builder: mozilla-central_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-021 starttime: 1465038737.73 results: success (0) buildid: 20160604013006 builduid: 8eb8b346bccf425aaabb3689b9a93cf2 revision: f3740cfc4b04fb61a1da306df4b1c2437f6bfb65 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-06-04 04:12:17.726826) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-06-04 04:12:17.727352) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-04 04:12:17.727653) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-04 04:12:17.763779) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-04 04:12:17.764065) ========= 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=df17445c3590ff7897617a0e00000225-1465037577.256341-43850869 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-06-04 04:12:18-- 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% 221M=0s 2016-06-04 04:12:18 (221 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.095811 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-04 04:12:17.877752) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-04 04:12:17.878068) ========= 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=df17445c3590ff7897617a0e00000225-1465037577.256341-43850869 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.021745 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-04 04:12:17.936821) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-04 04:12:17.937144) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev f3740cfc4b04fb61a1da306df4b1c2437f6bfb65 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo mozilla-central --rev f3740cfc4b04fb61a1da306df4b1c2437f6bfb65 --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=df17445c3590ff7897617a0e00000225-1465037577.256341-43850869 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-06-04 04:12:18,480 truncating revision to first 12 chars 2016-06-04 04:12:18,480 Setting DEBUG logging. 2016-06-04 04:12:18,480 attempt 1/10 2016-06-04 04:12:18,480 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/f3740cfc4b04?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-06-04 04:12:19,123 unpacking tar archive at: mozilla-central-f3740cfc4b04/testing/mozharness/ program finished with exit code 0 elapsedTime=0.969825 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-04 04:12:18.920816) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-04 04:12:18.921107) ========= script_repo_revision: f3740cfc4b04fb61a1da306df4b1c2437f6bfb65 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-04 04:12:18.921547) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-04 04:12:18.921826) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-04 04:12:18.944228) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 26 secs) (at 2016-06-04 04:12:18.944584) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=df17445c3590ff7897617a0e00000225-1465037577.256341-43850869 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 04:12:19 INFO - MultiFileLogger online at 20160604 04:12:19 in /builds/slave/test 04:12:19 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 04:12:19 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 04:12:19 INFO - {'append_to_log': False, 04:12:19 INFO - 'base_work_dir': '/builds/slave/test', 04:12:19 INFO - 'blob_upload_branch': 'Firefox', 04:12:19 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 04:12:19 INFO - 'branch': 'Firefox', 04:12:19 INFO - 'buildbot_json_path': 'buildprops.json', 04:12:19 INFO - 'config_files': ('talos/linux_config.py',), 04:12:19 INFO - 'default_actions': ('clobber', 04:12:19 INFO - 'read-buildbot-config', 04:12:19 INFO - 'download-and-extract', 04:12:19 INFO - 'populate-webroot', 04:12:19 INFO - 'create-virtualenv', 04:12:19 INFO - 'install', 04:12:19 INFO - 'run-tests'), 04:12:19 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 04:12:19 INFO - 'download_minidump_stackwalk': True, 04:12:19 INFO - 'download_symbols': 'ondemand', 04:12:19 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 04:12:19 INFO - 'tooltool.py': '/tools/tooltool.py', 04:12:19 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 04:12:19 INFO - '/tools/misc-python/virtualenv.py')}, 04:12:19 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 04:12:19 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 04:12:19 INFO - 'installer_path': 'installer.exe', 04:12:19 INFO - 'log_level': 'info', 04:12:19 INFO - 'log_name': 'talos', 04:12:19 INFO - 'log_to_console': True, 04:12:19 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 04:12:19 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 04:12:19 INFO - 'opt_config_files': (), 04:12:19 INFO - 'pip_index': False, 04:12:19 INFO - 'sps_profile': False, 04:12:19 INFO - 'sps_profile_interval': 0, 04:12:19 INFO - 'suite': 'dromaeojs', 04:12:19 INFO - 'system_bits': '32', 04:12:19 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 04:12:19 INFO - 'title': 'talos-linux64-ix-021', 04:12:19 INFO - 'tooltool_cache': '/builds/tooltool_cache', 04:12:19 INFO - 'use_talos_json': True, 04:12:19 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 04:12:19 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 04:12:19 INFO - 'work_dir': 'build'} 04:12:19 INFO - ##### 04:12:19 INFO - ##### Running clobber step. 04:12:19 INFO - ##### 04:12:19 INFO - Running pre-action listener: _resource_record_pre_action 04:12:19 INFO - Running main action method: clobber 04:12:19 INFO - rmtree: /builds/slave/test/build 04:12:19 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 04:12:20 INFO - Running post-action listener: _resource_record_post_action 04:12:20 INFO - ##### 04:12:20 INFO - ##### Finished clobber step (success) 04:12:20 INFO - ##### 04:12:20 INFO - ##### 04:12:20 INFO - ##### Running read-buildbot-config step. 04:12:20 INFO - ##### 04:12:20 INFO - Running pre-action listener: _resource_record_pre_action 04:12:20 INFO - Running main action method: read_buildbot_config 04:12:20 INFO - Using buildbot properties: 04:12:20 INFO - { 04:12:20 INFO - "project": "", 04:12:20 INFO - "product": "firefox", 04:12:20 INFO - "script_repo_revision": "production", 04:12:20 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs", 04:12:20 INFO - "repository": "", 04:12:20 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central pgo talos dromaeojs", 04:12:20 INFO - "buildid": "20160604013006", 04:12:20 INFO - "pgo_build": "True", 04:12:20 INFO - "basedir": "/builds/slave/test", 04:12:20 INFO - "buildnumber": 320, 04:12:20 INFO - "slavename": "talos-linux64-ix-021", 04:12:20 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 04:12:20 INFO - "platform": "ubuntu64_hw", 04:12:20 INFO - "scheduler": "tests-mozilla-central-linux64-pgo-talos", 04:12:20 INFO - "branch": "mozilla-central", 04:12:20 INFO - "repo_path": "mozilla-central", 04:12:20 INFO - "revision": "f3740cfc4b04fb61a1da306df4b1c2437f6bfb65", 04:12:20 INFO - "stage_platform": "linux64-pgo", 04:12:20 INFO - "builduid": "8eb8b346bccf425aaabb3689b9a93cf2", 04:12:20 INFO - "slavebuilddir": "test" 04:12:20 INFO - } 04:12:20 INFO - Found installer url https://queue.taskcluster.net/v1/task/YHdGyUxeQdCa1aVHz9KeXw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2. 04:12:20 INFO - Running post-action listener: _resource_record_post_action 04:12:20 INFO - ##### 04:12:20 INFO - ##### Finished read-buildbot-config step (success) 04:12:20 INFO - ##### 04:12:20 INFO - ##### 04:12:20 INFO - ##### Running download-and-extract step. 04:12:20 INFO - ##### 04:12:20 INFO - Running pre-action listener: _resource_record_pre_action 04:12:20 INFO - Running main action method: download_and_extract 04:12:20 INFO - mkdir: /builds/slave/test/build/tests 04:12:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:12:20 INFO - https://queue.taskcluster.net/v1/task/YHdGyUxeQdCa1aVHz9KeXw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 04:12:20 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YHdGyUxeQdCa1aVHz9KeXw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 04:12:20 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YHdGyUxeQdCa1aVHz9KeXw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 04:12:20 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YHdGyUxeQdCa1aVHz9KeXw/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 04:12:20 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YHdGyUxeQdCa1aVHz9KeXw/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 04:12:26 INFO - Downloaded 1361 bytes. 04:12:26 INFO - Reading from file /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 04:12:26 INFO - Using the following test package requirements: 04:12:26 INFO - {u'common': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'], 04:12:26 INFO - u'cppunittest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 04:12:26 INFO - u'firefox-49.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 04:12:26 INFO - u'gtest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 04:12:26 INFO - u'firefox-49.0a1.en-US.linux-x86_64.gtest.tests.zip'], 04:12:26 INFO - u'jittest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 04:12:26 INFO - u'jsshell-linux-x86_64.zip'], 04:12:26 INFO - u'mochitest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 04:12:26 INFO - u'firefox-49.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 04:12:26 INFO - u'mozbase': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'], 04:12:26 INFO - u'reftest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 04:12:26 INFO - u'firefox-49.0a1.en-US.linux-x86_64.reftest.tests.zip'], 04:12:26 INFO - u'talos': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 04:12:26 INFO - u'firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip'], 04:12:26 INFO - u'web-platform': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 04:12:26 INFO - u'firefox-49.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 04:12:26 INFO - u'xpcshell': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 04:12:26 INFO - u'firefox-49.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 04:12:26 INFO - Downloading packages: [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 04:12:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:12:26 INFO - https://queue.taskcluster.net/v1/task/YHdGyUxeQdCa1aVHz9KeXw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 04:12:26 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YHdGyUxeQdCa1aVHz9KeXw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 04:12:26 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YHdGyUxeQdCa1aVHz9KeXw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 04:12:26 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YHdGyUxeQdCa1aVHz9KeXw/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 04:12:26 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YHdGyUxeQdCa1aVHz9KeXw/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 04:12:28 INFO - retry: attempt #1 caught exception: '' 04:12:28 INFO - retry: Failed, sleeping 30 seconds before retrying 04:12:58 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YHdGyUxeQdCa1aVHz9KeXw/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 04:13:10 INFO - Downloaded 24441287 bytes. 04:13:10 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'] 04:13:10 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 04:13:11 INFO - Return code: 0 04:13:11 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 04:13:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:13:11 INFO - https://queue.taskcluster.net/v1/task/YHdGyUxeQdCa1aVHz9KeXw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 04:13:11 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YHdGyUxeQdCa1aVHz9KeXw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 04:13:11 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YHdGyUxeQdCa1aVHz9KeXw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 04:13:11 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YHdGyUxeQdCa1aVHz9KeXw/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 04:13:11 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YHdGyUxeQdCa1aVHz9KeXw/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 04:13:12 INFO - Downloaded 24441287 bytes. 04:13:12 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'] 04:13:12 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 04:13:14 INFO - Return code: 0 04:13:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:13:14 INFO - https://queue.taskcluster.net/v1/task/YHdGyUxeQdCa1aVHz9KeXw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 04:13:14 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YHdGyUxeQdCa1aVHz9KeXw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip 04:13:14 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YHdGyUxeQdCa1aVHz9KeXw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip 04:13:14 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YHdGyUxeQdCa1aVHz9KeXw/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 04:13:14 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YHdGyUxeQdCa1aVHz9KeXw/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 04:13:15 INFO - Downloaded 10833369 bytes. 04:13:15 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'] 04:13:15 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 04:13:15 INFO - Return code: 0 04:13:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:13:15 INFO - https://queue.taskcluster.net/v1/task/YHdGyUxeQdCa1aVHz9KeXw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 04:13:15 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YHdGyUxeQdCa1aVHz9KeXw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 04:13:15 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YHdGyUxeQdCa1aVHz9KeXw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 04:13:15 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YHdGyUxeQdCa1aVHz9KeXw/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 04:13:15 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/YHdGyUxeQdCa1aVHz9KeXw/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 04:13:16 INFO - Downloaded 59129756 bytes. 04:13:16 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/YHdGyUxeQdCa1aVHz9KeXw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 04:13:16 INFO - mkdir: /builds/slave/test/properties 04:13:16 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 04:13:16 INFO - Writing to file /builds/slave/test/properties/build_url 04:13:16 INFO - Contents: 04:13:16 INFO - build_url:https://queue.taskcluster.net/v1/task/YHdGyUxeQdCa1aVHz9KeXw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 04:13:17 INFO - Running post-action listener: _resource_record_post_action 04:13:17 INFO - Running post-action listener: set_extra_try_arguments 04:13:17 INFO - ##### 04:13:17 INFO - ##### Finished download-and-extract step (success) 04:13:17 INFO - ##### 04:13:17 INFO - ##### 04:13:17 INFO - ##### Running populate-webroot step. 04:13:17 INFO - ##### 04:13:17 INFO - Running pre-action listener: _resource_record_pre_action 04:13:17 INFO - Running main action method: populate_webroot 04:13:17 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 04:13:17 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 04:13:17 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 04:13:17 INFO - '--tppagecycles', 04:13:17 INFO - '7'], 04:13:17 INFO - 'tests': ['tsvgm']}}, 04:13:17 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 04:13:17 INFO - 'tests': ['tresize', 'tcanvasmark']}, 04:13:17 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 04:13:17 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 04:13:17 INFO - 'tests': ['dromaeo_css', 'kraken']}, 04:13:17 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 04:13:17 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:13:17 INFO - 'talos_options': ['--disable-e10s'], 04:13:17 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:13:17 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:13:17 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:13:17 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:13:17 INFO - 'talos_options': ['--disable-e10s'], 04:13:17 INFO - 'tests': ['damp', 'tps']}, 04:13:17 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:13:17 INFO - 'tests': ['damp', 'tps']}, 04:13:17 INFO - 'g3': {'talos_options': ['--disable-e10s'], 04:13:17 INFO - 'tests': ['dromaeo_dom']}, 04:13:17 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 04:13:17 INFO - 'other': {'talos_options': ['--disable-e10s'], 04:13:17 INFO - 'tests': ['a11yr', 04:13:17 INFO - 'ts_paint', 04:13:17 INFO - 'tpaint', 04:13:17 INFO - 'sessionrestore', 04:13:17 INFO - 'sessionrestore_no_auto_restore', 04:13:17 INFO - 'tabpaint']}, 04:13:17 INFO - 'other-e10s': {'tests': ['a11yr', 04:13:17 INFO - 'ts_paint', 04:13:17 INFO - 'tpaint', 04:13:17 INFO - 'sessionrestore', 04:13:17 INFO - 'sessionrestore_no_auto_restore', 04:13:17 INFO - 'tabpaint']}, 04:13:17 INFO - 'other-e10s_l64': {'tests': ['a11yr', 04:13:17 INFO - 'ts_paint', 04:13:17 INFO - 'tpaint', 04:13:17 INFO - 'sessionrestore', 04:13:17 INFO - 'sessionrestore_no_auto_restore', 04:13:17 INFO - 'tabpaint']}, 04:13:17 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 04:13:17 INFO - 'ts_paint', 04:13:17 INFO - 'tpaint', 04:13:17 INFO - 'sessionrestore', 04:13:17 INFO - 'sessionrestore_no_auto_restore', 04:13:17 INFO - 'tabpaint']}, 04:13:17 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 04:13:17 INFO - 'tests': ['a11yr', 04:13:17 INFO - 'ts_paint', 04:13:17 INFO - 'tpaint', 04:13:17 INFO - 'sessionrestore', 04:13:17 INFO - 'sessionrestore_no_auto_restore', 04:13:17 INFO - 'tabpaint']}, 04:13:17 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 04:13:17 INFO - 'tests': ['a11yr', 04:13:17 INFO - 'ts_paint', 04:13:17 INFO - 'tpaint', 04:13:17 INFO - 'sessionrestore', 04:13:17 INFO - 'sessionrestore_no_auto_restore', 04:13:17 INFO - 'tabpaint']}, 04:13:17 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 04:13:17 INFO - 'tests': ['tsvgx', 04:13:17 INFO - 'tsvgr_opacity', 04:13:17 INFO - 'tart', 04:13:17 INFO - 'tscrollx', 04:13:17 INFO - 'cart']}, 04:13:17 INFO - 'svgr-e10s': {'tests': ['tsvgx', 04:13:17 INFO - 'tsvgr_opacity', 04:13:17 INFO - 'tart', 04:13:17 INFO - 'tscrollx', 04:13:17 INFO - 'cart']}, 04:13:17 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:13:17 INFO - 'talos_options': ['--disable-e10s'], 04:13:17 INFO - 'tests': ['tp5o']}, 04:13:17 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:13:17 INFO - 'tests': ['tp5o']}, 04:13:17 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:13:17 INFO - 'talos_options': ['--disable-e10s', 04:13:17 INFO - '--xperf_path', 04:13:17 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:13:17 INFO - 'tests': ['tp5n']}, 04:13:17 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:13:17 INFO - 'talos_options': ['--xperf_path', 04:13:17 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:13:17 INFO - 'tests': ['tp5n']}}, 04:13:17 INFO - 'talos.zip': {'path': '', 04:13:17 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 04:13:17 INFO - Running post-action listener: _resource_record_post_action 04:13:17 INFO - ##### 04:13:17 INFO - ##### Finished populate-webroot step (success) 04:13:17 INFO - ##### 04:13:17 INFO - ##### 04:13:17 INFO - ##### Running create-virtualenv step. 04:13:17 INFO - ##### 04:13:17 INFO - Running pre-action listener: _resource_record_pre_action 04:13:17 INFO - Running main action method: create_virtualenv 04:13:17 INFO - Creating virtualenv /builds/slave/test/build/venv 04:13:17 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 04:13:17 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 04:13:17 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 04:13:17 INFO - Using real prefix '/usr' 04:13:17 INFO - New python executable in /builds/slave/test/build/venv/bin/python 04:13:18 INFO - Installing distribute.............................................................................................................................................................................................done. 04:13:20 INFO - Installing pip.................done. 04:13:20 INFO - Return code: 0 04:13:20 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 04:13:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:13:20 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:13:20 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:13:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:13:20 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:13:20 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:13:20 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb7eddfaf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29498a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a15f60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2aa5010>, '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 0x2aa5ef0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2aa63a0>, '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': 'df17445c3590ff7897617a0e00000225-1465037577.256341-43850869', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:13:20 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 04:13:20 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 04:13:20 INFO - Using env: {'DISPLAY': ':0', 04:13:20 INFO - 'HOME': '/home/cltbld', 04:13:20 INFO - 'LANG': 'en_US.UTF-8', 04:13:20 INFO - 'LANGUAGE': 'en_US:en', 04:13:20 INFO - 'LOGNAME': 'cltbld', 04:13:20 INFO - 'MAIL': '/var/mail/cltbld', 04:13:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:13:20 INFO - 'MOZ_NO_REMOTE': '1', 04:13:20 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:13:20 INFO - 'NO_EM_RESTART': '1', 04:13:20 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:13:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:13:20 INFO - 'PWD': '/builds/slave/test', 04:13:20 INFO - 'SHELL': '/bin/bash', 04:13:20 INFO - 'SHLVL': '1', 04:13:20 INFO - 'TERM': 'linux', 04:13:20 INFO - 'TMOUT': '86400', 04:13:20 INFO - 'USER': 'cltbld', 04:13:20 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1465037577.256341-43850869', 04:13:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:13:20 INFO - '_': '/tools/buildbot/bin/python'} 04:13:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:13:20 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 04:13:20 INFO - Cleaning up... 04:13:20 INFO - Return code: 0 04:13:20 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 04:13:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:13:20 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:13:20 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:13:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:13:20 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:13:20 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:13:20 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb7eddfaf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29498a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a15f60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2aa5010>, '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 0x2aa5ef0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2aa63a0>, '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': 'df17445c3590ff7897617a0e00000225-1465037577.256341-43850869', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:13:20 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 04:13:20 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 04:13:20 INFO - Using env: {'DISPLAY': ':0', 04:13:20 INFO - 'HOME': '/home/cltbld', 04:13:20 INFO - 'LANG': 'en_US.UTF-8', 04:13:20 INFO - 'LANGUAGE': 'en_US:en', 04:13:20 INFO - 'LOGNAME': 'cltbld', 04:13:20 INFO - 'MAIL': '/var/mail/cltbld', 04:13:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:13:20 INFO - 'MOZ_NO_REMOTE': '1', 04:13:20 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:13:20 INFO - 'NO_EM_RESTART': '1', 04:13:20 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:13:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:13:20 INFO - 'PWD': '/builds/slave/test', 04:13:20 INFO - 'SHELL': '/bin/bash', 04:13:20 INFO - 'SHLVL': '1', 04:13:20 INFO - 'TERM': 'linux', 04:13:20 INFO - 'TMOUT': '86400', 04:13:20 INFO - 'USER': 'cltbld', 04:13:20 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1465037577.256341-43850869', 04:13:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:13:20 INFO - '_': '/tools/buildbot/bin/python'} 04:13:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:13:20 INFO - Downloading/unpacking psutil>=3.1.1 04:13:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:13:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:13:20 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:13:20 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:13:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:13:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:13:22 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 04:13:22 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:13:22 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:13:22 INFO - Installing collected packages: psutil 04:13:22 INFO - Running setup.py install for psutil 04:13:22 INFO - building 'psutil._psutil_linux' extension 04:13:22 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 04:13:22 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 04:13:22 INFO - building 'psutil._psutil_posix' extension 04:13:22 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 04:13:22 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 04:13:23 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:13:23 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:13:23 INFO - Successfully installed psutil 04:13:23 INFO - Cleaning up... 04:13:23 INFO - Return code: 0 04:13:23 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 04:13:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:13:23 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:13:23 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:13:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:13:23 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:13:23 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:13:23 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb7eddfaf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29498a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a15f60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2aa5010>, '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 0x2aa5ef0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2aa63a0>, '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': 'df17445c3590ff7897617a0e00000225-1465037577.256341-43850869', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:13:23 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 04:13:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 04:13:23 INFO - Using env: {'DISPLAY': ':0', 04:13:23 INFO - 'HOME': '/home/cltbld', 04:13:23 INFO - 'LANG': 'en_US.UTF-8', 04:13:23 INFO - 'LANGUAGE': 'en_US:en', 04:13:23 INFO - 'LOGNAME': 'cltbld', 04:13:23 INFO - 'MAIL': '/var/mail/cltbld', 04:13:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:13:23 INFO - 'MOZ_NO_REMOTE': '1', 04:13:23 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:13:23 INFO - 'NO_EM_RESTART': '1', 04:13:23 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:13:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:13:23 INFO - 'PWD': '/builds/slave/test', 04:13:23 INFO - 'SHELL': '/bin/bash', 04:13:23 INFO - 'SHLVL': '1', 04:13:23 INFO - 'TERM': 'linux', 04:13:23 INFO - 'TMOUT': '86400', 04:13:23 INFO - 'USER': 'cltbld', 04:13:23 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1465037577.256341-43850869', 04:13:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:13:23 INFO - '_': '/tools/buildbot/bin/python'} 04:13:23 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:13:23 INFO - Downloading/unpacking mozsystemmonitor==0.3 04:13:23 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:13:23 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:13:23 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:13:23 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:13:23 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:13:23 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:13:25 INFO - Downloading mozsystemmonitor-0.3.tar.gz 04:13:25 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 04:13:25 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 04:13:25 INFO - Installing collected packages: mozsystemmonitor 04:13:25 INFO - Running setup.py install for mozsystemmonitor 04:13:25 INFO - Successfully installed mozsystemmonitor 04:13:25 INFO - Cleaning up... 04:13:25 INFO - Return code: 0 04:13:25 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 04:13:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:13:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:13:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:13:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:13:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:13:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:13:25 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb7eddfaf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29498a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a15f60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2aa5010>, '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 0x2aa5ef0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2aa63a0>, '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': 'df17445c3590ff7897617a0e00000225-1465037577.256341-43850869', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:13:25 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 04:13:25 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 04:13:25 INFO - Using env: {'DISPLAY': ':0', 04:13:25 INFO - 'HOME': '/home/cltbld', 04:13:25 INFO - 'LANG': 'en_US.UTF-8', 04:13:25 INFO - 'LANGUAGE': 'en_US:en', 04:13:25 INFO - 'LOGNAME': 'cltbld', 04:13:25 INFO - 'MAIL': '/var/mail/cltbld', 04:13:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:13:25 INFO - 'MOZ_NO_REMOTE': '1', 04:13:25 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:13:25 INFO - 'NO_EM_RESTART': '1', 04:13:25 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:13:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:13:25 INFO - 'PWD': '/builds/slave/test', 04:13:25 INFO - 'SHELL': '/bin/bash', 04:13:25 INFO - 'SHLVL': '1', 04:13:25 INFO - 'TERM': 'linux', 04:13:25 INFO - 'TMOUT': '86400', 04:13:25 INFO - 'USER': 'cltbld', 04:13:25 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1465037577.256341-43850869', 04:13:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:13:25 INFO - '_': '/tools/buildbot/bin/python'} 04:13:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:13:25 INFO - Downloading/unpacking jsonschema==2.5.1 04:13:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:13:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:13:25 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:13:25 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:13:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:13:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:13:27 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 04:13:27 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 04:13:27 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:13:27 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:13:27 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:13:27 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:13:27 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:13:27 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:13:27 INFO - Downloading functools32-3.2.3-2.tar.gz 04:13:27 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 04:13:27 INFO - warning: no files found matching '*.txt' 04:13:27 INFO - no previously-included directories found matching 'build' 04:13:27 INFO - no previously-included directories found matching 'dist' 04:13:27 INFO - no previously-included directories found matching '.git*' 04:13:27 INFO - Installing collected packages: jsonschema, functools32 04:13:27 INFO - Running setup.py install for functools32 04:13:27 INFO - warning: no files found matching '*.txt' 04:13:27 INFO - no previously-included directories found matching 'build' 04:13:27 INFO - no previously-included directories found matching 'dist' 04:13:27 INFO - no previously-included directories found matching '.git*' 04:13:27 INFO - Successfully installed jsonschema functools32 04:13:27 INFO - Cleaning up... 04:13:28 INFO - Return code: 0 04:13:28 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 04:13:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:13:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:13:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:13:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:13:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:13:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:13:28 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 0x7fb7eddfaf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29498a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a15f60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2aa5010>, '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 0x2aa5ef0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2aa63a0>, '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': 'df17445c3590ff7897617a0e00000225-1465037577.256341-43850869', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:13:28 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 04:13:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 04:13:28 INFO - Using env: {'DISPLAY': ':0', 04:13:28 INFO - 'HOME': '/home/cltbld', 04:13:28 INFO - 'LANG': 'en_US.UTF-8', 04:13:28 INFO - 'LANGUAGE': 'en_US:en', 04:13:28 INFO - 'LOGNAME': 'cltbld', 04:13:28 INFO - 'MAIL': '/var/mail/cltbld', 04:13:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:13:28 INFO - 'MOZ_NO_REMOTE': '1', 04:13:28 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:13:28 INFO - 'NO_EM_RESTART': '1', 04:13:28 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:13:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:13:28 INFO - 'PWD': '/builds/slave/test', 04:13:28 INFO - 'SHELL': '/bin/bash', 04:13:28 INFO - 'SHLVL': '1', 04:13:28 INFO - 'TERM': 'linux', 04:13:28 INFO - 'TMOUT': '86400', 04:13:28 INFO - 'USER': 'cltbld', 04:13:28 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1465037577.256341-43850869', 04:13:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:13:28 INFO - '_': '/tools/buildbot/bin/python'} 04:13:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:13:28 INFO - Downloading/unpacking blobuploader==1.2.4 04:13:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:13:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:13:28 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:13:28 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:13:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:13:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:13:30 INFO - Downloading blobuploader-1.2.4.tar.gz 04:13:30 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 04:13:30 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 04:13:30 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:13:30 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:13:30 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:13:30 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:13:30 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:13:30 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:13:30 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 04:13:30 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 04:13:30 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:13:30 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:13:30 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:13:30 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:13:30 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:13:30 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:13:30 INFO - Downloading docopt-0.6.1.tar.gz 04:13:30 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 04:13:30 INFO - Installing collected packages: blobuploader, requests, docopt 04:13:30 INFO - Running setup.py install for blobuploader 04:13:30 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 04:13:30 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 04:13:30 INFO - Running setup.py install for requests 04:13:31 INFO - Running setup.py install for docopt 04:13:31 INFO - Successfully installed blobuploader requests docopt 04:13:31 INFO - Cleaning up... 04:13:31 INFO - Return code: 0 04:13:31 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:13:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:13:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:13:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:13:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:13:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:13:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:13:31 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 0x7fb7eddfaf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29498a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a15f60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2aa5010>, '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 0x2aa5ef0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2aa63a0>, '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': 'df17445c3590ff7897617a0e00000225-1465037577.256341-43850869', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:13:31 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 04:13:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 04:13:31 INFO - Using env: {'DISPLAY': ':0', 04:13:31 INFO - 'HOME': '/home/cltbld', 04:13:31 INFO - 'LANG': 'en_US.UTF-8', 04:13:31 INFO - 'LANGUAGE': 'en_US:en', 04:13:31 INFO - 'LOGNAME': 'cltbld', 04:13:31 INFO - 'MAIL': '/var/mail/cltbld', 04:13:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:13:31 INFO - 'MOZ_NO_REMOTE': '1', 04:13:31 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:13:31 INFO - 'NO_EM_RESTART': '1', 04:13:31 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:13:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:13:31 INFO - 'PWD': '/builds/slave/test', 04:13:31 INFO - 'SHELL': '/bin/bash', 04:13:31 INFO - 'SHLVL': '1', 04:13:31 INFO - 'TERM': 'linux', 04:13:31 INFO - 'TMOUT': '86400', 04:13:31 INFO - 'USER': 'cltbld', 04:13:31 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1465037577.256341-43850869', 04:13:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:13:31 INFO - '_': '/tools/buildbot/bin/python'} 04:13:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:13:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:13:31 INFO - Running setup.py (path:/tmp/pip-5mSLOb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:13:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:13:31 INFO - Running setup.py (path:/tmp/pip-lQhpbl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:13:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:13:31 INFO - Running setup.py (path:/tmp/pip-xr9tys-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:13:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:13:31 INFO - Running setup.py (path:/tmp/pip-sEfkep-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:13:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:13:31 INFO - Running setup.py (path:/tmp/pip-yTlCok-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:13:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:13:32 INFO - Running setup.py (path:/tmp/pip-l8yPj3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:13:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:13:32 INFO - Running setup.py (path:/tmp/pip-EYIp2l-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:13:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:13:32 INFO - Running setup.py (path:/tmp/pip-_dr9wl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:13:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:13:32 INFO - Running setup.py (path:/tmp/pip-ThdnoW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:13:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:13:32 INFO - Running setup.py (path:/tmp/pip-IF8MJq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:13:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:13:32 INFO - Running setup.py (path:/tmp/pip-gWFf4K-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:13:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:13:32 INFO - Running setup.py (path:/tmp/pip-WLO8_x-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:13:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:13:32 INFO - Running setup.py (path:/tmp/pip-o87BiJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:13:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:13:32 INFO - Running setup.py (path:/tmp/pip-hQasyn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:13:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:13:32 INFO - Running setup.py (path:/tmp/pip-vhqBP2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:13:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:13:32 INFO - Running setup.py (path:/tmp/pip-Skwe7r-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:13:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:13:32 INFO - Running setup.py (path:/tmp/pip-WcfLd8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:13:32 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 04:13:32 INFO - Running setup.py install for manifestparser 04:13:33 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 04:13:33 INFO - Running setup.py install for mozcrash 04:13:33 INFO - Running setup.py install for mozdebug 04:13:33 INFO - Running setup.py install for mozdevice 04:13:33 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 04:13:33 INFO - Installing dm script to /builds/slave/test/build/venv/bin 04:13:33 INFO - Running setup.py install for mozfile 04:13:33 INFO - Running setup.py install for mozhttpd 04:13:33 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 04:13:33 INFO - Running setup.py install for mozinfo 04:13:33 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 04:13:33 INFO - Running setup.py install for mozInstall 04:13:33 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 04:13:33 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 04:13:33 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 04:13:33 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 04:13:33 INFO - Running setup.py install for mozleak 04:13:33 INFO - Running setup.py install for mozlog 04:13:33 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 04:13:33 INFO - Running setup.py install for moznetwork 04:13:34 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 04:13:34 INFO - Running setup.py install for mozprocess 04:13:34 INFO - Running setup.py install for mozprofile 04:13:34 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 04:13:34 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 04:13:34 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 04:13:34 INFO - Running setup.py install for mozrunner 04:13:34 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 04:13:34 INFO - Running setup.py install for mozscreenshot 04:13:34 INFO - Running setup.py install for moztest 04:13:34 INFO - Running setup.py install for mozversion 04:13:34 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 04:13:34 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 04:13:34 INFO - Cleaning up... 04:13:34 INFO - Return code: 0 04:13:34 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:13:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:13:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:13:34 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:13:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:13:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:13:34 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:13:34 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 0x7fb7eddfaf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29498a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a15f60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2aa5010>, '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 0x2aa5ef0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2aa63a0>, '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': 'df17445c3590ff7897617a0e00000225-1465037577.256341-43850869', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:13:34 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 04:13:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 04:13:34 INFO - Using env: {'DISPLAY': ':0', 04:13:34 INFO - 'HOME': '/home/cltbld', 04:13:34 INFO - 'LANG': 'en_US.UTF-8', 04:13:34 INFO - 'LANGUAGE': 'en_US:en', 04:13:34 INFO - 'LOGNAME': 'cltbld', 04:13:34 INFO - 'MAIL': '/var/mail/cltbld', 04:13:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:13:34 INFO - 'MOZ_NO_REMOTE': '1', 04:13:34 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:13:34 INFO - 'NO_EM_RESTART': '1', 04:13:34 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:13:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:13:34 INFO - 'PWD': '/builds/slave/test', 04:13:34 INFO - 'SHELL': '/bin/bash', 04:13:34 INFO - 'SHLVL': '1', 04:13:34 INFO - 'TERM': 'linux', 04:13:34 INFO - 'TMOUT': '86400', 04:13:34 INFO - 'USER': 'cltbld', 04:13:34 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1465037577.256341-43850869', 04:13:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:13:34 INFO - '_': '/tools/buildbot/bin/python'} 04:13:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:13:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:13:34 INFO - Running setup.py (path:/tmp/pip-x_ZYDQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:13:34 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 04:13:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:13:34 INFO - Running setup.py (path:/tmp/pip-o179i7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:13:35 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 04:13:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:13:35 INFO - Running setup.py (path:/tmp/pip-qapuVq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:13:35 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 04:13:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:13:35 INFO - Running setup.py (path:/tmp/pip-fABOET-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:13:35 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 04:13:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:13:35 INFO - Running setup.py (path:/tmp/pip-oRcg35-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:13:35 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 04:13:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:13:35 INFO - Running setup.py (path:/tmp/pip-b1rOHN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:13:35 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 04:13:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:13:35 INFO - Running setup.py (path:/tmp/pip-O7ese1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:13:35 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 04:13:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:13:35 INFO - Running setup.py (path:/tmp/pip-wvF4QZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:13:35 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 04:13:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:13:35 INFO - Running setup.py (path:/tmp/pip-wkpNSV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:13:35 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 04:13:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:13:35 INFO - Running setup.py (path:/tmp/pip-DH5OS9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:13:35 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.2 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 04:13:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:13:35 INFO - Running setup.py (path:/tmp/pip-wFzmbb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:13:35 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 04:13:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:13:35 INFO - Running setup.py (path:/tmp/pip-njoEly-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:13:35 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)) 04:13:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:13:35 INFO - Running setup.py (path:/tmp/pip-4xhene-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:13:35 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 04:13:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:13:35 INFO - Running setup.py (path:/tmp/pip-fnXi8u-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:13:35 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)) 04:13:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:13:35 INFO - Running setup.py (path:/tmp/pip-E6i0wX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:13:36 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 04:13:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:13:36 INFO - Running setup.py (path:/tmp/pip-W9i7hl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:13:36 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 04:13:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:13:36 INFO - Running setup.py (path:/tmp/pip-_qD_iY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:13:36 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 04:13:36 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 04:13:36 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 04:13:36 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 04:13:36 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 04:13:36 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 04:13:36 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.2->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 04:13:36 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:13:36 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:13:36 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:13:36 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:13:36 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:13:36 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:13:38 INFO - Downloading blessings-1.6.tar.gz 04:13:38 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 04:13:38 INFO - Installing collected packages: blessings 04:13:38 INFO - Running setup.py install for blessings 04:13:38 INFO - Successfully installed blessings 04:13:38 INFO - Cleaning up... 04:13:38 INFO - Return code: 0 04:13:38 INFO - Done creating virtualenv /builds/slave/test/build/venv. 04:13:38 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:13:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:13:38 INFO - Reading from file tmpfile_stdout 04:13:38 INFO - Current package versions: 04:13:38 INFO - argparse == 1.2.1 04:13:38 INFO - blessings == 1.6 04:13:38 INFO - blobuploader == 1.2.4 04:13:38 INFO - docopt == 0.6.1 04:13:38 INFO - functools32 == 3.2.3-2 04:13:38 INFO - jsonschema == 2.5.1 04:13:38 INFO - manifestparser == 1.1 04:13:38 INFO - mozInstall == 1.12 04:13:38 INFO - mozcrash == 0.17 04:13:38 INFO - mozdebug == 0.1 04:13:38 INFO - mozdevice == 0.48 04:13:38 INFO - mozfile == 1.2 04:13:38 INFO - mozhttpd == 0.7 04:13:38 INFO - mozinfo == 0.9 04:13:38 INFO - mozleak == 0.1 04:13:38 INFO - mozlog == 3.2 04:13:38 INFO - moznetwork == 0.27 04:13:38 INFO - mozprocess == 0.22 04:13:38 INFO - mozprofile == 0.28 04:13:38 INFO - mozrunner == 6.11 04:13:38 INFO - mozscreenshot == 0.1 04:13:38 INFO - mozsystemmonitor == 0.3 04:13:38 INFO - moztest == 0.7 04:13:38 INFO - mozversion == 1.4 04:13:38 INFO - psutil == 3.1.1 04:13:38 INFO - requests == 1.2.3 04:13:38 INFO - wsgiref == 0.1.2 04:13:38 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:13:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:13:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:13:38 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:13:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:13:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:13:38 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:13:38 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 0x7fb7eddfaf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29498a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a15f60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2aa5010>, '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 0x2aa5ef0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2aa63a0>, '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': 'df17445c3590ff7897617a0e00000225-1465037577.256341-43850869', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:13:38 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 04:13:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 04:13:38 INFO - Using env: {'DISPLAY': ':0', 04:13:38 INFO - 'HOME': '/home/cltbld', 04:13:38 INFO - 'LANG': 'en_US.UTF-8', 04:13:38 INFO - 'LANGUAGE': 'en_US:en', 04:13:38 INFO - 'LOGNAME': 'cltbld', 04:13:38 INFO - 'MAIL': '/var/mail/cltbld', 04:13:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:13:38 INFO - 'MOZ_NO_REMOTE': '1', 04:13:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:13:38 INFO - 'NO_EM_RESTART': '1', 04:13:38 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:13:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:13:38 INFO - 'PWD': '/builds/slave/test', 04:13:38 INFO - 'SHELL': '/bin/bash', 04:13:38 INFO - 'SHLVL': '1', 04:13:38 INFO - 'TERM': 'linux', 04:13:38 INFO - 'TMOUT': '86400', 04:13:38 INFO - 'USER': 'cltbld', 04:13:38 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1465037577.256341-43850869', 04:13:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:13:38 INFO - '_': '/tools/buildbot/bin/python'} 04:13:38 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:13:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 04:13:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 04:13:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 04:13:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 04:13:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 04:13:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 04:13:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 04:13:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 04:13:38 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 04:13:38 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 04:13:38 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 04:13:38 INFO - Cleaning up... 04:13:38 INFO - Return code: 0 04:13:38 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 04:13:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:13:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:13:38 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:13:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:13:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:13:38 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:13:38 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 0x7fb7eddfaf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29498a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a15f60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2aa5010>, '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 0x2aa5ef0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2aa63a0>, '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': 'df17445c3590ff7897617a0e00000225-1465037577.256341-43850869', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:13:38 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 04:13:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 04:13:38 INFO - Using env: {'DISPLAY': ':0', 04:13:38 INFO - 'HOME': '/home/cltbld', 04:13:38 INFO - 'LANG': 'en_US.UTF-8', 04:13:38 INFO - 'LANGUAGE': 'en_US:en', 04:13:38 INFO - 'LOGNAME': 'cltbld', 04:13:38 INFO - 'MAIL': '/var/mail/cltbld', 04:13:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:13:38 INFO - 'MOZ_NO_REMOTE': '1', 04:13:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:13:38 INFO - 'NO_EM_RESTART': '1', 04:13:38 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:13:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:13:38 INFO - 'PWD': '/builds/slave/test', 04:13:38 INFO - 'SHELL': '/bin/bash', 04:13:38 INFO - 'SHLVL': '1', 04:13:38 INFO - 'TERM': 'linux', 04:13:38 INFO - 'TMOUT': '86400', 04:13:38 INFO - 'USER': 'cltbld', 04:13:38 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1465037577.256341-43850869', 04:13:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:13:38 INFO - '_': '/tools/buildbot/bin/python'} 04:13:38 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:13:38 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 04:13:38 INFO - Cleaning up... 04:13:38 INFO - Return code: 0 04:13:38 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 04:13:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:13:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:13:38 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:13:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:13:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:13:38 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:13:38 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 0x7fb7eddfaf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29498a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a15f60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2aa5010>, '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 0x2aa5ef0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2aa63a0>, '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': 'df17445c3590ff7897617a0e00000225-1465037577.256341-43850869', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:13:38 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 04:13:38 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 04:13:38 INFO - Using env: {'DISPLAY': ':0', 04:13:38 INFO - 'HOME': '/home/cltbld', 04:13:38 INFO - 'LANG': 'en_US.UTF-8', 04:13:38 INFO - 'LANGUAGE': 'en_US:en', 04:13:38 INFO - 'LOGNAME': 'cltbld', 04:13:38 INFO - 'MAIL': '/var/mail/cltbld', 04:13:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:13:38 INFO - 'MOZ_NO_REMOTE': '1', 04:13:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:13:38 INFO - 'NO_EM_RESTART': '1', 04:13:38 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:13:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:13:38 INFO - 'PWD': '/builds/slave/test', 04:13:38 INFO - 'SHELL': '/bin/bash', 04:13:38 INFO - 'SHLVL': '1', 04:13:38 INFO - 'TERM': 'linux', 04:13:38 INFO - 'TMOUT': '86400', 04:13:38 INFO - 'USER': 'cltbld', 04:13:38 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1465037577.256341-43850869', 04:13:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:13:38 INFO - '_': '/tools/buildbot/bin/python'} 04:13:39 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:13:39 INFO - Downloading/unpacking flake8 04:13:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:13:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:13:39 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:13:39 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:13:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:13:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:13:41 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 04:13:41 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 04:13:41 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:13:41 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:13:41 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:13:41 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:13:41 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:13:41 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:13:41 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 04:13:41 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 04:13:41 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:13:41 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:13:41 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:13:41 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:13:41 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:13:41 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:13:41 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 04:13:41 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:13:41 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:13:41 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:13:41 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:13:41 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:13:41 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:13:41 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 04:13:41 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 04:13:41 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 04:13:41 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 04:13:41 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 04:13:41 INFO - no previously-included directories found matching 'docs/_build' 04:13:41 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 04:13:41 INFO - Running setup.py install for pep8 04:13:42 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 04:13:42 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 04:13:42 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 04:13:42 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 04:13:42 INFO - no previously-included directories found matching 'docs/_build' 04:13:42 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 04:13:42 INFO - Successfully installed flake8 mccabe pyflakes pep8 04:13:42 INFO - Cleaning up... 04:13:42 INFO - Return code: 0 04:13:42 INFO - Running post-action listener: _resource_record_post_action 04:13:42 INFO - Running post-action listener: _start_resource_monitoring 04:13:42 INFO - Starting resource monitoring. 04:13:42 INFO - ##### 04:13:42 INFO - ##### Finished create-virtualenv step (success) 04:13:42 INFO - ##### 04:13:42 INFO - ##### 04:13:42 INFO - ##### Running install step. 04:13:42 INFO - ##### 04:13:42 INFO - Running pre-action listener: _resource_record_pre_action 04:13:42 INFO - Running main action method: install 04:13:42 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:13:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:13:42 INFO - Reading from file tmpfile_stdout 04:13:42 INFO - Detecting whether we're running mozinstall >=1.0... 04:13:42 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 04:13:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 04:13:42 INFO - Reading from file tmpfile_stdout 04:13:42 INFO - Output received: 04:13:42 INFO - Usage: mozinstall [options] installer 04:13:42 INFO - Options: 04:13:42 INFO - -h, --help show this help message and exit 04:13:42 INFO - -d DEST, --destination=DEST 04:13:42 INFO - Directory to install application into. [default: 04:13:42 INFO - "/builds/slave/test"] 04:13:42 INFO - --app=APP Application being installed. [default: firefox] 04:13:42 INFO - mkdir: /builds/slave/test/build/application 04:13:42 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'] 04:13:42 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 04:13:59 INFO - Reading from file tmpfile_stdout 04:13:59 INFO - Output received: 04:13:59 INFO - /builds/slave/test/build/application/firefox/firefox 04:13:59 INFO - Running post-action listener: _resource_record_post_action 04:13:59 INFO - ##### 04:13:59 INFO - ##### Finished install step (success) 04:13:59 INFO - ##### 04:13:59 INFO - ##### 04:13:59 INFO - ##### Running run-tests step. 04:13:59 INFO - ##### 04:13:59 INFO - Running pre-action listener: _resource_record_pre_action 04:13:59 INFO - Running main action method: run_tests 04:13:59 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 04:13:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 04:13:59 INFO - Python 2.7.3 04:13:59 INFO - Return code: 0 04:13:59 INFO - grabbing minidump binary from tooltool 04:13:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:13:59 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2aa5010>, '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 0x2aa5ef0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2aa63a0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 04:13:59 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 04:13:59 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 04:13:59 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 04:13:59 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 04:13:59 INFO - Return code: 0 04:13:59 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 04:13:59 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 04:13:59 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 04:13:59 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 04:13:59 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 04:13:59 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 04:13:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 04:14:00 INFO - Return code: 0 04:14:00 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/YHdGyUxeQdCa1aVHz9KeXw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-021', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 04:14:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/YHdGyUxeQdCa1aVHz9KeXw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-021 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 04:14:00 INFO - Using env: {'DISPLAY': ':0', 04:14:00 INFO - 'HOME': '/home/cltbld', 04:14:00 INFO - 'LANG': 'en_US.UTF-8', 04:14:00 INFO - 'LANGUAGE': 'en_US:en', 04:14:00 INFO - 'LOGNAME': 'cltbld', 04:14:00 INFO - 'MAIL': '/var/mail/cltbld', 04:14:00 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 04:14:00 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 04:14:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:14:00 INFO - 'MOZ_NO_REMOTE': '1', 04:14:00 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 04:14:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:14:00 INFO - 'NO_EM_RESTART': '1', 04:14:00 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:14:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:14:00 INFO - 'PWD': '/builds/slave/test', 04:14:00 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 04:14:00 INFO - 'SHELL': '/bin/bash', 04:14:00 INFO - 'SHLVL': '1', 04:14:00 INFO - 'TERM': 'linux', 04:14:00 INFO - 'TMOUT': '86400', 04:14:00 INFO - 'USER': 'cltbld', 04:14:00 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1465037577.256341-43850869', 04:14:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:14:00 INFO - '_': '/tools/buildbot/bin/python'} 04:14:00 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/YHdGyUxeQdCa1aVHz9KeXw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-021', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 04:14:00 INFO - mozversion application_buildid: 20160604013006 04:14:00 INFO - mozversion application_changeset: f3740cfc4b04fb61a1da306df4b1c2437f6bfb65 04:14:00 INFO - mozversion application_display_name: Nightly 04:14:00 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 04:14:00 INFO - mozversion application_name: Firefox 04:14:00 INFO - mozversion application_remotingname: firefox 04:14:00 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 04:14:00 INFO - mozversion application_vendor: Mozilla 04:14:00 INFO - mozversion application_version: 49.0a1 04:14:00 INFO - mozversion platform_buildid: 20160604013006 04:14:00 INFO - mozversion platform_changeset: f3740cfc4b04fb61a1da306df4b1c2437f6bfb65 04:14:00 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 04:14:00 INFO - mozversion platform_version: 49.0a1 04:14:00 INFO - using testdate: 1465038840 04:14:00 INFO - actual date: 1465038840 04:14:00 INFO - starting webserver on 'localhost:50120' 04:14:00 INFO - SUITE-START | Running 2 tests 04:14:00 INFO - TEST-START | dromaeo_css 04:14:00 INFO - operating with platform_type : linux_ 04:14:00 INFO - Initialising browser for dromaeo_css test... 04:14:00 INFO - TEST-INFO | started process 10389 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp1glMHp/profile http://localhost:50120/getInfo.html) 04:14:05 INFO - PROCESS | 10389 | __metrics Screen width/height:1600/1200 04:14:05 INFO - PROCESS | 10389 | colorDepth:24 04:14:05 INFO - PROCESS | 10389 | Browser inner width/height: 1024/697 04:14:05 INFO - PROCESS | 10389 | __metrics 04:14:06 ERROR - PROCESS | 10389 | JavaScript error: resource://app/modules/AboutNewTab.jsm, line 36: TypeError: this.pageListener is null 04:14:07 INFO - TEST-INFO | 10389: exit 0 04:14:07 INFO - Browser initialized. 04:14:07 INFO - Running cycle 1/1 for dromaeo_css test... 04:14:07 INFO - TEST-INFO | started process 10474 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp1glMHp/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 04:14:19 INFO - PROCESS | 10474 | RSS: Main: 156938240 04:14:19 INFO - PROCESS | 10474 | 04:15:10 INFO - PROCESS | 10474 | 1465038910849 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 04:17:19 INFO - PROCESS | 10474 | Cycle 1(1): loaded http://localhost:50120/tests/dromaeo/cssquery-dojo.html (next: http://localhost:50120/tests/dromaeo/cssquery-ext.html) 04:17:20 INFO - PROCESS | 10474 | RSS: Main: 288620544 04:17:20 INFO - PROCESS | 10474 | 04:20:23 INFO - PROCESS | 10474 | Cycle 1(1): loaded http://localhost:50120/tests/dromaeo/cssquery-ext.html (next: http://localhost:50120/tests/dromaeo/cssquery-jquery.html) 04:20:23 INFO - PROCESS | 10474 | RSS: Main: 237932544 04:20:23 INFO - PROCESS | 10474 | 04:23:25 INFO - PROCESS | 10474 | Cycle 1(1): loaded http://localhost:50120/tests/dromaeo/cssquery-jquery.html (next: http://localhost:50120/tests/dromaeo/cssquery-mootools.html) 04:23:26 INFO - PROCESS | 10474 | RSS: Main: 241963008 04:23:26 INFO - PROCESS | 10474 | 04:26:28 INFO - PROCESS | 10474 | Cycle 1(1): loaded http://localhost:50120/tests/dromaeo/cssquery-mootools.html (next: http://localhost:50120/tests/dromaeo/cssquery-prototype.html) 04:26:28 INFO - PROCESS | 10474 | RSS: Main: 238882816 04:26:28 INFO - PROCESS | 10474 | 04:29:31 INFO - PROCESS | 10474 | Cycle 1(1): loaded http://localhost:50120/tests/dromaeo/cssquery-prototype.html (next: http://localhost:50120/tests/dromaeo/cssquery-yui.html) 04:29:32 INFO - PROCESS | 10474 | RSS: Main: 223883264 04:29:32 INFO - PROCESS | 10474 | 04:32:35 INFO - PROCESS | 10474 | Cycle 1(1): loaded http://localhost:50120/tests/dromaeo/cssquery-yui.html (next: http://localhost:50120/tests/dromaeo/cssquery-dojo.html) 04:32:35 INFO - PROCESS | 10474 | RSS: Main: 320135168 04:32:35 INFO - PROCESS | 10474 | 04:32:35 INFO - PROCESS | 10474 | __start_tp_report 04:32:35 INFO - PROCESS | 10474 | _x_x_mozilla_page_load 04:32:35 INFO - PROCESS | 10474 | _x_x_mozilla_page_load_details 04:32:35 INFO - PROCESS | 10474 | |i|pagename|runs| 04:32:35 INFO - PROCESS | 10474 | |0;dojo.html;3141.890033848815;3164.9208769780766;3192.792468489549;3211.839408029598;3247.951280730788;5285.841424757254;5370.43610420905;5456.508914197721;5546.4453554644515;5593.244911936888;5351.25082488452;5356.785728570852;5484.670919744818;5505.421930697279;5526.088195447756;4824.87937801556;4890.951090489103;4909.288153217782;4920.68015578988;5042.067217564744;4960.627952903528;4980.601551875841;5000.374953130859;5014.8244811431605;5059.038782631306;4790.832320868771;4844.297576851354;4908.901821963576;4967.577755890754;4997.625178111638;4901.338319326881;4931.43288521821;4931.67944083637;5014.774335154927;5023.974880125613;4931.161702510546;4952.777125029383;4976.800927962913;4978.103941290567;5022.17134172861;5234.371875374942;5308.469153084699;5395.649282796645;5428.647137936022;5444.891102177974;5925.585209035369;5948.494377977877;5954.345022047572;5970.283565972068;5972.790952316692;5901.4098590141075;5983.910241346383;5984.3417224105315;5986.102084687332;6008.639481631116;5275.050490911634;5443.646162999393;5474.863128421742;5477.068898287341;5600.831975040755;6063.151158837766;6068.779501011499;6069.36271691466;6071.551513397757;6081.745283254246;5863.413658634103;5877.647341159544;5889.5877288590245;5891.116332550152;5899.410058994152;5650.152477128464;5786.3056433228285;5854.912176317359;5855.824325270249;5912.940870591239;5870.5890587659305;5878.059510478303;5880.26496687914;5880.882382352329;5883.2057672213705;5668.914966275509;5859.882802343929;5911.527077833849;5914.112883067574;5917.704114794243;4306.138772245564;4407.669424793154;4432.955670443319;4442.378067070613;4465.531119232499;3953.1105501261986;3962.841486340514;3963.6829053675638;3999.0202400411504;4009.1781184857036;5338.46615338463;5518.255035570227;5530.308711411074;5539.473749993744;5543.1408131739645;5845.795397161079;5897.144913987534;5911.349751527328;5985.581009329392;6016.879662406727;5551.056320425538;5551.639143455663;5551.8889622208135;5555.583331250173;5557.972210138923;5090.160123579642;5100.336956195671;5100.948990510122;5101.362329708786;5135.4094279157625;5842.912356314659;6005.069214271794;6081.513478921675;6100.847478813065;6151.046587778901;5956.404359564009;5956.672383018976;5957.821265362046;5961.2846458425265;5962.433568810956;5825.533957283323;6073.908891366721;6117;6132.693365331626;6147.784827531015;5733.569982251264;5752.884942301047;5785.132230165509;5821.126830975388;5832.212651292021;5883.705814709333;5922.289325280822;5923.674197919156;5925.081612350093;5926.1999630049395;5521.420250873761;5679.574031947538;5751.367349591458;5755.424457554379;5756.68338241384;5729.083346664514;5780.306363236438;5798.1302804579655;5803.390643982321;5850.531957443309;5680.517156041783;5700.543956483389;5701.6864072474755;5704.543636509153;5705.515031222227;5538.833834984957;5685.630434021776;5799.652020878761;5819.5053420459735;5851.239338886088;5405.675659460445;5447.373552041566;5558.777648894161;5607.99056169877;5658.20785090096 04:32:35 INFO - PROCESS | 10474 | |1;ext.html;574.7528562718032;609.9417510619077;628.2649300318627;635.9046143078538;639.4724352409263;33884.491732624;41792.16415671685;43192;43289;43330.35004474936;44440.55559444405;45053.62097842659;45056.54943450564;45104.09791804162;45189.548104518944;8047.356211503065;8547.829043419128;8731.781705457352;10511.159107271438;10808.459577021156;10222.284440089197;10651.627193048245;10654.4140072296;10655.680329590125;10664.573417063308;10678.199135064862;10682.465876706172;10686;10754.462276886163;10762.73093172673;10628.681139565826;10690.51892664832;10697.358158510475;10700.78598428027;10723.571057157704;10622;10718.303310284806;10721.303115297558;10725.51735171919;10730.839037414446;43369.78315108404;43742.78128609368;43778.78110609426;44038;44051;3469.4275444551618;3877.321468742987;4169.4162817205615;4214.873553793391;4283.550227226127;33636.32727345464;33687.157821054425;33869.32261354759;34777;35125.12187195315;4234.6823988201;4319.827206911751;4362.454693163355;4371.388005679208;4380.167768124046;361640;364941;365340;366174;368491;65644;65713;65790;66037;66041;70677.2932270681;70776;70780.2921970784;70796.29203707897;70856.291437086;16929.576760581083;17392.3043078278;17501.47495575135;17540.824591754175;17559.122043897754;13193.274369909746;13306.800397994039;13314.667133321744;13319.800202996963;13320.267385293708;20070.19719211215;20775.480612984797;20803.271885483937;20814.66965285547;20974.685379719318;7519.8120046998165;7707.768766937001;7770.222977702185;7780.688772449039;7801.882971755428;1023.2785885950387;1064.8775390830153;1156.329328989201;1157.4350998923296;1160.7178227627448;32950.50574241388;32957.50563741546;32977.67022329794;32986.83506582452;33621.83189084039;950.7052813627797;1093.6281664234039;1158.9362585057902;1163.2613290560387;1197.2935967778878;16213.513594592181;16755.83244167567;16859.325626975027;17011.744823827652;17204.483865484057;493518;493547;497322;497345;499128;58574.7071264641;59239.40760592339;59258.40741592529;59295.703521482115;59352.70323648354;1299.0452017766934;1371.5268232459784;1384.349355802771;1409.239010934084;1421.5948454690363;32668.83665581657;33504.664953350155;33911.15222119368;33932.64269429195;34191.82904085464;50230.748846255534;50458.49541504538;50537.74731126468;50676.74661626668;50701.74649126879;379510;380910;381564;382628;382666;33993.320133596695;43690.78154609207;44661.776691116334;47357.52642473669;48028.519714803806;48904.75547622239;48975.26537102018;49160.508394915596;50141;50226.97730226948;39959.80020099881;41359.586404135574;41649.79175104226;42435.15129697327;42443.57556424396;40614;40980.59019409768;42106.36840447457;42238.366424504275;42796.14407711891;41327.79336103421;42015.15969680528;42733.931651708954;42762;45576.544234558554;33254.5011824818;36425.15505755005;36965.815170923976;39399.21201575895;39907.60092399039;28381.858090709415;28400.85799570989;28492;28637;28655.283617908884 04:32:35 INFO - PROCESS | 10474 | |2;jquery.html;379.7607507270419;384.181692993923;393.37649825027347;395.28848073467753;409.54540460089316;17857.553561160978;19584.41246762596;20370.490737731565;20390.184392624295;20390.796092039076;18610.441686749386;18625.161867715953;19366;19850.106745196466;19881.801181988176;5381.704006279653;5494.80768173114;5608.46719561641;5718.399568045358;5852.853678658025;5841.824745257628;5864.23764910561;5867.031939729939;5885.764569417218;5890.087036509348;5457.181422786594;5749.683767392792;5750.942490575104;5852.151438041481;5853.473187413132;5747.051736463479;5755.2230448889495;5764.365919748824;5767.307923049261;5791.5656325775735;5417.945820541783;5663.037283661787;5674.177244299594;5675.290588676416;5677.574181936371;13242.271675057867;13507.594772156754;14656;22560.43598910024;23155.073797048266;2248.9212877549207;2351.4356554426986;2394.1022116706235;2407.037185125946;2682.5305571524905;9401.388909720847;10305.84541231882;10543.578256869716;11991.880081199251;14105.435782568686;1859.172668162668;1885.4155211884222;1888.0842791246234;1889.1970912362192;1908.7232351309121;78726;82927;82957;83992.58003710004;85846.57076714639;10654;10866.239363244655;10894.61868834587;11142.944285278521;11321.830172547254;15382.230888455757;15425.228738563026;15443.536693899201;15463.458778942682;15464.613384665474;8081.151479094728;8242.56080720666;8277.62750676209;8386.790330241793;8430.156984301644;7886.171951945078;7939.126696063428;8038.638261278256;8069.556174410463;8124.431289809657;4691.7184968901975;4724.740139292372;4763.333133361332;4771.5467030632035;4836.492168322346;1950.5416227186884;1975.4468748750373;1995.720599116125;2018.3137733170793;2021.9797802022085;856.0497847389518;1040.4745603470199;1064.5156453813497;1066.4987455895716;1087.475623830937;18782.53043673919;19015.33446329372;19262.71105933412;19958.20167193325;19979.38318883328;991.9779604497087;1012.625393452353;1026.5688410867454;1059.3379138038727;1101.6529793115303;10485.117514169024;11124.551389069415;11184.60853870127;11194.832077518844;11260.268082574607;349577;354647;440325;447775;451108;103258;103264;105624.47187764011;107533;108394;1015.2994433840627;1027.9588816447258;1059.3114475590928;1068.5565490321585;1082.626493859617;17804.46586602404;18094.5476363092;18333.724994124834;18347.35784247545;18724.625507490047;41875.58124418717;43097.78451107725;43118.56881431145;43252.56747432485;43916.341254880565;59983.40016599778;61019;62255;62426.37573624387;62770.37229627645;8509.702160424355;8546.829063418822;8561.22948934599;8621.913780862362;8729.738107856774;9249.630014799333;13424.89167428837;13626.93186534061;13636.79544806809;14054;11826.940865295619;11989.160758746804;12032.75934481288;12034.819477708017;12278.631641050782;11540.711482213012;11645.359505227294;11655.708607284547;11666.824997624874;11979.580714674945;11921.165518413627;12147.696307592381;12269.447874845475;12353.135280530276;12752.42614082387;8614.18165274298;8627.137286271323;8630.956845215735;8789.296856251356;8921.15249051339;11057.855192618043;12280.815787763013;12421.689457763629;12461.190022648861;12551.246925184518 04:32:35 INFO - PROCESS | 10474 | |3;mootools.html;1387.3063468265866;1495.932683029264;1527.6257316957347;1703.3612395351743;1857.9535511612207;8617.612207450664;8915.286777057836;8955.910440895588;9191.494467804268;9211;8911.331650126234;9111.863322050174;9117.452952822836;9121.17909388155;9131.223845973083;2055.403932859469;2264.8188144948363;2339.415146213447;2347.2958112566203;2371.407148212938;2381.868997205153;2389.139909632531;2390.2948630154146;2391.1391898916377;2395.3891757601873;2373.098222675381;2385.1294277588727;2413.8310318277727;2421.2615152378517;2422.6729391532094;2020.8383329333617;2240.260713964396;2287.645414960667;2346.753590872968;2356.1871154451687;2317.7450480447137;2323.6979192705007;2357.174988753922;2358.068562917655;2361.3388251289666;9042.095790420972;9055.864162037575;9068.727938161866;9069.410488318239;9076.18314351705;5250.343707036621;5361.946380536184;5366.812161574326;5374.516293533562;5389.730513474311;3261.5433839262287;3285.211549228192;3371.96628033719;3401.8299085045896;3492.353914525821;1041.1202533858877;1061.4321338084164;1069.1874175626501;1095.5015467962137;1095.616534213027;12888.80666789999;12899.806502902464;12931.806022909665;12955.222686638832;12989.155704879247;4644.140833945731;4672.252439609714;4779.928301075487;4780.020095880336;4784.832530861403;10620.468976551141;10677.679669609925;10682.62610808618;10685.755991241926;10689.679309620724;5395.352557693023;5414.377346605112;5422.8915421691345;5432.29380180574;5441.483059109379;4356.803943822536;4845.75771211438;5006.4492905780335;5049.6465247432325;5100.1074811907765;4048.514178298623;4070.0792563017676;4169.937450938239;4173.373993900939;4195.035141917376;1246.6696325473756;1251.956181533642;1296.572131196703;1303.0878385130447;1307.2940612069376;855.1130290390448;905.8550631898864;944.2587568758491;990.6037584966072;1038.382162613244;6147.907781383283;6487.318831522716;6535.281119076898;6573.1454910861285;6619.900701489481;442.10473790574343;442.17975655159216;449.22732899412955;459.6322941646669;460.6545091181614;4217.97891010543;4262.403263543107;4355.542668019875;4415.249407600716;4426.402435671208;11102.555897764;11471.139664525193;11499.885001150049;11574.421278936019;11585;11210.327380357041;11317.547298107984;11322.32066076038;11349.375784331776;11359.261647992855;7939.087004994384;8203.58982050907;8228.958855205685;8308.003039635283;8505.702300419456;5740.339860915881;6061.878762424815;6140.385961403824;6204.565680402328;6397.520185986163;9762.60949562038;9893.159081477866;10126.59493620247;10147.086762191439;10166.644167454104;10033.698989030048;10231.641892533726;10282.280240383101;10315.329503582243;10332.948335258276;7577.1665116836;7671;8434.03008653988;8587.699430519902;8845.380823342304;8491.915080849112;8512.574371281287;8598.742037738877;8600.78498037554;8629.611667475105;7256.7460138894885;7488.475806693479;7563.697452101855;7580;7641.312281894656;7330.780076597711;7601.0878694557005;7628.847423051397;7684.923150768421;7757.340626046849;6876.621785801829;6926.411255043377;6969.059177011039;6970.059042029464;6970.930290697028;5206.453322401245;5261.184516399964;5271.367435907562;5407.080796264566;5424.213489044146;5122.718250496258;5505.587080969023;5582.162675598693;5713.057345538106;5779.2775903012125 04:32:35 INFO - PROCESS | 10474 | |4;prototype.html;325.4776084384563;326.1454987931619;336.05233242256844;336.45662255457427;339.25194945145955;5296.470352964707;5353.812616558421;5357;5357.937194180239;5390.1914712793105;5247.370315562138;5267.656747529384;5271.288376069229;5284.735763211843;5294.497022782839;3992.1616460543246;4042.4744783178144;4150.086980864205;4158.958410415902;4170.39529268256;4165.375193720935;4182;4187.1625674865;4200.453940987667;4202.453681021463;4003.939940900889;4163.333866581347;4164.208800327928;4166.749995000295;4170.812313445902;4044.3529035354495;4077.6533994610495;4098;4116.958830411702;4161.56303588122;3647.252313275772;3665.193657395369;3681.37416639172;3689.6494832991093;3689.8893033209047;5012.423571289312;5084.491550844923;5084.491550844923;5095.847124586268;5111.591072714211;4586.3579098926175;4723.929141062887;4745.881352966204;4755.762211889391;4778.2115950868065;5500.862478438031;5558.77764889408;5560.054790685593;5562.582806289544;5574.804881829116;3823.847046118152;3985.3822657487844;4057.8173982170874;4063.1061166543313;4063.9390409143884;5797.130430435426;5801.7099145042575;5805.941940580582;5816.185733997244;5845.444682755132;4063.776492292893;4068.4100805383055;4073.103917138225;4086.366613174963;4087.7532352632734;3863.36254518007;4111.465509483748;4127.4634297541725;4128.752274863517;4130.669546436278;4667.533246675305;4698.389209402824;4700.153972285021;4703.882402939954;4706.435227772689;5632.633878797865;5636.267285252891;5643.322801263875;5648.51987581052;5657;1344.1128854955878;1408.8732014118777;1416.5891891351598;1421.722764060998;1424.5896562403354;902.5081330674798;908.9181973622406;909.3816204980544;913.5660561233361;949.6581230756922;5313.681179129265;5315.335583052119;5323.855371095233;5353.9732301338245;5373.65071270374;5745.735938093612;5755.740991655385;5758;5762.9135562966585;5763.7982670606325;5074.695518268915;5245.97703447824;5291.365036195682;5354.491323324278;5364.436734142937;3002;3006.969930300669;3031.9393612128074;3036.9392612147635;3037.772167087433;5826.213461182686;5828.834233153301;5842.912356314659;5860.472557469848;5860.765569377262;5599.832005039855;5858.50202732764;5895.734691938873;5906.633219065092;5910.670099227726;5873.970630146822;5890.9410905891245;5900.734466948998;5927.496162826208;5931.792387266425;5532.197831314517;5768.769249229984;5773.566982476415;5786.582287339629;5807.390224026416;5603.243562119224;5684.971575142098;5703.230063941481;5727.4845263926445;5744.626599271034;5896.498797602252;5929.22123362998;5930.7924222652;5936.970315148396;5938.584299099021;3852.6725228355904;4048.554658987568;4052.777097259679;4073.6537394321813;4084.8978775529663;5666.886662266649;5679.642948176461;5681.176229446624;5717.628354156966;5719.48524632785;5357.812476563302;5457.972710136424;5563.916541251803;5573.300143456285;5609.943900561106;5471.644343117685;5490.3411590609385;5492.681756378521;5573.944260557342;5582.218489411404;5205.45342739007;5368.302120724281;5374.355077390738;5400.9459905400445;5456.236126942152;5635.8591035224445;5658.688772117573;5660.264165658438;5662.490375866192;5667.376588575171;5445.53712934405;5467.753951072132;5475.863103422446;5515.724213789214;5519.668819870821 04:32:35 INFO - PROCESS | 10474 | |5;yui.html;784.5724080376194;818.2390376949437;847.5423271433426;850.188070392775;858.8325276571068;15339.156346400958;15548.144852033134;15585.29866156023;16027.439039633615;16139;14259.643508912282;14281.92859035706;14401.27993600321;14416.135031898093;14428.35072421741;682.9897551536731;801.4550105927966;803.1606970715587;823.7158180427773;829.655692887451;817.7056259746487;818.5702506184241;818.5907046476761;818.8198596308803;819.9549024803633;862.6808081010004;865.5369377383101;865.5455885660016;866.2333834556431;866.9436486628349;701.3582571946663;833.0628043451118;853.5561508015797;853.5774791478227;861.7543999960012;624.4692011789942;624.9781257656006;625.4527288622455;625.6871564217892;626.2672672972633;14942.925285373503;15044.699106017928;15045.172515511642;15046.699066018728;15064.322105505169;14165.291735413188;14531.636709082357;14554.563363099123;14594.270286485633;14767.335469903881;12375.566855160116;12656.303903285316;12740.108192426535;13025.609231723063;13088;4435.146443514664;4500.257457519506;4525.70582912113;4557.473246462439;4694.342792009122;68706;68764.31235687679;70514;72324;72542.27457725408;11517.596884109016;11600.6519804406;11694.181407301407;11763;11793.351365674798;21511.67732484014;21590.568188636138;21601.67597486039;21632.35102946914;21646.675299870516;8184.920417465908;8332.16678332174;8385.706500272461;8634.611442485104;8817.426867253607;4662.860114196579;4773;4816.301636262722;4829.492903245108;4971.90056198874;3602.495650608917;3716.9442458363146;3720.8511659533856;3724.217914237986;3728.6084961078695;599.9760009599568;610.4170517156106;616.808789275326;646.3342756960338;646.3988490703597;633.3096924352386;682.8258794007496;707.7558242406361;713.6360456167392;740.4594645908517;9910.504474776233;10090.747731306776;10185.592576296865;10240.64157754475;10326.22553308505;603.8430008197901;605.9272887253558;627.6140173793176;644.9970296189376;766.1419210484294;4457.531959144243;4660.39414876064;4669.4630117536235;4694;4869.63477739171;73047;120900.3954980237;122099;129824.3508782469;130504;76604;104515;106846;106977.46511267393;110368.4481577587;53068.73465632647;63043.05435418472;71590;82103;83808.8484261314;9862.753431164278;10315.742106447098;10366.5335059924;10496.68509944703;10571.2600117991;38247;40341.39487907742;43166.136677266906;44543.55456445524;44886.3267051001;52769.736151319;58875.11687324779;74756.62621687075;75468;75484;12592.244465331743;12639.431225595054;12777.93611031939;13149.868501315246;13733.107348022746;14012.159270443806;14364.281785910454;14707.485238016618;14797;15421.768673469682;13761.17432954026;13951.162930224218;13988.792714769028;14364.35360408805;14638.194899280215;13359.53241636577;14007.859921400655;14190.2195379251;14394.640133996734;14845.554633361016;12310.815337769762;12423.937880310541;12769.489220431451;13585.909731736845;13749.656258593615;10859.782804344028;11009.339439633648;11082.889171108509;11174.329540227613;11560.710982225175;10710.241868306735;11568.363739994382;12079.939600301943;12174.634760957186;12269.681950636419 04:32:35 INFO - PROCESS | 10474 | __end_tp_report 04:32:35 INFO - PROCESS | 10474 | __start_cc_report 04:32:35 INFO - PROCESS | 10474 | _x_x_mozilla_cycle_collect,1138 04:32:35 INFO - PROCESS | 10474 | __end_cc_report 04:32:35 INFO - PROCESS | 10474 | __startTimestamp1465039955441__endTimestamp 04:32:35 INFO - PROCESS | 10474 | 04:32:35 INFO - PROCESS | 10474 | ------- Summary: start ------- 04:32:35 INFO - PROCESS | 10474 | Number of tests: 6 04:32:35 INFO - PROCESS | 10474 | 04:32:35 INFO - PROCESS | 10474 | [#0] dojo.html Cycles:165 Average:5447.69 Median:5658.21 stddev:637.40 (11.3%) stddev-sans-first:613.15 04:32:35 INFO - PROCESS | 10474 | Values: 3141.9 3164.9 3192.8 3211.8 3248.0 5285.8 5370.4 5456.5 5546.4 5593.2 5351.3 5356.8 5484.7 5505.4 5526.1 4824.9 4891.0 4909.3 4920.7 5042.1 4960.6 4980.6 5000.4 5014.8 5059.0 4790.8 4844.3 4908.9 4967.6 4997.6 4901.3 4931.4 4931.7 5014.8 5024.0 4931.2 4952.8 4976.8 4978.1 5022.2 5234.4 5308.5 5395.6 5428.6 5444.9 5925.6 5948.5 5954.3 5970.3 5972.8 5901.4 5983.9 5984.3 5986.1 6008.6 5275.1 5443.6 5474.9 5477.1 5600.8 6063.2 6068.8 6069.4 6071.6 6081.7 5863.4 5877.6 5889.6 5891.1 5899.4 5650.2 5786.3 5854.9 5855.8 5912.9 5870.6 5878.1 5880.3 5880.9 5883.2 5668.9 5859.9 5911.5 5914.1 5917.7 4306.1 4407.7 4433.0 4442.4 4465.5 3953.1 3962.8 3963.7 3999.0 4009.2 5338.5 5518.3 5530.3 5539.5 5543.1 5845.8 5897.1 5911.3 5985.6 6016.9 5551.1 5551.6 5551.9 5555.6 5558.0 5090.2 5100.3 5100.9 5101.4 5135.4 5842.9 6005.1 6081.5 6100.8 6151.0 5956.4 5956.7 5957.8 5961.3 5962.4 5825.5 6073.9 6117.0 6132.7 6147.8 5733.6 5752.9 5785.1 5821.1 5832.2 5883.7 5922.3 5923.7 5925.1 5926.2 5521.4 5679.6 5751.4 5755.4 5756.7 5729.1 5780.3 5798.1 5803.4 5850.5 5680.5 5700.5 5701.7 5704.5 5705.5 5538.8 5685.6 5799.7 5819.5 5851.2 5405.7 5447.4 5558.8 5608.0 5658.2 04:32:35 INFO - PROCESS | 10474 | 04:32:35 INFO - PROCESS | 10474 | [#1] ext.html Cycles:180 Average:59595.41 Median:382647.00 stddev:110289.16 (28.8%) stddev-sans-first:110509.53 04:32:35 INFO - PROCESS | 10474 | Values: 574.8 609.9 628.3 635.9 639.5 33884.5 41792.2 43192.0 43289.0 43330.4 44440.6 45053.6 45056.5 45104.1 45189.5 8047.4 8547.8 8731.8 10511.2 10808.5 10222.3 10651.6 10654.4 10655.7 10664.6 10678.2 10682.5 10686.0 10754.5 10762.7 10628.7 10690.5 10697.4 10700.8 10723.6 10622.0 10718.3 10721.3 10725.5 10730.8 43369.8 43742.8 43778.8 44038.0 44051.0 3469.4 3877.3 4169.4 4214.9 4283.6 33636.3 33687.2 33869.3 34777.0 35125.1 4234.7 4319.8 4362.5 4371.4 4380.2 361640.0 364941.0 365340.0 366174.0 368491.0 65644.0 65713.0 65790.0 66037.0 66041.0 70677.3 70776.0 70780.3 70796.3 70856.3 16929.6 17392.3 17501.5 17540.8 17559.1 13193.3 13306.8 13314.7 13319.8 13320.3 20070.2 20775.5 20803.3 20814.7 20974.7 7519.8 7707.8 7770.2 7780.7 7801.9 1023.3 1064.9 1156.3 1157.4 1160.7 32950.5 32957.5 32977.7 32986.8 33621.8 950.7 1093.6 1158.9 1163.3 1197.3 16213.5 16755.8 16859.3 17011.7 17204.5 493518.0 493547.0 497322.0 497345.0 499128.0 58574.7 59239.4 59258.4 59295.7 59352.7 1299.0 1371.5 1384.3 1409.2 1421.6 32668.8 33504.7 33911.2 33932.6 34191.8 50230.7 50458.5 50537.7 50676.7 50701.7 379510.0 380910.0 381564.0 382628.0 382666.0 33993.3 43690.8 44661.8 47357.5 48028.5 48904.8 48975.3 49160.5 50141.0 50227.0 39959.8 41359.6 41649.8 42435.2 42443.6 40614.0 40980.6 42106.4 42238.4 42796.1 41327.8 42015.2 42733.9 42762.0 45576.5 33254.5 36425.2 36965.8 39399.2 39907.6 28381.9 28400.9 28492.0 28637.0 28655.3 04:32:35 INFO - PROCESS | 10474 | 04:32:35 INFO - PROCESS | 10474 | [#2] jquery.html Cycles:180 Average:27290.86 Median:11196.24 stddev:68848.43 (614.9%) stddev-sans-first:69011.92 04:32:35 INFO - PROCESS | 10474 | Values: 379.8 384.2 393.4 395.3 409.5 17857.6 19584.4 20370.5 20390.2 20390.8 18610.4 18625.2 19366.0 19850.1 19881.8 5381.7 5494.8 5608.5 5718.4 5852.9 5841.8 5864.2 5867.0 5885.8 5890.1 5457.2 5749.7 5750.9 5852.2 5853.5 5747.1 5755.2 5764.4 5767.3 5791.6 5417.9 5663.0 5674.2 5675.3 5677.6 13242.3 13507.6 14656.0 22560.4 23155.1 2248.9 2351.4 2394.1 2407.0 2682.5 9401.4 10305.8 10543.6 11991.9 14105.4 1859.2 1885.4 1888.1 1889.2 1908.7 78726.0 82927.0 82957.0 83992.6 85846.6 10654.0 10866.2 10894.6 11142.9 11321.8 15382.2 15425.2 15443.5 15463.5 15464.6 8081.2 8242.6 8277.6 8386.8 8430.2 7886.2 7939.1 8038.6 8069.6 8124.4 4691.7 4724.7 4763.3 4771.5 4836.5 1950.5 1975.4 1995.7 2018.3 2022.0 856.0 1040.5 1064.5 1066.5 1087.5 18782.5 19015.3 19262.7 19958.2 19979.4 992.0 1012.6 1026.6 1059.3 1101.7 10485.1 11124.6 11184.6 11194.8 11260.3 349577.0 354647.0 440325.0 447775.0 451108.0 103258.0 103264.0 105624.5 107533.0 108394.0 1015.3 1028.0 1059.3 1068.6 1082.6 17804.5 18094.5 18333.7 18347.4 18724.6 41875.6 43097.8 43118.6 43252.6 43916.3 59983.4 61019.0 62255.0 62426.4 62770.4 8509.7 8546.8 8561.2 8621.9 8729.7 9249.6 13424.9 13626.9 13636.8 14054.0 11826.9 11989.2 12032.8 12034.8 12278.6 11540.7 11645.4 11655.7 11666.8 11979.6 11921.2 12147.7 12269.4 12353.1 12752.4 8614.2 8627.1 8631.0 8789.3 8921.2 11057.9 12280.8 12421.7 12461.2 12551.2 04:32:35 INFO - PROCESS | 10474 | 04:32:35 INFO - PROCESS | 10474 | [#3] mootools.html Cycles:180 Average:5929.56 Median:4658.20 stddev:3424.28 (73.5%) stddev-sans-first:3416.87 04:32:35 INFO - PROCESS | 10474 | Values: 1387.3 1495.9 1527.6 1703.4 1858.0 8617.6 8915.3 8955.9 9191.5 9211.0 8911.3 9111.9 9117.5 9121.2 9131.2 2055.4 2264.8 2339.4 2347.3 2371.4 2381.9 2389.1 2390.3 2391.1 2395.4 2373.1 2385.1 2413.8 2421.3 2422.7 2020.8 2240.3 2287.6 2346.8 2356.2 2317.7 2323.7 2357.2 2358.1 2361.3 9042.1 9055.9 9068.7 9069.4 9076.2 5250.3 5361.9 5366.8 5374.5 5389.7 3261.5 3285.2 3372.0 3401.8 3492.4 1041.1 1061.4 1069.2 1095.5 1095.6 12888.8 12899.8 12931.8 12955.2 12989.2 4644.1 4672.3 4779.9 4780.0 4784.8 10620.5 10677.7 10682.6 10685.8 10689.7 5395.4 5414.4 5422.9 5432.3 5441.5 4356.8 4845.8 5006.4 5049.6 5100.1 4048.5 4070.1 4169.9 4173.4 4195.0 1246.7 1252.0 1296.6 1303.1 1307.3 855.1 905.9 944.3 990.6 1038.4 6147.9 6487.3 6535.3 6573.1 6619.9 442.1 442.2 449.2 459.6 460.7 4218.0 4262.4 4355.5 4415.2 4426.4 11102.6 11471.1 11499.9 11574.4 11585.0 11210.3 11317.5 11322.3 11349.4 11359.3 7939.1 8203.6 8229.0 8308.0 8505.7 5740.3 6061.9 6140.4 6204.6 6397.5 9762.6 9893.2 10126.6 10147.1 10166.6 10033.7 10231.6 10282.3 10315.3 10332.9 7577.2 7671.0 8434.0 8587.7 8845.4 8491.9 8512.6 8598.7 8600.8 8629.6 7256.7 7488.5 7563.7 7580.0 7641.3 7330.8 7601.1 7628.8 7684.9 7757.3 6876.6 6926.4 6969.1 6970.1 6970.9 5206.5 5261.2 5271.4 5407.1 5424.2 5122.7 5505.6 5582.2 5713.1 5779.3 04:32:35 INFO - PROCESS | 10474 | 04:32:35 INFO - PROCESS | 10474 | [#4] prototype.html Cycles:180 Average:4685.93 Median:5355.75 stddev:1385.69 (25.9%) stddev-sans-first:1350.38 04:32:35 INFO - PROCESS | 10474 | Values: 325.5 326.1 336.1 336.5 339.3 5296.5 5353.8 5357.0 5357.9 5390.2 5247.4 5267.7 5271.3 5284.7 5294.5 3992.2 4042.5 4150.1 4159.0 4170.4 4165.4 4182.0 4187.2 4200.5 4202.5 4003.9 4163.3 4164.2 4166.7 4170.8 4044.4 4077.7 4098.0 4117.0 4161.6 3647.3 3665.2 3681.4 3689.6 3689.9 5012.4 5084.5 5084.5 5095.8 5111.6 4586.4 4723.9 4745.9 4755.8 4778.2 5500.9 5558.8 5560.1 5562.6 5574.8 3823.8 3985.4 4057.8 4063.1 4063.9 5797.1 5801.7 5805.9 5816.2 5845.4 4063.8 4068.4 4073.1 4086.4 4087.8 3863.4 4111.5 4127.5 4128.8 4130.7 4667.5 4698.4 4700.2 4703.9 4706.4 5632.6 5636.3 5643.3 5648.5 5657.0 1344.1 1408.9 1416.6 1421.7 1424.6 902.5 908.9 909.4 913.6 949.7 5313.7 5315.3 5323.9 5354.0 5373.7 5745.7 5755.7 5758.0 5762.9 5763.8 5074.7 5246.0 5291.4 5354.5 5364.4 3002.0 3007.0 3031.9 3036.9 3037.8 5826.2 5828.8 5842.9 5860.5 5860.8 5599.8 5858.5 5895.7 5906.6 5910.7 5874.0 5890.9 5900.7 5927.5 5931.8 5532.2 5768.8 5773.6 5786.6 5807.4 5603.2 5685.0 5703.2 5727.5 5744.6 5896.5 5929.2 5930.8 5937.0 5938.6 3852.7 4048.6 4052.8 4073.7 4084.9 5666.9 5679.6 5681.2 5717.6 5719.5 5357.8 5458.0 5563.9 5573.3 5609.9 5471.6 5490.3 5492.7 5573.9 5582.2 5205.5 5368.3 5374.4 5400.9 5456.2 5635.9 5658.7 5660.3 5662.5 5667.4 5445.5 5467.8 5475.9 5515.7 5519.7 04:32:35 INFO - PROCESS | 10474 | 04:32:35 INFO - PROCESS | 10474 | [#5] yui.html Cycles:180 Average:19950.36 Median:20987.80 stddev:28745.43 (137.0%) stddev-sans-first:28790.04 04:32:35 INFO - PROCESS | 10474 | Values: 784.6 818.2 847.5 850.2 858.8 15339.2 15548.1 15585.3 16027.4 16139.0 14259.6 14281.9 14401.3 14416.1 14428.4 683.0 801.5 803.2 823.7 829.7 817.7 818.6 818.6 818.8 820.0 862.7 865.5 865.5 866.2 866.9 701.4 833.1 853.6 853.6 861.8 624.5 625.0 625.5 625.7 626.3 14942.9 15044.7 15045.2 15046.7 15064.3 14165.3 14531.6 14554.6 14594.3 14767.3 12375.6 12656.3 12740.1 13025.6 13088.0 4435.1 4500.3 4525.7 4557.5 4694.3 68706.0 68764.3 70514.0 72324.0 72542.3 11517.6 11600.7 11694.2 11763.0 11793.4 21511.7 21590.6 21601.7 21632.4 21646.7 8184.9 8332.2 8385.7 8634.6 8817.4 4662.9 4773.0 4816.3 4829.5 4971.9 3602.5 3716.9 3720.9 3724.2 3728.6 600.0 610.4 616.8 646.3 646.4 633.3 682.8 707.8 713.6 740.5 9910.5 10090.7 10185.6 10240.6 10326.2 603.8 605.9 627.6 645.0 766.1 4457.5 4660.4 4669.5 4694.0 4869.6 73047.0 120900.4 122099.0 129824.4 130504.0 76604.0 104515.0 106846.0 106977.5 110368.4 53068.7 63043.1 71590.0 82103.0 83808.8 9862.8 10315.7 10366.5 10496.7 10571.3 38247.0 40341.4 43166.1 44543.6 44886.3 52769.7 58875.1 74756.6 75468.0 75484.0 12592.2 12639.4 12777.9 13149.9 13733.1 14012.2 14364.3 14707.5 14797.0 15421.8 13761.2 13951.2 13988.8 14364.4 14638.2 13359.5 14007.9 14190.2 14394.6 14845.6 12310.8 12423.9 12769.5 13585.9 13749.7 10859.8 11009.3 11082.9 11174.3 11560.7 10710.2 11568.4 12079.9 12174.6 12269.7 04:32:35 INFO - PROCESS | 10474 | -------- Summary: end -------- 04:32:35 INFO - PROCESS | 10474 | 04:32:36 INFO - TEST-INFO | 10474: exit 0 04:32:36 INFO - TEST-OK | dromaeo_css | took 1115835ms 04:32:36 INFO - TEST-START | kraken 04:32:36 INFO - operating with platform_type : linux_ 04:32:36 INFO - Initialising browser for kraken test... 04:32:36 INFO - TEST-INFO | started process 10657 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpw4zrrw/profile http://localhost:50120/getInfo.html) 04:32:40 INFO - PROCESS | 10657 | __metrics Screen width/height:1600/1200 04:32:40 INFO - PROCESS | 10657 | colorDepth:24 04:32:40 INFO - PROCESS | 10657 | Browser inner width/height: 1024/697 04:32:40 INFO - PROCESS | 10657 | __metrics 04:32:42 ERROR - PROCESS | 10657 | JavaScript error: resource://app/modules/AboutNewTab.jsm, line 36: TypeError: this.pageListener is null 04:32:42 INFO - TEST-INFO | 10657: exit 0 04:32:42 INFO - Browser initialized. 04:32:42 INFO - Running cycle 1/1 for kraken test... 04:32:42 INFO - TEST-INFO | started process 10737 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpw4zrrw/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 04:32:54 INFO - PROCESS | 10737 | RSS: Main: 156631040 04:32:54 INFO - PROCESS | 10737 | 04:32:57 INFO - PROCESS | 10737 | Cycle 1(1): loaded http://localhost:50120/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:50120/tests/kraken/driver.html?testName=audio-beat-detection) 04:32:58 INFO - PROCESS | 10737 | RSS: Main: 214827008 04:32:58 INFO - PROCESS | 10737 | 04:33:00 INFO - PROCESS | 10737 | Cycle 1(1): loaded http://localhost:50120/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:50120/tests/kraken/driver.html?testName=audio-dft) 04:33:01 INFO - PROCESS | 10737 | RSS: Main: 201334784 04:33:01 INFO - PROCESS | 10737 | 04:33:04 INFO - PROCESS | 10737 | Cycle 1(1): loaded http://localhost:50120/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:50120/tests/kraken/driver.html?testName=audio-fft) 04:33:05 INFO - PROCESS | 10737 | RSS: Main: 268771328 04:33:05 INFO - PROCESS | 10737 | 04:33:07 INFO - PROCESS | 10737 | Cycle 1(1): loaded http://localhost:50120/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:50120/tests/kraken/driver.html?testName=audio-oscillator) 04:33:07 INFO - PROCESS | 10737 | RSS: Main: 179916800 04:33:07 INFO - PROCESS | 10737 | 04:33:10 INFO - PROCESS | 10737 | Cycle 1(1): loaded http://localhost:50120/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:50120/tests/kraken/driver.html?testName=imaging-gaussian-blur) 04:33:10 INFO - PROCESS | 10737 | RSS: Main: 183566336 04:33:10 INFO - PROCESS | 10737 | 04:33:13 INFO - PROCESS | 10737 | Cycle 1(1): loaded http://localhost:50120/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:50120/tests/kraken/driver.html?testName=imaging-darkroom) 04:33:14 INFO - PROCESS | 10737 | RSS: Main: 220082176 04:33:14 INFO - PROCESS | 10737 | 04:33:17 INFO - PROCESS | 10737 | Cycle 1(1): loaded http://localhost:50120/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:50120/tests/kraken/driver.html?testName=imaging-desaturate) 04:33:18 INFO - PROCESS | 10737 | RSS: Main: 220286976 04:33:18 INFO - PROCESS | 10737 | 04:33:21 INFO - PROCESS | 10737 | Cycle 1(1): loaded http://localhost:50120/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:50120/tests/kraken/driver.html?testName=json-parse-financial) 04:33:21 INFO - PROCESS | 10737 | RSS: Main: 220839936 04:33:21 INFO - PROCESS | 10737 | 04:33:23 INFO - PROCESS | 10737 | Cycle 1(1): loaded http://localhost:50120/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:50120/tests/kraken/driver.html?testName=json-stringify-tinderbox) 04:33:23 INFO - PROCESS | 10737 | RSS: Main: 206114816 04:33:23 INFO - PROCESS | 10737 | 04:33:25 INFO - PROCESS | 10737 | Cycle 1(1): loaded http://localhost:50120/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:50120/tests/kraken/driver.html?testName=stanford-crypto-aes) 04:33:26 INFO - PROCESS | 10737 | RSS: Main: 208834560 04:33:26 INFO - PROCESS | 10737 | 04:33:28 INFO - PROCESS | 10737 | Cycle 1(1): loaded http://localhost:50120/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:50120/tests/kraken/driver.html?testName=stanford-crypto-ccm) 04:33:28 INFO - PROCESS | 10737 | RSS: Main: 215932928 04:33:28 INFO - PROCESS | 10737 | 04:33:31 INFO - PROCESS | 10737 | Cycle 1(1): loaded http://localhost:50120/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:50120/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 04:33:32 INFO - PROCESS | 10737 | RSS: Main: 222232576 04:33:32 INFO - PROCESS | 10737 | 04:33:34 INFO - PROCESS | 10737 | Cycle 1(1): loaded http://localhost:50120/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:50120/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 04:33:35 INFO - PROCESS | 10737 | RSS: Main: 223686656 04:33:35 INFO - PROCESS | 10737 | 04:33:36 INFO - PROCESS | 10737 | Cycle 1(1): loaded http://localhost:50120/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:50120/tests/kraken/driver.html?testName=ai-astar) 04:33:37 INFO - PROCESS | 10737 | RSS: Main: 265363456 04:33:37 INFO - PROCESS | 10737 | 04:33:37 INFO - PROCESS | 10737 | __start_tp_report 04:33:37 INFO - PROCESS | 10737 | _x_x_mozilla_page_load 04:33:37 INFO - PROCESS | 10737 | _x_x_mozilla_page_load_details 04:33:37 INFO - PROCESS | 10737 | |i|pagename|runs| 04:33:37 INFO - PROCESS | 10737 | |0;ai-astar;110;104;110;111;112;111;110;110;111;112 04:33:37 INFO - PROCESS | 10737 | |1;audio-beat-detection;156;123;134;164;128;161;154;125;190;133 04:33:37 INFO - PROCESS | 10737 | |2;audio-dft;159;159;162;159;161;160;162;161;160;159 04:33:37 INFO - PROCESS | 10737 | |3;audio-fft;75;74;74;124;76;76;75;74;118;74 04:33:37 INFO - PROCESS | 10737 | |4;audio-oscillator;84;86;109;84;84;87;115;83;84;135 04:33:37 INFO - PROCESS | 10737 | |5;imaging-gaussian-blur;116;117;116;116;117;117;117;117;118;118 04:33:37 INFO - PROCESS | 10737 | |6;imaging-darkroom;146;146;146;146;146;145;146;145;146;145 04:33:37 INFO - PROCESS | 10737 | |7;imaging-desaturate;95;94;95;94;94;94;94;95;95;94 04:33:37 INFO - PROCESS | 10737 | |8;json-parse-financial;54;57;55;54;54;54;54;55;53;55 04:33:37 INFO - PROCESS | 10737 | |9;json-stringify-tinderbox;62;63;62;63;63;63;62;62;63;63 04:33:37 INFO - PROCESS | 10737 | |10;stanford-crypto-aes;85;81;78;79;85;83;80;80;111;81 04:33:37 INFO - PROCESS | 10737 | |11;stanford-crypto-ccm;124;129;121;121;131;122;121;120;131;125 04:33:37 INFO - PROCESS | 10737 | |12;stanford-crypto-pbkdf2;166;160;160;157;161;157;157;157;156;157 04:33:37 INFO - PROCESS | 10737 | |13;stanford-crypto-sha256-iterative;63;64;63;63;62;61;65;62;63;60 04:33:37 INFO - PROCESS | 10737 | __end_tp_report 04:33:37 INFO - PROCESS | 10737 | __start_cc_report 04:33:37 INFO - PROCESS | 10737 | _x_x_mozilla_cycle_collect,1649 04:33:37 INFO - PROCESS | 10737 | __end_cc_report 04:33:37 INFO - PROCESS | 10737 | __startTimestamp1465040017214__endTimestamp 04:33:37 INFO - PROCESS | 10737 | 04:33:37 INFO - PROCESS | 10737 | ------- Summary: start ------- 04:33:37 INFO - PROCESS | 10737 | Number of tests: 14 04:33:37 INFO - PROCESS | 10737 | 04:33:37 INFO - PROCESS | 10737 | [#0] ai-astar Cycles:10 Average:110.10 Median:111.00 stddev:2.28 (2.1%) stddev-sans-first:2.42 04:33:37 INFO - PROCESS | 10737 | Values: 110.0 104.0 110.0 111.0 112.0 111.0 110.0 110.0 111.0 112.0 04:33:37 INFO - PROCESS | 10737 | 04:33:37 INFO - PROCESS | 10737 | [#1] audio-beat-detection Cycles:10 Average:146.80 Median:155.00 stddev:21.73 (14.0%) stddev-sans-first:22.79 04:33:37 INFO - PROCESS | 10737 | Values: 156.0 123.0 134.0 164.0 128.0 161.0 154.0 125.0 190.0 133.0 04:33:37 INFO - PROCESS | 10737 | 04:33:37 INFO - PROCESS | 10737 | [#2] audio-dft Cycles:10 Average:160.20 Median:160.50 stddev:1.23 (0.8%) stddev-sans-first:1.22 04:33:37 INFO - PROCESS | 10737 | Values: 159.0 159.0 162.0 159.0 161.0 160.0 162.0 161.0 160.0 159.0 04:33:37 INFO - PROCESS | 10737 | 04:33:37 INFO - PROCESS | 10737 | [#3] audio-fft Cycles:10 Average:84.00 Median:74.50 stddev:19.57 (26.3%) stddev-sans-first:20.48 04:33:37 INFO - PROCESS | 10737 | Values: 75.0 74.0 74.0 124.0 76.0 76.0 75.0 74.0 118.0 74.0 04:33:37 INFO - PROCESS | 10737 | 04:33:37 INFO - PROCESS | 10737 | [#4] audio-oscillator Cycles:10 Average:95.10 Median:84.00 stddev:18.16 (21.6%) stddev-sans-first:18.81 04:33:37 INFO - PROCESS | 10737 | Values: 84.0 86.0 109.0 84.0 84.0 87.0 115.0 83.0 84.0 135.0 04:33:37 INFO - PROCESS | 10737 | 04:33:37 INFO - PROCESS | 10737 | [#5] imaging-gaussian-blur Cycles:10 Average:116.90 Median:117.00 stddev:0.74 (0.6%) stddev-sans-first:0.71 04:33:37 INFO - PROCESS | 10737 | Values: 116.0 117.0 116.0 116.0 117.0 117.0 117.0 117.0 118.0 118.0 04:33:37 INFO - PROCESS | 10737 | 04:33:37 INFO - PROCESS | 10737 | [#6] imaging-darkroom Cycles:10 Average:145.70 Median:146.00 stddev:0.48 (0.3%) stddev-sans-first:0.50 04:33:37 INFO - PROCESS | 10737 | Values: 146.0 146.0 146.0 146.0 146.0 145.0 146.0 145.0 146.0 145.0 04:33:37 INFO - PROCESS | 10737 | 04:33:37 INFO - PROCESS | 10737 | [#7] imaging-desaturate Cycles:10 Average:94.40 Median:94.50 stddev:0.52 (0.5%) stddev-sans-first:0.50 04:33:37 INFO - PROCESS | 10737 | Values: 95.0 94.0 95.0 94.0 94.0 94.0 94.0 95.0 95.0 94.0 04:33:37 INFO - PROCESS | 10737 | 04:33:37 INFO - PROCESS | 10737 | [#8] json-parse-financial Cycles:10 Average:54.50 Median:54.50 stddev:1.08 (2.0%) stddev-sans-first:1.13 04:33:37 INFO - PROCESS | 10737 | Values: 54.0 57.0 55.0 54.0 54.0 54.0 54.0 55.0 53.0 55.0 04:33:37 INFO - PROCESS | 10737 | 04:33:37 INFO - PROCESS | 10737 | [#9] json-stringify-tinderbox Cycles:10 Average:62.60 Median:63.00 stddev:0.52 (0.8%) stddev-sans-first:0.50 04:33:37 INFO - PROCESS | 10737 | Values: 62.0 63.0 62.0 63.0 63.0 63.0 62.0 62.0 63.0 63.0 04:33:37 INFO - PROCESS | 10737 | 04:33:37 INFO - PROCESS | 10737 | [#10] stanford-crypto-aes Cycles:10 Average:84.30 Median:81.00 stddev:9.67 (11.9%) stddev-sans-first:10.26 04:33:37 INFO - PROCESS | 10737 | Values: 85.0 81.0 78.0 79.0 85.0 83.0 80.0 80.0 111.0 81.0 04:33:37 INFO - PROCESS | 10737 | 04:33:37 INFO - PROCESS | 10737 | [#11] stanford-crypto-ccm Cycles:10 Average:124.50 Median:124.50 stddev:4.33 (3.5%) stddev-sans-first:4.59 04:33:37 INFO - PROCESS | 10737 | Values: 124.0 129.0 121.0 121.0 131.0 122.0 121.0 120.0 131.0 125.0 04:33:37 INFO - PROCESS | 10737 | 04:33:37 INFO - PROCESS | 10737 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:158.80 Median:158.50 stddev:3.05 (1.9%) stddev-sans-first:1.80 04:33:37 INFO - PROCESS | 10737 | Values: 166.0 160.0 160.0 157.0 161.0 157.0 157.0 157.0 156.0 157.0 04:33:37 INFO - PROCESS | 10737 | 04:33:37 INFO - PROCESS | 10737 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:62.60 Median:63.00 stddev:1.43 (2.3%) stddev-sans-first:1.51 04:33:37 INFO - PROCESS | 10737 | Values: 63.0 64.0 63.0 63.0 62.0 61.0 65.0 62.0 63.0 60.0 04:33:37 INFO - PROCESS | 10737 | -------- Summary: end -------- 04:33:37 INFO - PROCESS | 10737 | 04:33:38 INFO - TEST-INFO | 10737: exit 0 04:33:38 INFO - TEST-OK | kraken | took 62000ms 04:33:38 INFO - SUITE-END | took 1177s 04:33:38 INFO - Completed test suite (00:19:37) 04:33:38 INFO - javascript benchmark 04:33:38 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3141.890033848815, 3164.9208769780766, 3192.792468489549, 3211.839408029598, 3247.951280730788, 5285.841424757254, 5370.43610420905, 5456.508914197721, 5546.4453554644515, 5593.244911936888, 5351.25082488452, 5356.785728570852, 5484.670919744818, 5505.421930697279, 5526.088195447756, 4824.87937801556, 4890.951090489103, 4909.288153217782, 4920.68015578988, 5042.067217564744, 4960.627952903528, 4980.601551875841, 5000.374953130859, 5014.8244811431605, 5059.038782631306, 4790.832320868771, 4844.297576851354, 4908.901821963576, 4967.577755890754, 4997.625178111638, 4901.338319326881, 4931.43288521821, 4931.67944083637, 5014.774335154927, 5023.974880125613, 4931.161702510546, 4952.777125029383, 4976.800927962913, 4978.103941290567, 5022.17134172861, 5234.371875374942, 5308.469153084699, 5395.649282796645, 5428.647137936022, 5444.891102177974, 5925.585209035369, 5948.494377977877, 5954.345022047572, 5970.283565972068, 5972.790952316692, 5901.4098590141075, 5983.910241346383, 5984.3417224105315, 5986.102084687332, 6008.639481631116, 5275.050490911634, 5443.646162999393, 5474.863128421742, 5477.068898287341, 5600.831975040755, 6063.151158837766, 6068.779501011499, 6069.36271691466, 6071.551513397757, 6081.745283254246, 5863.413658634103, 5877.647341159544, 5889.5877288590245, 5891.116332550152, 5899.410058994152, 5650.152477128464, 5786.3056433228285, 5854.912176317359, 5855.824325270249, 5912.940870591239, 5870.5890587659305, 5878.059510478303, 5880.26496687914, 5880.882382352329, 5883.2057672213705, 5668.914966275509, 5859.882802343929, 5911.527077833849, 5914.112883067574, 5917.704114794243, 4306.138772245564, 4407.669424793154, 4432.955670443319, 4442.378067070613, 4465.531119232499, 3953.1105501261986, 3962.841486340514, 3963.6829053675638, 3999.0202400411504, 4009.1781184857036, 5338.46615338463, 5518.255035570227, 5530.308711411074, 5539.473749993744, 5543.1408131739645, 5845.795397161079, 5897.144913987534, 5911.349751527328, 5985.581009329392, 6016.879662406727, 5551.056320425538, 5551.639143455663, 5551.8889622208135, 5555.583331250173, 5557.972210138923, 5090.160123579642, 5100.336956195671, 5100.948990510122, 5101.362329708786, 5135.4094279157625, 5842.912356314659, 6005.069214271794, 6081.513478921675, 6100.847478813065, 6151.046587778901, 5956.404359564009, 5956.672383018976, 5957.821265362046, 5961.2846458425265, 5962.433568810956, 5825.533957283323, 6073.908891366721, 6117.0, 6132.693365331626, 6147.784827531015, 5733.569982251264, 5752.884942301047, 5785.132230165509, 5821.126830975388, 5832.212651292021, 5883.705814709333, 5922.289325280822, 5923.674197919156, 5925.081612350093, 5926.1999630049395, 5521.420250873761, 5679.574031947538, 5751.367349591458, 5755.424457554379, 5756.68338241384, 5729.083346664514, 5780.306363236438, 5798.1302804579655, 5803.390643982321, 5850.531957443309, 5680.517156041783, 5700.543956483389, 5701.6864072474755, 5704.543636509153, 5705.515031222227, 5538.833834984957, 5685.630434021776, 5799.652020878761, 5819.5053420459735, 5851.239338886088, 5405.675659460445, 5447.373552041566, 5558.777648894161, 5607.99056169877, 5658.20785090096], "value": 5403.975904762236, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [574.7528562718032, 609.9417510619077, 628.2649300318627, 635.9046143078538, 639.4724352409263, 33884.491732624, 41792.16415671685, 43192.0, 43289.0, 43330.35004474936, 44440.55559444405, 45053.62097842659, 45056.54943450564, 45104.09791804162, 45189.548104518944, 8047.356211503065, 8547.829043419128, 8731.781705457352, 10511.159107271438, 10808.459577021156, 10222.284440089197, 10651.627193048245, 10654.4140072296, 10655.680329590125, 10664.573417063308, 10678.199135064862, 10682.465876706172, 10686.0, 10754.462276886163, 10762.73093172673, 10628.681139565826, 10690.51892664832, 10697.358158510475, 10700.78598428027, 10723.571057157704, 10622.0, 10718.303310284806, 10721.303115297558, 10725.51735171919, 10730.839037414446, 43369.78315108404, 43742.78128609368, 43778.78110609426, 44038.0, 44051.0, 3469.4275444551618, 3877.321468742987, 4169.4162817205615, 4214.873553793391, 4283.550227226127, 33636.32727345464, 33687.157821054425, 33869.32261354759, 34777.0, 35125.12187195315, 4234.6823988201, 4319.827206911751, 4362.454693163355, 4371.388005679208, 4380.167768124046, 361640.0, 364941.0, 365340.0, 366174.0, 368491.0, 65644.0, 65713.0, 65790.0, 66037.0, 66041.0, 70677.2932270681, 70776.0, 70780.2921970784, 70796.29203707897, 70856.291437086, 16929.576760581083, 17392.3043078278, 17501.47495575135, 17540.824591754175, 17559.122043897754, 13193.274369909746, 13306.800397994039, 13314.667133321744, 13319.800202996963, 13320.267385293708, 20070.19719211215, 20775.480612984797, 20803.271885483937, 20814.66965285547, 20974.685379719318, 7519.8120046998165, 7707.768766937001, 7770.222977702185, 7780.688772449039, 7801.882971755428, 1023.2785885950387, 1064.8775390830153, 1156.329328989201, 1157.4350998923296, 1160.7178227627448, 32950.50574241388, 32957.50563741546, 32977.67022329794, 32986.83506582452, 33621.83189084039, 950.7052813627797, 1093.6281664234039, 1158.9362585057902, 1163.2613290560387, 1197.2935967778878, 16213.513594592181, 16755.83244167567, 16859.325626975027, 17011.744823827652, 17204.483865484057, 493518.0, 493547.0, 497322.0, 497345.0, 499128.0, 58574.7071264641, 59239.40760592339, 59258.40741592529, 59295.703521482115, 59352.70323648354, 1299.0452017766934, 1371.5268232459784, 1384.349355802771, 1409.239010934084, 1421.5948454690363, 32668.83665581657, 33504.664953350155, 33911.15222119368, 33932.64269429195, 34191.82904085464, 50230.748846255534, 50458.49541504538, 50537.74731126468, 50676.74661626668, 50701.74649126879, 379510.0, 380910.0, 381564.0, 382628.0, 382666.0, 33993.320133596695, 43690.78154609207, 44661.776691116334, 47357.52642473669, 48028.519714803806, 48904.75547622239, 48975.26537102018, 49160.508394915596, 50141.0, 50226.97730226948, 39959.80020099881, 41359.586404135574, 41649.79175104226, 42435.15129697327, 42443.57556424396, 40614.0, 40980.59019409768, 42106.36840447457, 42238.366424504275, 42796.14407711891, 41327.79336103421, 42015.15969680528, 42733.931651708954, 42762.0, 45576.544234558554, 33254.5011824818, 36425.15505755005, 36965.815170923976, 39399.21201575895, 39907.60092399039, 28381.858090709415, 28400.85799570989, 28492.0, 28637.0, 28655.283617908884], "value": 21326.853260137334, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [379.7607507270419, 384.181692993923, 393.37649825027347, 395.28848073467753, 409.54540460089316, 17857.553561160978, 19584.41246762596, 20370.490737731565, 20390.184392624295, 20390.796092039076, 18610.441686749386, 18625.161867715953, 19366.0, 19850.106745196466, 19881.801181988176, 5381.704006279653, 5494.80768173114, 5608.46719561641, 5718.399568045358, 5852.853678658025, 5841.824745257628, 5864.23764910561, 5867.031939729939, 5885.764569417218, 5890.087036509348, 5457.181422786594, 5749.683767392792, 5750.942490575104, 5852.151438041481, 5853.473187413132, 5747.051736463479, 5755.2230448889495, 5764.365919748824, 5767.307923049261, 5791.5656325775735, 5417.945820541783, 5663.037283661787, 5674.177244299594, 5675.290588676416, 5677.574181936371, 13242.271675057867, 13507.594772156754, 14656.0, 22560.43598910024, 23155.073797048266, 2248.9212877549207, 2351.4356554426986, 2394.1022116706235, 2407.037185125946, 2682.5305571524905, 9401.388909720847, 10305.84541231882, 10543.578256869716, 11991.880081199251, 14105.435782568686, 1859.172668162668, 1885.4155211884222, 1888.0842791246234, 1889.1970912362192, 1908.7232351309121, 78726.0, 82927.0, 82957.0, 83992.58003710004, 85846.57076714639, 10654.0, 10866.239363244655, 10894.61868834587, 11142.944285278521, 11321.830172547254, 15382.230888455757, 15425.228738563026, 15443.536693899201, 15463.458778942682, 15464.613384665474, 8081.151479094728, 8242.56080720666, 8277.62750676209, 8386.790330241793, 8430.156984301644, 7886.171951945078, 7939.126696063428, 8038.638261278256, 8069.556174410463, 8124.431289809657, 4691.7184968901975, 4724.740139292372, 4763.333133361332, 4771.5467030632035, 4836.492168322346, 1950.5416227186884, 1975.4468748750373, 1995.720599116125, 2018.3137733170793, 2021.9797802022085, 856.0497847389518, 1040.4745603470199, 1064.5156453813497, 1066.4987455895716, 1087.475623830937, 18782.53043673919, 19015.33446329372, 19262.71105933412, 19958.20167193325, 19979.38318883328, 991.9779604497087, 1012.625393452353, 1026.5688410867454, 1059.3379138038727, 1101.6529793115303, 10485.117514169024, 11124.551389069415, 11184.60853870127, 11194.832077518844, 11260.268082574607, 349577.0, 354647.0, 440325.0, 447775.0, 451108.0, 103258.0, 103264.0, 105624.47187764011, 107533.0, 108394.0, 1015.2994433840627, 1027.9588816447258, 1059.3114475590928, 1068.5565490321585, 1082.626493859617, 17804.46586602404, 18094.5476363092, 18333.724994124834, 18347.35784247545, 18724.625507490047, 41875.58124418717, 43097.78451107725, 43118.56881431145, 43252.56747432485, 43916.341254880565, 59983.40016599778, 61019.0, 62255.0, 62426.37573624387, 62770.37229627645, 8509.702160424355, 8546.829063418822, 8561.22948934599, 8621.913780862362, 8729.738107856774, 9249.630014799333, 13424.89167428837, 13626.93186534061, 13636.79544806809, 14054.0, 11826.940865295619, 11989.160758746804, 12032.75934481288, 12034.819477708017, 12278.631641050782, 11540.711482213012, 11645.359505227294, 11655.708607284547, 11666.824997624874, 11979.580714674945, 11921.165518413627, 12147.696307592381, 12269.447874845475, 12353.135280530276, 12752.42614082387, 8614.18165274298, 8627.137286271323, 8630.956845215735, 8789.296856251356, 8921.15249051339, 11057.855192618043, 12280.815787763013, 12421.689457763629, 12461.190022648861, 12551.246925184518], "value": 9299.655835988093, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1387.3063468265866, 1495.932683029264, 1527.6257316957347, 1703.3612395351743, 1857.9535511612207, 8617.612207450664, 8915.286777057836, 8955.910440895588, 9191.494467804268, 9211.0, 8911.331650126234, 9111.863322050174, 9117.452952822836, 9121.17909388155, 9131.223845973083, 2055.403932859469, 2264.8188144948363, 2339.415146213447, 2347.2958112566203, 2371.407148212938, 2381.868997205153, 2389.139909632531, 2390.2948630154146, 2391.1391898916377, 2395.3891757601873, 2373.098222675381, 2385.1294277588727, 2413.8310318277727, 2421.2615152378517, 2422.6729391532094, 2020.8383329333617, 2240.260713964396, 2287.645414960667, 2346.753590872968, 2356.1871154451687, 2317.7450480447137, 2323.6979192705007, 2357.174988753922, 2358.068562917655, 2361.3388251289666, 9042.095790420972, 9055.864162037575, 9068.727938161866, 9069.410488318239, 9076.18314351705, 5250.343707036621, 5361.946380536184, 5366.812161574326, 5374.516293533562, 5389.730513474311, 3261.5433839262287, 3285.211549228192, 3371.96628033719, 3401.8299085045896, 3492.353914525821, 1041.1202533858877, 1061.4321338084164, 1069.1874175626501, 1095.5015467962137, 1095.616534213027, 12888.80666789999, 12899.806502902464, 12931.806022909665, 12955.222686638832, 12989.155704879247, 4644.140833945731, 4672.252439609714, 4779.928301075487, 4780.020095880336, 4784.832530861403, 10620.468976551141, 10677.679669609925, 10682.62610808618, 10685.755991241926, 10689.679309620724, 5395.352557693023, 5414.377346605112, 5422.8915421691345, 5432.29380180574, 5441.483059109379, 4356.803943822536, 4845.75771211438, 5006.4492905780335, 5049.6465247432325, 5100.1074811907765, 4048.514178298623, 4070.0792563017676, 4169.937450938239, 4173.373993900939, 4195.035141917376, 1246.6696325473756, 1251.956181533642, 1296.572131196703, 1303.0878385130447, 1307.2940612069376, 855.1130290390448, 905.8550631898864, 944.2587568758491, 990.6037584966072, 1038.382162613244, 6147.907781383283, 6487.318831522716, 6535.281119076898, 6573.1454910861285, 6619.900701489481, 442.10473790574343, 442.17975655159216, 449.22732899412955, 459.6322941646669, 460.6545091181614, 4217.97891010543, 4262.403263543107, 4355.542668019875, 4415.249407600716, 4426.402435671208, 11102.555897764, 11471.139664525193, 11499.885001150049, 11574.421278936019, 11585.0, 11210.327380357041, 11317.547298107984, 11322.32066076038, 11349.375784331776, 11359.261647992855, 7939.087004994384, 8203.58982050907, 8228.958855205685, 8308.003039635283, 8505.702300419456, 5740.339860915881, 6061.878762424815, 6140.385961403824, 6204.565680402328, 6397.520185986163, 9762.60949562038, 9893.159081477866, 10126.59493620247, 10147.086762191439, 10166.644167454104, 10033.698989030048, 10231.641892533726, 10282.280240383101, 10315.329503582243, 10332.948335258276, 7577.1665116836, 7671.0, 8434.03008653988, 8587.699430519902, 8845.380823342304, 8491.915080849112, 8512.574371281287, 8598.742037738877, 8600.78498037554, 8629.611667475105, 7256.7460138894885, 7488.475806693479, 7563.697452101855, 7580.0, 7641.312281894656, 7330.780076597711, 7601.0878694557005, 7628.847423051397, 7684.923150768421, 7757.340626046849, 6876.621785801829, 6926.411255043377, 6969.059177011039, 6970.059042029464, 6970.930290697028, 5206.453322401245, 5261.184516399964, 5271.367435907562, 5407.080796264566, 5424.213489044146, 5122.718250496258, 5505.587080969023, 5582.162675598693, 5713.057345538106, 5779.2775903012125], "value": 4634.142567396566, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [325.4776084384563, 326.1454987931619, 336.05233242256844, 336.45662255457427, 339.25194945145955, 5296.470352964707, 5353.812616558421, 5357.0, 5357.937194180239, 5390.1914712793105, 5247.370315562138, 5267.656747529384, 5271.288376069229, 5284.735763211843, 5294.497022782839, 3992.1616460543246, 4042.4744783178144, 4150.086980864205, 4158.958410415902, 4170.39529268256, 4165.375193720935, 4182.0, 4187.1625674865, 4200.453940987667, 4202.453681021463, 4003.939940900889, 4163.333866581347, 4164.208800327928, 4166.749995000295, 4170.812313445902, 4044.3529035354495, 4077.6533994610495, 4098.0, 4116.958830411702, 4161.56303588122, 3647.252313275772, 3665.193657395369, 3681.37416639172, 3689.6494832991093, 3689.8893033209047, 5012.423571289312, 5084.491550844923, 5084.491550844923, 5095.847124586268, 5111.591072714211, 4586.3579098926175, 4723.929141062887, 4745.881352966204, 4755.762211889391, 4778.2115950868065, 5500.862478438031, 5558.77764889408, 5560.054790685593, 5562.582806289544, 5574.804881829116, 3823.847046118152, 3985.3822657487844, 4057.8173982170874, 4063.1061166543313, 4063.9390409143884, 5797.130430435426, 5801.7099145042575, 5805.941940580582, 5816.185733997244, 5845.444682755132, 4063.776492292893, 4068.4100805383055, 4073.103917138225, 4086.366613174963, 4087.7532352632734, 3863.36254518007, 4111.465509483748, 4127.4634297541725, 4128.752274863517, 4130.669546436278, 4667.533246675305, 4698.389209402824, 4700.153972285021, 4703.882402939954, 4706.435227772689, 5632.633878797865, 5636.267285252891, 5643.322801263875, 5648.51987581052, 5657.0, 1344.1128854955878, 1408.8732014118777, 1416.5891891351598, 1421.722764060998, 1424.5896562403354, 902.5081330674798, 908.9181973622406, 909.3816204980544, 913.5660561233361, 949.6581230756922, 5313.681179129265, 5315.335583052119, 5323.855371095233, 5353.9732301338245, 5373.65071270374, 5745.735938093612, 5755.740991655385, 5758.0, 5762.9135562966585, 5763.7982670606325, 5074.695518268915, 5245.97703447824, 5291.365036195682, 5354.491323324278, 5364.436734142937, 3002.0, 3006.969930300669, 3031.9393612128074, 3036.9392612147635, 3037.772167087433, 5826.213461182686, 5828.834233153301, 5842.912356314659, 5860.472557469848, 5860.765569377262, 5599.832005039855, 5858.50202732764, 5895.734691938873, 5906.633219065092, 5910.670099227726, 5873.970630146822, 5890.9410905891245, 5900.734466948998, 5927.496162826208, 5931.792387266425, 5532.197831314517, 5768.769249229984, 5773.566982476415, 5786.582287339629, 5807.390224026416, 5603.243562119224, 5684.971575142098, 5703.230063941481, 5727.4845263926445, 5744.626599271034, 5896.498797602252, 5929.22123362998, 5930.7924222652, 5936.970315148396, 5938.584299099021, 3852.6725228355904, 4048.554658987568, 4052.777097259679, 4073.6537394321813, 4084.8978775529663, 5666.886662266649, 5679.642948176461, 5681.176229446624, 5717.628354156966, 5719.48524632785, 5357.812476563302, 5457.972710136424, 5563.916541251803, 5573.300143456285, 5609.943900561106, 5471.644343117685, 5490.3411590609385, 5492.681756378521, 5573.944260557342, 5582.218489411404, 5205.45342739007, 5368.302120724281, 5374.355077390738, 5400.9459905400445, 5456.236126942152, 5635.8591035224445, 5658.688772117573, 5660.264165658438, 5662.490375866192, 5667.376588575171, 5445.53712934405, 5467.753951072132, 5475.863103422446, 5515.724213789214, 5519.668819870821], "value": 4241.370911340353, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [784.5724080376194, 818.2390376949437, 847.5423271433426, 850.188070392775, 858.8325276571068, 15339.156346400958, 15548.144852033134, 15585.29866156023, 16027.439039633615, 16139.0, 14259.643508912282, 14281.92859035706, 14401.27993600321, 14416.135031898093, 14428.35072421741, 682.9897551536731, 801.4550105927966, 803.1606970715587, 823.7158180427773, 829.655692887451, 817.7056259746487, 818.5702506184241, 818.5907046476761, 818.8198596308803, 819.9549024803633, 862.6808081010004, 865.5369377383101, 865.5455885660016, 866.2333834556431, 866.9436486628349, 701.3582571946663, 833.0628043451118, 853.5561508015797, 853.5774791478227, 861.7543999960012, 624.4692011789942, 624.9781257656006, 625.4527288622455, 625.6871564217892, 626.2672672972633, 14942.925285373503, 15044.699106017928, 15045.172515511642, 15046.699066018728, 15064.322105505169, 14165.291735413188, 14531.636709082357, 14554.563363099123, 14594.270286485633, 14767.335469903881, 12375.566855160116, 12656.303903285316, 12740.108192426535, 13025.609231723063, 13088.0, 4435.146443514664, 4500.257457519506, 4525.70582912113, 4557.473246462439, 4694.342792009122, 68706.0, 68764.31235687679, 70514.0, 72324.0, 72542.27457725408, 11517.596884109016, 11600.6519804406, 11694.181407301407, 11763.0, 11793.351365674798, 21511.67732484014, 21590.568188636138, 21601.67597486039, 21632.35102946914, 21646.675299870516, 8184.920417465908, 8332.16678332174, 8385.706500272461, 8634.611442485104, 8817.426867253607, 4662.860114196579, 4773.0, 4816.301636262722, 4829.492903245108, 4971.90056198874, 3602.495650608917, 3716.9442458363146, 3720.8511659533856, 3724.217914237986, 3728.6084961078695, 599.9760009599568, 610.4170517156106, 616.808789275326, 646.3342756960338, 646.3988490703597, 633.3096924352386, 682.8258794007496, 707.7558242406361, 713.6360456167392, 740.4594645908517, 9910.504474776233, 10090.747731306776, 10185.592576296865, 10240.64157754475, 10326.22553308505, 603.8430008197901, 605.9272887253558, 627.6140173793176, 644.9970296189376, 766.1419210484294, 4457.531959144243, 4660.39414876064, 4669.4630117536235, 4694.0, 4869.63477739171, 73047.0, 120900.3954980237, 122099.0, 129824.3508782469, 130504.0, 76604.0, 104515.0, 106846.0, 106977.46511267393, 110368.4481577587, 53068.73465632647, 63043.05435418472, 71590.0, 82103.0, 83808.8484261314, 9862.753431164278, 10315.742106447098, 10366.5335059924, 10496.68509944703, 10571.2600117991, 38247.0, 40341.39487907742, 43166.136677266906, 44543.55456445524, 44886.3267051001, 52769.736151319, 58875.11687324779, 74756.62621687075, 75468.0, 75484.0, 12592.244465331743, 12639.431225595054, 12777.93611031939, 13149.868501315246, 13733.107348022746, 14012.159270443806, 14364.281785910454, 14707.485238016618, 14797.0, 15421.768673469682, 13761.17432954026, 13951.162930224218, 13988.792714769028, 14364.35360408805, 14638.194899280215, 13359.53241636577, 14007.859921400655, 14190.2195379251, 14394.640133996734, 14845.554633361016, 12310.815337769762, 12423.937880310541, 12769.489220431451, 13585.909731736845, 13749.656258593615, 10859.782804344028, 11009.339439633648, 11082.889171108509, 11174.329540227613, 11560.710982225175, 10710.241868306735, 11568.363739994382, 12079.939600301943, 12174.634760957186, 12269.681950636419], "value": 7541.263904315776, "unit": "score"}], "name": "dromaeo_css", "value": 7359.454904646058, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [110.0, 104.0, 110.0, 111.0, 112.0, 111.0, 110.0, 110.0, 111.0, 112.0], "value": 110.1, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [156.0, 123.0, 134.0, 164.0, 128.0, 161.0, 154.0, 125.0, 190.0, 133.0], "value": 146.8, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [159.0, 159.0, 162.0, 159.0, 161.0, 160.0, 162.0, 161.0, 160.0, 159.0], "value": 160.2, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 74.0, 74.0, 124.0, 76.0, 76.0, 75.0, 74.0, 118.0, 74.0], "value": 84.0, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 86.0, 109.0, 84.0, 84.0, 87.0, 115.0, 83.0, 84.0, 135.0], "value": 95.1, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [116.0, 117.0, 116.0, 116.0, 117.0, 117.0, 117.0, 117.0, 118.0, 118.0], "value": 116.9, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 146.0, 146.0, 146.0, 146.0, 145.0, 146.0, 145.0, 146.0, 145.0], "value": 145.7, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 94.0, 95.0, 94.0, 94.0, 94.0, 94.0, 95.0, 95.0, 94.0], "value": 94.4, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [54.0, 57.0, 55.0, 54.0, 54.0, 54.0, 54.0, 55.0, 53.0, 55.0], "value": 54.5, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [62.0, 63.0, 62.0, 63.0, 63.0, 63.0, 62.0, 62.0, 63.0, 63.0], "value": 62.6, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 81.0, 78.0, 79.0, 85.0, 83.0, 80.0, 80.0, 111.0, 81.0], "value": 84.3, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [124.0, 129.0, 121.0, 121.0, 131.0, 122.0, 121.0, 120.0, 131.0, 125.0], "value": 124.5, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [166.0, 160.0, 160.0, 157.0, 161.0, 157.0, 157.0, 157.0, 156.0, 157.0], "value": 158.8, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [63.0, 64.0, 63.0, 63.0, 62.0, 61.0, 65.0, 62.0, 63.0, 60.0], "value": 62.6, "unit": "score"}], "name": "kraken", "value": 1500.4999999999998, "alertThreshold": 2.0}]} 04:33:38 INFO - Return code: 0 04:33:38 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 04:33:38 ERROR - # TBPL SUCCESS # 04:33:38 INFO - Running post-action listener: _resource_record_post_action 04:33:38 INFO - ##### 04:33:38 INFO - ##### Finished run-tests step (success) 04:33:38 INFO - ##### 04:33:38 INFO - Running post-run listener: _resource_record_post_run 04:33:38 INFO - Total resource usage - Wall time: 1196s; CPU: 13.0%; Read bytes: 0; Write bytes: 541777920; Read time: 0; Write time: 1077792 04:33:38 INFO - TinderboxPrint: CPU usage
13.2% 04:33:38 INFO - TinderboxPrint: I/O read bytes / time
0 / 0 04:33:38 INFO - TinderboxPrint: I/O write bytes / time
541,777,920 / 1,077,792 04:33:38 INFO - TinderboxPrint: CPU idle
8,284.5 (86.8%) 04:33:38 INFO - TinderboxPrint: CPU user
1,206.7 (12.6%) 04:33:38 INFO - TinderboxPrint: Swap in / out
0 / 0 04:33:38 INFO - install - Wall time: 17s; CPU: 17.0%; Read bytes: 0; Write bytes: 249094144; Read time: 0; Write time: 773444 04:33:38 INFO - run-tests - Wall time: 1179s; CPU: 13.0%; Read bytes: 0; Write bytes: 292683776; Read time: 0; Write time: 304348 04:33:39 INFO - Running post-run listener: _upload_blobber_files 04:33:39 INFO - Blob upload gear active. 04:33:39 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 04:33:39 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 04:33:39 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Firefox', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 04:33:39 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Firefox -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 04:33:39 INFO - (blobuploader) - INFO - Open directory for files ... 04:33:39 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 04:33:39 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:33:39 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:33:43 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 04:33:43 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:33:43 INFO - (blobuploader) - INFO - Done attempting. 04:33:43 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 04:33:43 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:33:43 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:33:44 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 04:33:44 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:33:44 INFO - (blobuploader) - INFO - Done attempting. 04:33:44 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 04:33:44 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:33:44 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:33:45 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 04:33:45 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:33:45 INFO - (blobuploader) - INFO - Done attempting. 04:33:45 INFO - (blobuploader) - INFO - Iteration through files over. 04:33:45 INFO - Return code: 0 04:33:45 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 04:33:45 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 04:33:45 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/eae72f564de5008d91d39ad8b6e60a71c8c5f54d6b896bead3e66ada941eff699d1e7d3e8e6e7960ef468eb117a0632cd9ec5b8be7fa4949ff05e8c5a73ea1cd", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/3d5a602f4c7e12892f52e3794e55cdd942dd503bccae1c72db9554e35dc12c226f3b34c9a4b2883a335b826bd832892fb390003624a07edf21027494ebe6332c", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/2dd9a200edea819ce8f092dc6a236f821f7c1abfc0e66f2100248eabda622528798dd1d37fbe6685ded914c328757522486bef21f3bdfe6f63f14babd0f27529"} 04:33:45 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 04:33:45 INFO - Writing to file /builds/slave/test/properties/blobber_files 04:33:45 INFO - Contents: 04:33:45 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/eae72f564de5008d91d39ad8b6e60a71c8c5f54d6b896bead3e66ada941eff699d1e7d3e8e6e7960ef468eb117a0632cd9ec5b8be7fa4949ff05e8c5a73ea1cd", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/3d5a602f4c7e12892f52e3794e55cdd942dd503bccae1c72db9554e35dc12c226f3b34c9a4b2883a335b826bd832892fb390003624a07edf21027494ebe6332c", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/2dd9a200edea819ce8f092dc6a236f821f7c1abfc0e66f2100248eabda622528798dd1d37fbe6685ded914c328757522486bef21f3bdfe6f63f14babd0f27529"} 04:33:45 INFO - Running post-run listener: copy_logs_to_upload_dir 04:33:45 INFO - Copying logs to upload dir... 04:33:45 INFO - mkdir: /builds/slave/test/build/upload/logs 04:33:45 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1286.386169 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 26 secs) (at 2016-06-04 04:33:45.346509) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-04 04:33:45.349895) ========= 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=df17445c3590ff7897617a0e00000225-1465037577.256341-43850869 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/eae72f564de5008d91d39ad8b6e60a71c8c5f54d6b896bead3e66ada941eff699d1e7d3e8e6e7960ef468eb117a0632cd9ec5b8be7fa4949ff05e8c5a73ea1cd", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/3d5a602f4c7e12892f52e3794e55cdd942dd503bccae1c72db9554e35dc12c226f3b34c9a4b2883a335b826bd832892fb390003624a07edf21027494ebe6332c", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/2dd9a200edea819ce8f092dc6a236f821f7c1abfc0e66f2100248eabda622528798dd1d37fbe6685ded914c328757522486bef21f3bdfe6f63f14babd0f27529"} build_url:https://queue.taskcluster.net/v1/task/YHdGyUxeQdCa1aVHz9KeXw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011576 build_url: 'https://queue.taskcluster.net/v1/task/YHdGyUxeQdCa1aVHz9KeXw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/eae72f564de5008d91d39ad8b6e60a71c8c5f54d6b896bead3e66ada941eff699d1e7d3e8e6e7960ef468eb117a0632cd9ec5b8be7fa4949ff05e8c5a73ea1cd", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/3d5a602f4c7e12892f52e3794e55cdd942dd503bccae1c72db9554e35dc12c226f3b34c9a4b2883a335b826bd832892fb390003624a07edf21027494ebe6332c", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/2dd9a200edea819ce8f092dc6a236f821f7c1abfc0e66f2100248eabda622528798dd1d37fbe6685ded914c328757522486bef21f3bdfe6f63f14babd0f27529"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-04 04:33:45.374819) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-04 04:33:45.375122) ========= 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=df17445c3590ff7897617a0e00000225-1465037577.256341-43850869 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004459 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-04 04:33:45.457142) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-04 04:33:45.457458) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-04 04:33:45.457759) ========= ========= Total master_lag: 0.18 =========