builder: mozilla-inbound_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-001 starttime: 1463073201.87 results: success (0) buildid: 20160512073659 builduid: ed9d529ff5854bcdb4dda57b7c086c67 revision: 70dc1787f866ac056bbe3d01eda5a039c41ad74f ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-05-12 10:13:21.872127) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-05-12 10:13:21.872582) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-05-12 10:13:21.872886) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-05-12 10:13:21.915877) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-05-12 10:13:21.916266) ========= 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=8887e36bb8e381bfd44124ac000001a8-1463073025.835199-1380263536 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-05-12 10:13:22-- 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% 87.4M=0s 2016-05-12 10:13:22 (87.4 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.083364 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-05-12 10:13:22.013284) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-05-12 10:13:22.013614) ========= 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=8887e36bb8e381bfd44124ac000001a8-1463073025.835199-1380263536 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.018074 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-05-12 10:13:22.063812) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-05-12 10:13:22.064181) ========= bash -c 'python archiver_client.py mozharness --repo integration/mozilla-inbound --rev 70dc1787f866ac056bbe3d01eda5a039c41ad74f --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/mozilla-inbound --rev 70dc1787f866ac056bbe3d01eda5a039c41ad74f --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=8887e36bb8e381bfd44124ac000001a8-1463073025.835199-1380263536 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-05-12 10:13:22,252 truncating revision to first 12 chars 2016-05-12 10:13:22,252 Setting DEBUG logging. 2016-05-12 10:13:22,252 attempt 1/10 2016-05-12 10:13:22,252 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/mozilla-inbound/70dc1787f866?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-05-12 10:13:23,126 unpacking tar archive at: mozilla-inbound-70dc1787f866/testing/mozharness/ program finished with exit code 0 elapsedTime=1.187773 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-05-12 10:13:23.266560) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-05-12 10:13:23.266908) ========= script_repo_revision: 70dc1787f866ac056bbe3d01eda5a039c41ad74f ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-05-12 10:13:23.267356) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-05-12 10:13:23.267649) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-05-12 10:13:23.276807) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 28 secs) (at 2016-05-12 10:13:23.277217) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Inbound --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Inbound in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Inbound', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Inbound'] 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=8887e36bb8e381bfd44124ac000001a8-1463073025.835199-1380263536 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 10:13:23 INFO - MultiFileLogger online at 20160512 10:13:23 in /builds/slave/test 10:13:23 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Inbound --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Inbound 10:13:23 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 10:13:23 INFO - {'append_to_log': False, 10:13:23 INFO - 'base_work_dir': '/builds/slave/test', 10:13:23 INFO - 'blob_upload_branch': 'Mozilla-Inbound', 10:13:23 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 10:13:23 INFO - 'branch': 'Mozilla-Inbound', 10:13:23 INFO - 'buildbot_json_path': 'buildprops.json', 10:13:23 INFO - 'config_files': ('talos/linux_config.py',), 10:13:23 INFO - 'default_actions': ('clobber', 10:13:23 INFO - 'read-buildbot-config', 10:13:23 INFO - 'download-and-extract', 10:13:23 INFO - 'populate-webroot', 10:13:23 INFO - 'create-virtualenv', 10:13:23 INFO - 'install', 10:13:23 INFO - 'run-tests'), 10:13:23 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 10:13:23 INFO - 'download_minidump_stackwalk': True, 10:13:23 INFO - 'download_symbols': 'ondemand', 10:13:23 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 10:13:23 INFO - 'tooltool.py': '/tools/tooltool.py', 10:13:23 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 10:13:23 INFO - '/tools/misc-python/virtualenv.py')}, 10:13:23 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 10:13:23 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 10:13:23 INFO - 'installer_path': 'installer.exe', 10:13:23 INFO - 'log_level': 'info', 10:13:23 INFO - 'log_name': 'talos', 10:13:23 INFO - 'log_to_console': True, 10:13:23 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 10:13:23 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 10:13:23 INFO - 'opt_config_files': (), 10:13:23 INFO - 'pip_index': False, 10:13:23 INFO - 'sps_profile': False, 10:13:23 INFO - 'sps_profile_interval': 0, 10:13:23 INFO - 'suite': 'dromaeojs-e10s', 10:13:23 INFO - 'system_bits': '32', 10:13:23 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 10:13:23 INFO - 'title': 'talos-linux64-ix-001', 10:13:23 INFO - 'tooltool_cache': '/builds/tooltool_cache', 10:13:23 INFO - 'use_talos_json': True, 10:13:23 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 10:13:23 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 10:13:23 INFO - 'work_dir': 'build'} 10:13:23 INFO - ##### 10:13:23 INFO - ##### Running clobber step. 10:13:23 INFO - ##### 10:13:23 INFO - Running pre-action listener: _resource_record_pre_action 10:13:23 INFO - Running main action method: clobber 10:13:23 INFO - rmtree: /builds/slave/test/build 10:13:23 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 10:13:24 INFO - Running post-action listener: _resource_record_post_action 10:13:24 INFO - ##### 10:13:24 INFO - ##### Finished clobber step (success) 10:13:24 INFO - ##### 10:13:24 INFO - ##### 10:13:24 INFO - ##### Running read-buildbot-config step. 10:13:24 INFO - ##### 10:13:24 INFO - Running pre-action listener: _resource_record_pre_action 10:13:24 INFO - Running main action method: read_buildbot_config 10:13:24 INFO - Using buildbot properties: 10:13:24 INFO - { 10:13:24 INFO - "project": "", 10:13:24 INFO - "product": "firefox", 10:13:24 INFO - "script_repo_revision": "production", 10:13:24 INFO - "builddir": "mozilla-inbound_ubuntu64_hw_test-dromaeojs-e10s", 10:13:24 INFO - "repository": "", 10:13:24 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-inbound pgo talos dromaeojs-e10s", 10:13:24 INFO - "buildid": "20160512073659", 10:13:24 INFO - "pgo_build": "True", 10:13:24 INFO - "basedir": "/builds/slave/test", 10:13:24 INFO - "buildnumber": 1016, 10:13:24 INFO - "slavename": "talos-linux64-ix-001", 10:13:24 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 10:13:24 INFO - "platform": "ubuntu64_hw", 10:13:24 INFO - "scheduler": "tests-mozilla-inbound-linux64-pgo-talos", 10:13:24 INFO - "branch": "mozilla-inbound", 10:13:24 INFO - "repo_path": "integration/mozilla-inbound", 10:13:24 INFO - "revision": "70dc1787f866ac056bbe3d01eda5a039c41ad74f", 10:13:24 INFO - "stage_platform": "linux64-pgo", 10:13:24 INFO - "builduid": "ed9d529ff5854bcdb4dda57b7c086c67", 10:13:24 INFO - "slavebuilddir": "test" 10:13:24 INFO - } 10:13:24 INFO - Found installer url https://queue.taskcluster.net/v1/task/BfYG2V16QFaaQ9tmX6zBbA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2. 10:13:24 INFO - Running post-action listener: _resource_record_post_action 10:13:24 INFO - ##### 10:13:24 INFO - ##### Finished read-buildbot-config step (success) 10:13:24 INFO - ##### 10:13:24 INFO - ##### 10:13:24 INFO - ##### Running download-and-extract step. 10:13:24 INFO - ##### 10:13:24 INFO - Running pre-action listener: _resource_record_pre_action 10:13:24 INFO - Running main action method: download_and_extract 10:13:24 INFO - mkdir: /builds/slave/test/build/tests 10:13:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:13:24 INFO - https://queue.taskcluster.net/v1/task/BfYG2V16QFaaQ9tmX6zBbA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 10:13:24 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BfYG2V16QFaaQ9tmX6zBbA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 10:13:24 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BfYG2V16QFaaQ9tmX6zBbA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 10:13:24 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BfYG2V16QFaaQ9tmX6zBbA/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 10:13:24 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BfYG2V16QFaaQ9tmX6zBbA/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 10:13:24 INFO - Downloaded 1361 bytes. 10:13:24 INFO - Reading from file /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 10:13:24 INFO - Using the following test package requirements: 10:13:24 INFO - {u'common': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'], 10:13:24 INFO - u'cppunittest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 10:13:24 INFO - u'firefox-49.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 10:13:24 INFO - u'gtest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 10:13:24 INFO - u'firefox-49.0a1.en-US.linux-x86_64.gtest.tests.zip'], 10:13:24 INFO - u'jittest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 10:13:24 INFO - u'jsshell-linux-x86_64.zip'], 10:13:24 INFO - u'mochitest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 10:13:24 INFO - u'firefox-49.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 10:13:24 INFO - u'mozbase': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'], 10:13:24 INFO - u'reftest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 10:13:24 INFO - u'firefox-49.0a1.en-US.linux-x86_64.reftest.tests.zip'], 10:13:24 INFO - u'talos': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 10:13:24 INFO - u'firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip'], 10:13:24 INFO - u'web-platform': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 10:13:24 INFO - u'firefox-49.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 10:13:24 INFO - u'xpcshell': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 10:13:24 INFO - u'firefox-49.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 10:13:24 INFO - Downloading packages: [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 10:13:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:13:24 INFO - https://queue.taskcluster.net/v1/task/BfYG2V16QFaaQ9tmX6zBbA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 10:13:24 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BfYG2V16QFaaQ9tmX6zBbA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 10:13:24 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BfYG2V16QFaaQ9tmX6zBbA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 10:13:24 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BfYG2V16QFaaQ9tmX6zBbA/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 10:13:24 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BfYG2V16QFaaQ9tmX6zBbA/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 10:13:25 INFO - Downloaded 23907276 bytes. 10:13:25 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'] 10:13:25 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 10:13:26 INFO - Return code: 0 10:13:26 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 10:13: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')]} 10:13:26 INFO - https://queue.taskcluster.net/v1/task/BfYG2V16QFaaQ9tmX6zBbA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 10:13:26 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BfYG2V16QFaaQ9tmX6zBbA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 10:13:26 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BfYG2V16QFaaQ9tmX6zBbA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 10:13:26 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BfYG2V16QFaaQ9tmX6zBbA/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 10:13:26 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BfYG2V16QFaaQ9tmX6zBbA/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 10:13:29 INFO - Downloaded 23907276 bytes. 10:13:29 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'] 10:13:29 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 10:13:30 INFO - Return code: 0 10:13:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:13:30 INFO - https://queue.taskcluster.net/v1/task/BfYG2V16QFaaQ9tmX6zBbA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 10:13:30 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BfYG2V16QFaaQ9tmX6zBbA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip 10:13:30 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BfYG2V16QFaaQ9tmX6zBbA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip 10:13:30 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BfYG2V16QFaaQ9tmX6zBbA/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 10:13:30 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BfYG2V16QFaaQ9tmX6zBbA/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 10:13:31 INFO - Downloaded 10840239 bytes. 10:13:31 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'] 10:13:31 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 10:13:31 INFO - Return code: 0 10: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')]} 10:13:31 INFO - https://queue.taskcluster.net/v1/task/BfYG2V16QFaaQ9tmX6zBbA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 10:13:31 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BfYG2V16QFaaQ9tmX6zBbA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 10:13:31 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BfYG2V16QFaaQ9tmX6zBbA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 10:13:31 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BfYG2V16QFaaQ9tmX6zBbA/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 10:13:31 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/BfYG2V16QFaaQ9tmX6zBbA/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 10:13:32 INFO - Downloaded 58361680 bytes. 10:13:32 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/BfYG2V16QFaaQ9tmX6zBbA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 10:13:32 INFO - mkdir: /builds/slave/test/properties 10:13:32 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 10:13:32 INFO - Writing to file /builds/slave/test/properties/build_url 10:13:32 INFO - Contents: 10:13:32 INFO - build_url:https://queue.taskcluster.net/v1/task/BfYG2V16QFaaQ9tmX6zBbA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 10:13:33 INFO - Running post-action listener: _resource_record_post_action 10:13:33 INFO - Running post-action listener: set_extra_try_arguments 10:13:33 INFO - ##### 10:13:33 INFO - ##### Finished download-and-extract step (success) 10:13:33 INFO - ##### 10:13:33 INFO - ##### 10:13:33 INFO - ##### Running populate-webroot step. 10:13:33 INFO - ##### 10:13:33 INFO - Running pre-action listener: _resource_record_pre_action 10:13:33 INFO - Running main action method: populate_webroot 10:13:33 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 10:13:33 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 10:13:33 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 10:13:33 INFO - '--tppagecycles', 10:13:33 INFO - '7'], 10:13:33 INFO - 'tests': ['tsvgm']}}, 10:13:33 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 10:13:33 INFO - 'tests': ['tresize', 'tcanvasmark']}, 10:13:33 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 10:13:33 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 10:13:33 INFO - 'tests': ['dromaeo_css', 'kraken']}, 10:13:33 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 10:13:33 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:13:33 INFO - 'talos_options': ['--disable-e10s'], 10:13:33 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 10:13:33 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:13:33 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 10:13:33 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:13:33 INFO - 'talos_options': ['--disable-e10s'], 10:13:33 INFO - 'tests': ['damp', 'tps']}, 10:13:33 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:13:33 INFO - 'tests': ['damp', 'tps']}, 10:13:33 INFO - 'g3': {'talos_options': ['--disable-e10s'], 10:13:33 INFO - 'tests': ['dromaeo_dom']}, 10:13:33 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 10:13:33 INFO - 'other': {'talos_options': ['--disable-e10s'], 10:13:33 INFO - 'tests': ['a11yr', 10:13:33 INFO - 'ts_paint', 10:13:33 INFO - 'tpaint', 10:13:33 INFO - 'sessionrestore', 10:13:33 INFO - 'sessionrestore_no_auto_restore', 10:13:33 INFO - 'tabpaint']}, 10:13:33 INFO - 'other-e10s': {'tests': ['a11yr', 10:13:33 INFO - 'ts_paint', 10:13:33 INFO - 'tpaint', 10:13:33 INFO - 'sessionrestore', 10:13:33 INFO - 'sessionrestore_no_auto_restore', 10:13:33 INFO - 'tabpaint']}, 10:13:33 INFO - 'other-e10s_l64': {'tests': ['a11yr', 10:13:33 INFO - 'ts_paint', 10:13:33 INFO - 'tpaint', 10:13:33 INFO - 'sessionrestore', 10:13:33 INFO - 'sessionrestore_no_auto_restore', 10:13:33 INFO - 'tabpaint']}, 10:13:33 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 10:13:33 INFO - 'ts_paint', 10:13:33 INFO - 'tpaint', 10:13:33 INFO - 'sessionrestore', 10:13:33 INFO - 'sessionrestore_no_auto_restore', 10:13:33 INFO - 'tabpaint']}, 10:13:33 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 10:13:33 INFO - 'tests': ['a11yr', 10:13:33 INFO - 'ts_paint', 10:13:33 INFO - 'tpaint', 10:13:33 INFO - 'sessionrestore', 10:13:33 INFO - 'sessionrestore_no_auto_restore', 10:13:33 INFO - 'tabpaint']}, 10:13:33 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 10:13:33 INFO - 'tests': ['a11yr', 10:13:33 INFO - 'ts_paint', 10:13:33 INFO - 'tpaint', 10:13:33 INFO - 'sessionrestore', 10:13:33 INFO - 'sessionrestore_no_auto_restore', 10:13:33 INFO - 'tabpaint']}, 10:13:33 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 10:13:33 INFO - 'tests': ['tsvgx', 10:13:33 INFO - 'tsvgr_opacity', 10:13:33 INFO - 'tart', 10:13:33 INFO - 'tscrollx', 10:13:33 INFO - 'cart']}, 10:13:33 INFO - 'svgr-e10s': {'tests': ['tsvgx', 10:13:33 INFO - 'tsvgr_opacity', 10:13:33 INFO - 'tart', 10:13:33 INFO - 'tscrollx', 10:13:33 INFO - 'cart']}, 10:13:33 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:13:33 INFO - 'talos_options': ['--disable-e10s'], 10:13:33 INFO - 'tests': ['tp5o']}, 10:13:33 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:13:33 INFO - 'tests': ['tp5o']}, 10:13:33 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:13:33 INFO - 'talos_options': ['--disable-e10s', 10:13:33 INFO - '--xperf_path', 10:13:33 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 10:13:33 INFO - 'tests': ['tp5n']}, 10:13:33 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:13:33 INFO - 'talos_options': ['--xperf_path', 10:13:33 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 10:13:33 INFO - 'tests': ['tp5n']}}, 10:13:33 INFO - 'talos.zip': {'path': '', 10:13:33 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 10:13:33 INFO - Running post-action listener: _resource_record_post_action 10:13:33 INFO - ##### 10:13:33 INFO - ##### Finished populate-webroot step (success) 10:13:33 INFO - ##### 10:13:33 INFO - ##### 10:13:33 INFO - ##### Running create-virtualenv step. 10:13:33 INFO - ##### 10:13:33 INFO - Running pre-action listener: _resource_record_pre_action 10:13:33 INFO - Running main action method: create_virtualenv 10:13:33 INFO - Creating virtualenv /builds/slave/test/build/venv 10:13:33 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 10:13:33 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 10:13:33 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 10:13:33 INFO - Using real prefix '/usr' 10:13:33 INFO - New python executable in /builds/slave/test/build/venv/bin/python 10:13:34 INFO - Installing distribute.............................................................................................................................................................................................done. 10:13:36 INFO - Installing pip.................done. 10:13:36 INFO - Return code: 0 10:13:36 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 10:13:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:13:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:13:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:13:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:13:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:13:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:13:36 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb41553ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x234f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x241a770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24a99c0>, '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 0x24aa8c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24aad50>, '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': '8887e36bb8e381bfd44124ac000001a8-1463073025.835199-1380263536', '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 10:13:36 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 10:13:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 10:13:36 INFO - Using env: {'DISPLAY': ':0', 10:13:36 INFO - 'HOME': '/home/cltbld', 10:13:36 INFO - 'LANG': 'en_US.UTF-8', 10:13:36 INFO - 'LANGUAGE': 'en_US:en', 10:13:36 INFO - 'LOGNAME': 'cltbld', 10:13:36 INFO - 'MAIL': '/var/mail/cltbld', 10:13:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:13:36 INFO - 'MOZ_NO_REMOTE': '1', 10:13:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:13:36 INFO - 'NO_EM_RESTART': '1', 10:13:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:13:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:13:36 INFO - 'PWD': '/builds/slave/test', 10:13:36 INFO - 'SHELL': '/bin/bash', 10:13:36 INFO - 'SHLVL': '1', 10:13:36 INFO - 'TERM': 'linux', 10:13:36 INFO - 'TMOUT': '86400', 10:13:36 INFO - 'USER': 'cltbld', 10:13:36 INFO - 'XDG_SESSION_COOKIE': '8887e36bb8e381bfd44124ac000001a8-1463073025.835199-1380263536', 10:13:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:13:36 INFO - '_': '/tools/buildbot/bin/python'} 10:13:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:13:36 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 10:13:36 INFO - Cleaning up... 10:13:36 INFO - Return code: 0 10:13:36 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 10:13:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:13:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:13:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:13:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:13:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:13:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:13:36 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb41553ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x234f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x241a770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24a99c0>, '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 0x24aa8c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24aad50>, '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': '8887e36bb8e381bfd44124ac000001a8-1463073025.835199-1380263536', '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 10:13:36 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test/build 10:13:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 10:13:36 INFO - Using env: {'DISPLAY': ':0', 10:13:36 INFO - 'HOME': '/home/cltbld', 10:13:36 INFO - 'LANG': 'en_US.UTF-8', 10:13:36 INFO - 'LANGUAGE': 'en_US:en', 10:13:36 INFO - 'LOGNAME': 'cltbld', 10:13:36 INFO - 'MAIL': '/var/mail/cltbld', 10:13:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:13:36 INFO - 'MOZ_NO_REMOTE': '1', 10:13:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:13:36 INFO - 'NO_EM_RESTART': '1', 10:13:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:13:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:13:36 INFO - 'PWD': '/builds/slave/test', 10:13:36 INFO - 'SHELL': '/bin/bash', 10:13:36 INFO - 'SHLVL': '1', 10:13:36 INFO - 'TERM': 'linux', 10:13:36 INFO - 'TMOUT': '86400', 10:13:36 INFO - 'USER': 'cltbld', 10:13:36 INFO - 'XDG_SESSION_COOKIE': '8887e36bb8e381bfd44124ac000001a8-1463073025.835199-1380263536', 10:13:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:13:36 INFO - '_': '/tools/buildbot/bin/python'} 10:13:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:13:36 INFO - Downloading/unpacking psutil>=0.7.1 10: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 10: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 10: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 10: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 10: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 10: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 10:13:38 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 10:13:38 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 10:13:38 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 10:13:38 INFO - Installing collected packages: psutil 10:13:38 INFO - Running setup.py install for psutil 10:13:38 INFO - building 'psutil._psutil_linux' extension 10:13:38 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 10:13:38 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 10:13:39 INFO - building 'psutil._psutil_posix' extension 10:13:39 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 10:13:39 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 10:13:39 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 10:13:39 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 10:13:39 INFO - Successfully installed psutil 10:13:39 INFO - Cleaning up... 10:13:39 INFO - Return code: 0 10:13:39 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 10:13:39 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')]} 10:13:39 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:13:39 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:13:39 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')]} 10:13:39 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:13:39 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:13:39 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb41553ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x234f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x241a770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24a99c0>, '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 0x24aa8c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24aad50>, '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': '8887e36bb8e381bfd44124ac000001a8-1463073025.835199-1380263536', '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 10:13:39 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test/build 10:13:39 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 10:13:39 INFO - Using env: {'DISPLAY': ':0', 10:13:39 INFO - 'HOME': '/home/cltbld', 10:13:39 INFO - 'LANG': 'en_US.UTF-8', 10:13:39 INFO - 'LANGUAGE': 'en_US:en', 10:13:39 INFO - 'LOGNAME': 'cltbld', 10:13:39 INFO - 'MAIL': '/var/mail/cltbld', 10:13:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:13:39 INFO - 'MOZ_NO_REMOTE': '1', 10:13:39 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:13:39 INFO - 'NO_EM_RESTART': '1', 10:13:39 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:13:39 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:13:39 INFO - 'PWD': '/builds/slave/test', 10:13:39 INFO - 'SHELL': '/bin/bash', 10:13:39 INFO - 'SHLVL': '1', 10:13:39 INFO - 'TERM': 'linux', 10:13:39 INFO - 'TMOUT': '86400', 10:13:39 INFO - 'USER': 'cltbld', 10:13:39 INFO - 'XDG_SESSION_COOKIE': '8887e36bb8e381bfd44124ac000001a8-1463073025.835199-1380263536', 10:13:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:13:39 INFO - '_': '/tools/buildbot/bin/python'} 10:13:39 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:13:39 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 10: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 10: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 10: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 10: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 10: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 10: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 10:13:41 INFO - Downloading mozsystemmonitor-0.0.tar.gz 10:13:41 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 10:13:41 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 10:13:41 INFO - Installing collected packages: mozsystemmonitor 10:13:41 INFO - Running setup.py install for mozsystemmonitor 10:13:41 INFO - Successfully installed mozsystemmonitor 10:13:41 INFO - Cleaning up... 10:13:41 INFO - Return code: 0 10:13:41 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 10:13:41 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')]} 10:13:41 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:13:41 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:13:41 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')]} 10:13:41 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:13:41 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:13:41 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 0x7fb41553ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x234f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x241a770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24a99c0>, '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 0x24aa8c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24aad50>, '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': '8887e36bb8e381bfd44124ac000001a8-1463073025.835199-1380263536', '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 10:13:41 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 10:13:41 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 10:13:41 INFO - Using env: {'DISPLAY': ':0', 10:13:41 INFO - 'HOME': '/home/cltbld', 10:13:41 INFO - 'LANG': 'en_US.UTF-8', 10:13:41 INFO - 'LANGUAGE': 'en_US:en', 10:13:41 INFO - 'LOGNAME': 'cltbld', 10:13:41 INFO - 'MAIL': '/var/mail/cltbld', 10:13:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:13:41 INFO - 'MOZ_NO_REMOTE': '1', 10:13:41 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:13:41 INFO - 'NO_EM_RESTART': '1', 10:13:41 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:13:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:13:41 INFO - 'PWD': '/builds/slave/test', 10:13:41 INFO - 'SHELL': '/bin/bash', 10:13:41 INFO - 'SHLVL': '1', 10:13:41 INFO - 'TERM': 'linux', 10:13:41 INFO - 'TMOUT': '86400', 10:13:41 INFO - 'USER': 'cltbld', 10:13:41 INFO - 'XDG_SESSION_COOKIE': '8887e36bb8e381bfd44124ac000001a8-1463073025.835199-1380263536', 10:13:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:13:41 INFO - '_': '/tools/buildbot/bin/python'} 10:13:41 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:13:41 INFO - Downloading/unpacking blobuploader==1.2.4 10: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 10: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 10: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 10: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 10: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 10: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 10:13:43 INFO - Downloading blobuploader-1.2.4.tar.gz 10:13:43 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 10:13:43 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 10:13:43 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 10:13:43 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 10:13:43 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 10:13:43 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 10:13:43 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 10:13:43 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 10:13:43 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 10:13:44 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 10:13:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:13:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:13:44 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:13:44 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:13:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:13:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:13:44 INFO - Downloading docopt-0.6.1.tar.gz 10:13:44 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 10:13:44 INFO - Installing collected packages: blobuploader, requests, docopt 10:13:44 INFO - Running setup.py install for blobuploader 10:13:44 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 10:13:44 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 10:13:44 INFO - Running setup.py install for requests 10:13:44 INFO - Running setup.py install for docopt 10:13:44 INFO - Successfully installed blobuploader requests docopt 10:13:44 INFO - Cleaning up... 10:13:45 INFO - Return code: 0 10:13:45 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:13:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:13:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:13:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:13:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:13:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:13:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:13:45 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 0x7fb41553ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x234f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x241a770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24a99c0>, '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 0x24aa8c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24aad50>, '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': '8887e36bb8e381bfd44124ac000001a8-1463073025.835199-1380263536', '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 10:13:45 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 10:13:45 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 10:13:45 INFO - Using env: {'DISPLAY': ':0', 10:13:45 INFO - 'HOME': '/home/cltbld', 10:13:45 INFO - 'LANG': 'en_US.UTF-8', 10:13:45 INFO - 'LANGUAGE': 'en_US:en', 10:13:45 INFO - 'LOGNAME': 'cltbld', 10:13:45 INFO - 'MAIL': '/var/mail/cltbld', 10:13:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:13:45 INFO - 'MOZ_NO_REMOTE': '1', 10:13:45 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:13:45 INFO - 'NO_EM_RESTART': '1', 10:13:45 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:13:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:13:45 INFO - 'PWD': '/builds/slave/test', 10:13:45 INFO - 'SHELL': '/bin/bash', 10:13:45 INFO - 'SHLVL': '1', 10:13:45 INFO - 'TERM': 'linux', 10:13:45 INFO - 'TMOUT': '86400', 10:13:45 INFO - 'USER': 'cltbld', 10:13:45 INFO - 'XDG_SESSION_COOKIE': '8887e36bb8e381bfd44124ac000001a8-1463073025.835199-1380263536', 10:13:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:13:45 INFO - '_': '/tools/buildbot/bin/python'} 10:13:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:13:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 10:13:45 INFO - Running setup.py (path:/tmp/pip-nmPcz9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 10:13:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 10:13:45 INFO - Running setup.py (path:/tmp/pip-lZ8g2p-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 10:13:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 10:13:45 INFO - Running setup.py (path:/tmp/pip-ir3AWr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 10:13:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 10:13:45 INFO - Running setup.py (path:/tmp/pip-D2726q-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 10:13:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 10:13:45 INFO - Running setup.py (path:/tmp/pip-5pzolf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 10:13:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 10:13:45 INFO - Running setup.py (path:/tmp/pip-Zzp1Uf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 10:13:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 10:13:45 INFO - Running setup.py (path:/tmp/pip-aWlib0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 10:13:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 10:13:45 INFO - Running setup.py (path:/tmp/pip-6rRJvJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 10:13:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 10:13:45 INFO - Running setup.py (path:/tmp/pip-5YXnEs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 10:13:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 10:13:45 INFO - Running setup.py (path:/tmp/pip-QlCUDI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 10:13:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 10:13:45 INFO - Running setup.py (path:/tmp/pip-W521aa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 10:13:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 10:13:46 INFO - Running setup.py (path:/tmp/pip-r15m5G-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 10:13:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 10:13:46 INFO - Running setup.py (path:/tmp/pip-rRvXfA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 10:13:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 10:13:46 INFO - Running setup.py (path:/tmp/pip-wEbPZm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 10:13:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 10:13:46 INFO - Running setup.py (path:/tmp/pip-amF1R3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 10:13:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 10:13:46 INFO - Running setup.py (path:/tmp/pip-7WbYlz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 10:13:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 10:13:46 INFO - Running setup.py (path:/tmp/pip-ILwGQb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 10:13:46 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 10:13:46 INFO - Running setup.py install for manifestparser 10:13:46 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 10:13:46 INFO - Running setup.py install for mozcrash 10:13:46 INFO - Running setup.py install for mozdebug 10:13:46 INFO - Running setup.py install for mozdevice 10:13:46 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 10:13:46 INFO - Installing dm script to /builds/slave/test/build/venv/bin 10:13:46 INFO - Running setup.py install for mozfile 10:13:46 INFO - Running setup.py install for mozhttpd 10:13:47 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 10:13:47 INFO - Running setup.py install for mozinfo 10:13:47 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 10:13:47 INFO - Running setup.py install for mozInstall 10:13:47 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 10:13:47 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 10:13:47 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 10:13:47 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 10:13:47 INFO - Running setup.py install for mozleak 10:13:47 INFO - Running setup.py install for mozlog 10:13:47 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 10:13:47 INFO - Running setup.py install for moznetwork 10:13:47 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 10:13:47 INFO - Running setup.py install for mozprocess 10:13:47 INFO - Running setup.py install for mozprofile 10:13:47 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 10:13:47 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 10:13:47 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 10:13:47 INFO - Running setup.py install for mozrunner 10:13:47 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 10:13:47 INFO - Running setup.py install for mozscreenshot 10:13:48 INFO - Running setup.py install for moztest 10:13:48 INFO - Running setup.py install for mozversion 10:13:48 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 10:13:48 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 10:13:48 INFO - Cleaning up... 10:13:48 INFO - Return code: 0 10:13:48 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:13:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:13:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:13:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:13:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:13:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:13:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:13:48 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 0x7fb41553ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x234f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x241a770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24a99c0>, '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 0x24aa8c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24aad50>, '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': '8887e36bb8e381bfd44124ac000001a8-1463073025.835199-1380263536', '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 10:13:48 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 10:13:48 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 10:13:48 INFO - Using env: {'DISPLAY': ':0', 10:13:48 INFO - 'HOME': '/home/cltbld', 10:13:48 INFO - 'LANG': 'en_US.UTF-8', 10:13:48 INFO - 'LANGUAGE': 'en_US:en', 10:13:48 INFO - 'LOGNAME': 'cltbld', 10:13:48 INFO - 'MAIL': '/var/mail/cltbld', 10:13:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:13:48 INFO - 'MOZ_NO_REMOTE': '1', 10:13:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:13:48 INFO - 'NO_EM_RESTART': '1', 10:13:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:13:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:13:48 INFO - 'PWD': '/builds/slave/test', 10:13:48 INFO - 'SHELL': '/bin/bash', 10:13:48 INFO - 'SHLVL': '1', 10:13:48 INFO - 'TERM': 'linux', 10:13:48 INFO - 'TMOUT': '86400', 10:13:48 INFO - 'USER': 'cltbld', 10:13:48 INFO - 'XDG_SESSION_COOKIE': '8887e36bb8e381bfd44124ac000001a8-1463073025.835199-1380263536', 10:13:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:13:48 INFO - '_': '/tools/buildbot/bin/python'} 10:13:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:13:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 10:13:48 INFO - Running setup.py (path:/tmp/pip-68o17m-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 10:13:48 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)) 10:13:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 10:13:48 INFO - Running setup.py (path:/tmp/pip-eJaGaG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 10:13:48 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)) 10:13:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 10:13:48 INFO - Running setup.py (path:/tmp/pip-PIEkoW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 10:13:48 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)) 10:13:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 10:13:48 INFO - Running setup.py (path:/tmp/pip-dg90Zp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 10:13:48 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)) 10:13:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 10:13:48 INFO - Running setup.py (path:/tmp/pip-2cnjfb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 10:13:48 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)) 10:13:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 10:13:48 INFO - Running setup.py (path:/tmp/pip-zugUtk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 10:13:48 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)) 10:13:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 10:13:48 INFO - Running setup.py (path:/tmp/pip-lOfvKv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 10:13:48 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)) 10:13:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 10:13:48 INFO - Running setup.py (path:/tmp/pip-3J7e73-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 10:13:49 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)) 10:13:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 10:13:49 INFO - Running setup.py (path:/tmp/pip-cgFOXp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 10:13:49 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)) 10:13:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 10:13:49 INFO - Running setup.py (path:/tmp/pip-I7p3dJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 10:13:49 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)) 10:13:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 10:13:49 INFO - Running setup.py (path:/tmp/pip-YHn7Pm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 10:13:49 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)) 10:13:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 10:13:49 INFO - Running setup.py (path:/tmp/pip-L_aQi5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 10:13:49 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)) 10:13:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 10:13:49 INFO - Running setup.py (path:/tmp/pip-otJ4Le-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 10:13:49 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)) 10:13:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 10:13:49 INFO - Running setup.py (path:/tmp/pip-hYVLMl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 10:13:49 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)) 10:13:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 10:13:49 INFO - Running setup.py (path:/tmp/pip-D5MC3g-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 10:13:49 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)) 10:13:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 10:13:49 INFO - Running setup.py (path:/tmp/pip-c9sXNN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 10:13:49 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)) 10:13:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 10:13:49 INFO - Running setup.py (path:/tmp/pip-qhx92I-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 10:13:49 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)) 10:13:49 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)) 10:13:49 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)) 10:13:49 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)) 10:13:49 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)) 10:13:49 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)) 10:13:49 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.2->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 10:13:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:13:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:13:49 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:13:49 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:13:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:13:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:13:51 INFO - Downloading blessings-1.6.tar.gz 10:13:51 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 10:13:51 INFO - Installing collected packages: blessings 10:13:51 INFO - Running setup.py install for blessings 10:13:51 INFO - Successfully installed blessings 10:13:51 INFO - Cleaning up... 10:13:51 INFO - Return code: 0 10:13:51 INFO - Done creating virtualenv /builds/slave/test/build/venv. 10:13:51 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 10:13:51 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 10:13:52 INFO - Reading from file tmpfile_stdout 10:13:52 INFO - Current package versions: 10:13:52 INFO - argparse == 1.2.1 10:13:52 INFO - blessings == 1.6 10:13:52 INFO - blobuploader == 1.2.4 10:13:52 INFO - docopt == 0.6.1 10:13:52 INFO - manifestparser == 1.1 10:13:52 INFO - mozInstall == 1.12 10:13:52 INFO - mozcrash == 0.17 10:13:52 INFO - mozdebug == 0.1 10:13:52 INFO - mozdevice == 0.48 10:13:52 INFO - mozfile == 1.2 10:13:52 INFO - mozhttpd == 0.7 10:13:52 INFO - mozinfo == 0.9 10:13:52 INFO - mozleak == 0.1 10:13:52 INFO - mozlog == 3.2 10:13:52 INFO - moznetwork == 0.27 10:13:52 INFO - mozprocess == 0.22 10:13:52 INFO - mozprofile == 0.28 10:13:52 INFO - mozrunner == 6.11 10:13:52 INFO - mozscreenshot == 0.1 10:13:52 INFO - mozsystemmonitor == 0.0 10:13:52 INFO - moztest == 0.7 10:13:52 INFO - mozversion == 1.4 10:13:52 INFO - psutil == 3.1.1 10:13:52 INFO - requests == 1.2.3 10:13:52 INFO - wsgiref == 0.1.2 10:13:52 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:13:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:13:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:13:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:13:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:13:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:13:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:13:52 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 0x7fb41553ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x234f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x241a770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24a99c0>, '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 0x24aa8c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24aad50>, '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': '8887e36bb8e381bfd44124ac000001a8-1463073025.835199-1380263536', '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 10:13:52 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 10:13:52 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 10:13:52 INFO - Using env: {'DISPLAY': ':0', 10:13:52 INFO - 'HOME': '/home/cltbld', 10:13:52 INFO - 'LANG': 'en_US.UTF-8', 10:13:52 INFO - 'LANGUAGE': 'en_US:en', 10:13:52 INFO - 'LOGNAME': 'cltbld', 10:13:52 INFO - 'MAIL': '/var/mail/cltbld', 10:13:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:13:52 INFO - 'MOZ_NO_REMOTE': '1', 10:13:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:13:52 INFO - 'NO_EM_RESTART': '1', 10:13:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:13:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:13:52 INFO - 'PWD': '/builds/slave/test', 10:13:52 INFO - 'SHELL': '/bin/bash', 10:13:52 INFO - 'SHLVL': '1', 10:13:52 INFO - 'TERM': 'linux', 10:13:52 INFO - 'TMOUT': '86400', 10:13:52 INFO - 'USER': 'cltbld', 10:13:52 INFO - 'XDG_SESSION_COOKIE': '8887e36bb8e381bfd44124ac000001a8-1463073025.835199-1380263536', 10:13:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:13:52 INFO - '_': '/tools/buildbot/bin/python'} 10:13:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:13:52 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)) 10:13:52 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)) 10:13:52 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)) 10:13:52 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)) 10:13:52 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)) 10:13:52 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)) 10:13:52 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)) 10:13:52 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)) 10:13:52 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)) 10:13:52 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)) 10:13:52 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)) 10:13:52 INFO - Cleaning up... 10:13:52 INFO - Return code: 0 10:13:52 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 10:13:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:13:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:13:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:13:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:13:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:13:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:13:52 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb41553ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x234f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x241a770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24a99c0>, '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 0x24aa8c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24aad50>, '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': '8887e36bb8e381bfd44124ac000001a8-1463073025.835199-1380263536', '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 10:13:52 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 10:13:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 10:13:52 INFO - Using env: {'DISPLAY': ':0', 10:13:52 INFO - 'HOME': '/home/cltbld', 10:13:52 INFO - 'LANG': 'en_US.UTF-8', 10:13:52 INFO - 'LANGUAGE': 'en_US:en', 10:13:52 INFO - 'LOGNAME': 'cltbld', 10:13:52 INFO - 'MAIL': '/var/mail/cltbld', 10:13:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:13:52 INFO - 'MOZ_NO_REMOTE': '1', 10:13:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:13:52 INFO - 'NO_EM_RESTART': '1', 10:13:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:13:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:13:52 INFO - 'PWD': '/builds/slave/test', 10:13:52 INFO - 'SHELL': '/bin/bash', 10:13:52 INFO - 'SHLVL': '1', 10:13:52 INFO - 'TERM': 'linux', 10:13:52 INFO - 'TMOUT': '86400', 10:13:52 INFO - 'USER': 'cltbld', 10:13:52 INFO - 'XDG_SESSION_COOKIE': '8887e36bb8e381bfd44124ac000001a8-1463073025.835199-1380263536', 10:13:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:13:52 INFO - '_': '/tools/buildbot/bin/python'} 10:13:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:13:52 INFO - Downloading/unpacking jsonschema 10:13:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:13:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:13:52 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:13:52 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:13:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:13:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:13:54 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 10:13:54 INFO - Downloading/unpacking functools32 (from jsonschema) 10:13:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:13:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:13:54 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:13:54 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:13:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:13:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:13:54 INFO - Downloading functools32-3.2.3-2.tar.gz 10:13:54 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 10:13:54 INFO - warning: no files found matching '*.txt' 10:13:54 INFO - no previously-included directories found matching 'build' 10:13:54 INFO - no previously-included directories found matching 'dist' 10:13:54 INFO - no previously-included directories found matching '.git*' 10:13:54 INFO - Installing collected packages: jsonschema, functools32 10:13:54 INFO - Running setup.py install for functools32 10:13:54 INFO - warning: no files found matching '*.txt' 10:13:54 INFO - no previously-included directories found matching 'build' 10:13:54 INFO - no previously-included directories found matching 'dist' 10:13:54 INFO - no previously-included directories found matching '.git*' 10:13:54 INFO - Successfully installed jsonschema functools32 10:13:54 INFO - Cleaning up... 10:13:54 INFO - Return code: 0 10:13:54 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 10:13:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:13:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:13:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:13:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:13:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:13:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:13:54 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb41553ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x234f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x241a770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24a99c0>, '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 0x24aa8c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24aad50>, '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': '8887e36bb8e381bfd44124ac000001a8-1463073025.835199-1380263536', '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 10:13:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8'] in /builds/slave/test/build 10:13:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub flake8 10:13:54 INFO - Using env: {'DISPLAY': ':0', 10:13:54 INFO - 'HOME': '/home/cltbld', 10:13:54 INFO - 'LANG': 'en_US.UTF-8', 10:13:54 INFO - 'LANGUAGE': 'en_US:en', 10:13:54 INFO - 'LOGNAME': 'cltbld', 10:13:54 INFO - 'MAIL': '/var/mail/cltbld', 10:13:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:13:54 INFO - 'MOZ_NO_REMOTE': '1', 10:13:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:13:54 INFO - 'NO_EM_RESTART': '1', 10:13:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:13:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:13:54 INFO - 'PWD': '/builds/slave/test', 10:13:54 INFO - 'SHELL': '/bin/bash', 10:13:54 INFO - 'SHLVL': '1', 10:13:54 INFO - 'TERM': 'linux', 10:13:54 INFO - 'TMOUT': '86400', 10:13:54 INFO - 'USER': 'cltbld', 10:13:54 INFO - 'XDG_SESSION_COOKIE': '8887e36bb8e381bfd44124ac000001a8-1463073025.835199-1380263536', 10:13:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:13:54 INFO - '_': '/tools/buildbot/bin/python'} 10:13:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:13:55 INFO - Downloading/unpacking flake8 10:13:55 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 10:13:55 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 10:13:55 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 10:13:55 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 10:13:55 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 10:13:55 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 10:13:56 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 10:13:56 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 10:13:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:13:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:13:56 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:13:56 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:13:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:13:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:13:57 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 10:13:57 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 10:13:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:13:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:13:57 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:13:57 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:13:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:13:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:13:57 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 10:13:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:13:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:13:57 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:13:57 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:13:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:13:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:13:57 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 10:13:57 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 10:13:57 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 10:13:57 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 10:13:57 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 10:13:57 INFO - no previously-included directories found matching 'docs/_build' 10:13:57 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 10:13:57 INFO - Running setup.py install for pep8 10:13:57 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 10:13:57 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 10:13:57 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 10:13:57 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 10:13:57 INFO - no previously-included directories found matching 'docs/_build' 10:13:57 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 10:13:57 INFO - Successfully installed flake8 mccabe pyflakes pep8 10:13:57 INFO - Cleaning up... 10:13:57 INFO - Return code: 0 10:13:57 INFO - Running post-action listener: _resource_record_post_action 10:13:57 INFO - Running post-action listener: _start_resource_monitoring 10:13:57 INFO - Starting resource monitoring. 10:13:57 INFO - ##### 10:13:57 INFO - ##### Finished create-virtualenv step (success) 10:13:57 INFO - ##### 10:13:57 INFO - ##### 10:13:57 INFO - ##### Running install step. 10:13:57 INFO - ##### 10:13:57 INFO - Running pre-action listener: _resource_record_pre_action 10:13:57 INFO - Running main action method: install 10:13:57 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 10:13:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 10:13:58 INFO - Reading from file tmpfile_stdout 10:13:58 INFO - Detecting whether we're running mozinstall >=1.0... 10:13:58 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 10:13:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 10:13:58 INFO - Reading from file tmpfile_stdout 10:13:58 INFO - Output received: 10:13:58 INFO - Usage: mozinstall [options] installer 10:13:58 INFO - Options: 10:13:58 INFO - -h, --help show this help message and exit 10:13:58 INFO - -d DEST, --destination=DEST 10:13:58 INFO - Directory to install application into. [default: 10:13:58 INFO - "/builds/slave/test"] 10:13:58 INFO - --app=APP Application being installed. [default: firefox] 10:13:58 INFO - mkdir: /builds/slave/test/build/application 10:13:58 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'] 10:13:58 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 10:14:14 INFO - Reading from file tmpfile_stdout 10:14:14 INFO - Output received: 10:14:14 INFO - /builds/slave/test/build/application/firefox/firefox 10:14:14 INFO - Running post-action listener: _resource_record_post_action 10:14:14 INFO - ##### 10:14:14 INFO - ##### Finished install step (success) 10:14:14 INFO - ##### 10:14:14 INFO - ##### 10:14:14 INFO - ##### Running run-tests step. 10:14:14 INFO - ##### 10:14:14 INFO - Running pre-action listener: _resource_record_pre_action 10:14:14 INFO - Running main action method: run_tests 10:14:14 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 10:14:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 10:14:14 INFO - Python 2.7.3 10:14:14 INFO - Return code: 0 10:14:14 INFO - grabbing minidump binary from tooltool 10:14: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')]} 10:14:14 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 0x24a99c0>, '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 0x24aa8c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24aad50>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 10:14:14 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 10:14:14 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 10:14:14 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 10:14:14 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 10:14:14 INFO - Return code: 0 10:14:14 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 10:14:14 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 10:14:14 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 10:14:14 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 10:14:14 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 10:14:14 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 10:14:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 10:14:15 INFO - Return code: 0 10:14:15 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Inbound', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/BfYG2V16QFaaQ9tmX6zBbA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-001', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 10:14:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Inbound --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/BfYG2V16QFaaQ9tmX6zBbA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-001 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 10:14:15 INFO - Using env: {'DISPLAY': ':0', 10:14:15 INFO - 'HOME': '/home/cltbld', 10:14:15 INFO - 'LANG': 'en_US.UTF-8', 10:14:15 INFO - 'LANGUAGE': 'en_US:en', 10:14:15 INFO - 'LOGNAME': 'cltbld', 10:14:15 INFO - 'MAIL': '/var/mail/cltbld', 10:14:15 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 10:14:15 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 10:14:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:14:15 INFO - 'MOZ_NO_REMOTE': '1', 10:14:15 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 10:14:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:14:15 INFO - 'NO_EM_RESTART': '1', 10:14:15 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:14:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:14:15 INFO - 'PWD': '/builds/slave/test', 10:14:15 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 10:14:15 INFO - 'SHELL': '/bin/bash', 10:14:15 INFO - 'SHLVL': '1', 10:14:15 INFO - 'TERM': 'linux', 10:14:15 INFO - 'TMOUT': '86400', 10:14:15 INFO - 'USER': 'cltbld', 10:14:15 INFO - 'XDG_SESSION_COOKIE': '8887e36bb8e381bfd44124ac000001a8-1463073025.835199-1380263536', 10:14:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:14:15 INFO - '_': '/tools/buildbot/bin/python'} 10:14:15 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Inbound', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/BfYG2V16QFaaQ9tmX6zBbA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-001', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 10:14:15 INFO - mozversion application_buildid: 20160512073659 10:14:15 INFO - mozversion application_changeset: 70dc1787f866ac056bbe3d01eda5a039c41ad74f 10:14:15 INFO - mozversion application_display_name: Nightly 10:14:15 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 10:14:15 INFO - mozversion application_name: Firefox 10:14:15 INFO - mozversion application_remotingname: firefox 10:14:15 INFO - mozversion application_repository: https://hg.mozilla.org/integration/mozilla-inbound 10:14:15 INFO - mozversion application_vendor: Mozilla 10:14:15 INFO - mozversion application_version: 49.0a1 10:14:15 INFO - mozversion platform_buildid: 20160512073659 10:14:15 INFO - mozversion platform_changeset: 70dc1787f866ac056bbe3d01eda5a039c41ad74f 10:14:15 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/mozilla-inbound 10:14:15 INFO - mozversion platform_version: 49.0a1 10:14:15 INFO - using testdate: 1463073255 10:14:15 INFO - actual date: 1463073255 10:14:15 INFO - starting webserver on 'localhost:49867' 10:14:15 INFO - SUITE-START | Running 2 tests 10:14:15 INFO - TEST-START | dromaeo_css 10:14:15 INFO - operating with platform_type : linux_ 10:14:15 INFO - Initialising browser for dromaeo_css test... 10:14:15 INFO - TEST-INFO | started process 19951 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpclETCj/profile http://localhost:49867/getInfo.html) 10:14:19 INFO - PROCESS | 19951 | 10:14:19 INFO - PROCESS | 19951 | (process:20019): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 10:14:20 INFO - PROCESS | 19951 | __metrics Screen width/height:1600/1200 10:14:20 INFO - PROCESS | 19951 | colorDepth:24 10:14:20 INFO - PROCESS | 19951 | Browser inner width/height: 1024/697 10:14:20 INFO - PROCESS | 19951 | __metrics 10:14:21 ERROR - PROCESS | 19951 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2946: TypeError: this.tabs is undefined 10:14:22 INFO - TEST-INFO | 19951: exit 0 10:14:22 INFO - Browser initialized. 10:14:22 INFO - Running cycle 1/1 for dromaeo_css test... 10:14:22 INFO - TEST-INFO | started process 20070 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpclETCj/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 10:14:24 INFO - PROCESS | 20070 | 10:14:24 INFO - PROCESS | 20070 | (process:20132): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 10:14:34 INFO - PROCESS | 20070 | RSS: Main: 162762752 10:14:34 INFO - PROCESS | 20070 | 10:15:23 INFO - PROCESS | 20070 | 1463073323794 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] 10:17:31 INFO - PROCESS | 20070 | Cycle 1(1): loaded http://localhost:49867/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49867/tests/dromaeo/cssquery-ext.html) 10:17:32 INFO - PROCESS | 20070 | RSS: Main: 167288832 10:17:32 INFO - PROCESS | 20070 | 10:20:34 INFO - PROCESS | 20070 | Cycle 1(1): loaded http://localhost:49867/tests/dromaeo/cssquery-ext.html (next: http://localhost:49867/tests/dromaeo/cssquery-jquery.html) 10:20:35 INFO - PROCESS | 20070 | RSS: Main: 166137856 10:20:35 INFO - PROCESS | 20070 | 10:23:36 INFO - PROCESS | 20070 | Cycle 1(1): loaded http://localhost:49867/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49867/tests/dromaeo/cssquery-mootools.html) 10:23:37 INFO - PROCESS | 20070 | RSS: Main: 167124992 10:23:37 INFO - PROCESS | 20070 | 10:26:39 INFO - PROCESS | 20070 | Cycle 1(1): loaded http://localhost:49867/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49867/tests/dromaeo/cssquery-prototype.html) 10:26:39 INFO - PROCESS | 20070 | RSS: Main: 165113856 10:26:39 INFO - PROCESS | 20070 | 10:29:42 INFO - PROCESS | 20070 | Cycle 1(1): loaded http://localhost:49867/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49867/tests/dromaeo/cssquery-yui.html) 10:29:42 INFO - PROCESS | 20070 | RSS: Main: 166092800 10:29:42 INFO - PROCESS | 20070 | 10:32:45 INFO - PROCESS | 20070 | Cycle 1(1): loaded http://localhost:49867/tests/dromaeo/cssquery-yui.html (next: http://localhost:49867/tests/dromaeo/cssquery-dojo.html) 10:32:45 INFO - PROCESS | 20070 | RSS: Main: 168218624 10:32:45 INFO - PROCESS | 20070 | 10:32:45 INFO - PROCESS | 20070 | __start_tp_report 10:32:45 INFO - PROCESS | 20070 | _x_x_mozilla_page_load 10:32:45 INFO - PROCESS | 20070 | _x_x_mozilla_page_load_details 10:32:45 INFO - PROCESS | 20070 | |i|pagename|runs| 10:32:45 INFO - PROCESS | 20070 | |0;dojo.html;3245.5618491503647;3257.3973814844258;3281.442154833678;3291.2265617579865;3314.7679662423625;5538.446155384465;5551.944480555193;5589.021921163795;5603.467670571299;5649.519790817785;5530.917036244449;5574.1917421973785;5599.440055994409;5664.518515926151;5678.517326027282;5045.4197767256865;5081.136206844845;5186.896262074756;5202.375714914197;5221.843344699646;584.9449162659026;5185.662931909414;5202.92195617066;5225.03336882676;5238.240455134003;5099.235114732801;5113.335266415361;5122.743862806863;5140.434552199255;5149.562287205592;5004.649674522785;5111.309973153614;5117;5117.7185254810975;5121.2318152277085;5047.520485553867;5049.974750126225;5053.039922414766;5063.594912407036;5083.745812709387;5531.502164805147;5544.972275138599;5562;5587.0502014657195;5595.433839856518;6008.158857759917;6038.2150320458495;6062.1209924561135;6067.605605635619;6087.695615219265;6120.510359171256;6144.863200307913;6145.4161854623735;6157.384261573851;6163.445289923929;5697.629654072513;5720.856978575527;5723.685197314146;5724.284464441945;5753.568482363798;6022.789202377896;6139.246828488627;6187.443130118311;6203.906941395882;6204.162438070803;5962.970185149134;5966.105084237399;6006.069059295816;6048.455638992512;6050.152978583002;6074.240719910012;6100.267967843798;6102.115193296947;6103.328633850273;6113.419225173601;5843.2403787507355;5960.791372301948;6000.459958603659;6027.8794424111275;6063.454289114001;5809.070548712186;5919;5961.910571341434;6011.308699499614;6061.605995610271;4487.865364039084;4506.233940230169;4516.81932722694;4518.9548104518535;4554.931676024796;3982.820773065219;3990.06233535119;4012.337964235927;4029.294873397144;4035.515738111387;5692.430756924357;5699.2590963174525;5719.5138413235345;5721.914171287434;5727.828165155052;6024.427679370453;6042.6072305300895;6077.878442431215;6093.268807743099;6097.085437184369;5623.887522249532;5699.287589051369;5705.229793977843;5717.514011309002;5720.2849643794525;5106.617003724736;5114.64197506171;5116.053530096944;5122.564582010571;5127.743612819344;6089;6214.378562143749;6222.284437289679;6230.968845155836;6236.220472440945;6034.939650603438;6057.7879774207695;6063.333033366414;6081.087836824512;6102;6253.437190652863;6258.12386265914;6264.49884009269;6280.026595877646;6282.089097080989;5830.329512106162;5865.442782935615;5965.224520812267;5967.6121052131475;6009.609375390585;5975.37258587842;6020.548458865515;6029.974904266198;6036.275646922398;6067.969660151671;5797.101449275369;5818.592698511233;5852.619579727304;5855.560832937462;5862.970685146547;5728.656280623176;5859.970700146472;5879.764809407747;5886.470217680429;5904.9704751475965;5596.524295434933;5610.971945140412;5638.85902852432;5661.207430959751;5886.3525012247765;5770.3652598215;5772.509336706427;5799.101139323411;5806.767729290781;5813.854653633693;5776.7111644418455;5786.768529258951;5827.096799996008;5883.823485295448;5891.204687367151 10:32:45 INFO - PROCESS | 20070 | |1;ext.html;576.8298351986164;646.7962591783588;661.5071771530211;662.9569078009932;679.8368391586021;38740.22519549611;42386.7880660597;42582.57417425825;42672.14655706884;42961.78519107404;43712.3443148353;44067.77966110173;44091.77954110233;44379.334309985374;44384.55615443845;8740.650373985032;8981.326400519954;8994.055624159468;8996.730098097067;9017.909820901805;8763.298936085097;8886.86669699955;8901.510416927067;8914.821703565925;8928.687495937644;8861.202491775739;8944.463332200088;8949.552522373888;8955.283577313832;8961.686340978067;8876.201141897229;8877.334199934998;8884.555772211364;8890.73327800167;8931.285497160245;8754.037055923844;8820;8830.381873268874;8868.733937981806;8870.556472176366;40114.39828402576;40128;40476.190476190604;40488.380464781374;40492;3455.1362159460136;3520.2783429396914;3524.8766293179615;3656.104254457675;4028.1742242840146;32450.18874528132;32596.83701581477;32715.345693086005;32785.50821737676;34430.31139377224;4108.732932359387;4110.609492098246;4120.608542188487;4219.873403797891;4306.590873866978;336118;336544;337389;337530;338164.99999999756;32803.34393312121;33348.83325583357;33503.16242093918;53327;54584.72707636436;37863.24273514569;38234.426483602765;38250.234995299936;38277.42583861244;38323.233535329135;15459.690806183813;15544.689106218038;15577.221138943007;15594.766078508832;15610.76583851243;13148.737025259441;13206.33968301581;13207;13235.801462978063;13241.933790330986;8576.271016963503;8686;8706.738797836075;8724.607392667218;8757.605907734167;3290.0952238134228;3314.204590898167;3369.646187150314;3395.762296639261;3446.672566106216;1034.6740776655329;1037.4501514197336;1128.4696192789377;1165.2309475745967;1198.4726720243066;32464.67535324664;32746;32780.344393112005;33019.504707429405;33954.66045339515;1149.287441786098;1150.8273758936227;1170.1633332167542;1202.392791640216;1230.3171739684383;17471.91264043697;17503.299868005393;17531.123443827757;17678.734818977468;17924.608470924446;503504;508377;508745;509787;512677;58240.41759582435;58747.41252587505;58779;59416;59477.70261148667;1440.4598275646633;1441.3730027438098;1445.9710805784036;1455.0978393396163;1459.0370355565276;30572;31891.521627175145;32679.836600816845;32897.50653740148;33386.16534586558;51789.7410512945;51827.74086129545;52383;52444;52470.21294680659;447877;451906;452546;452582;454545;28398.148055558366;29458.263543411587;29508.704912950594;29571;29689.734129245335;47395.289070663275;48382.758086209345;49015.26477102775;49272.50727492679;52668.736656316476;42266.57733422749;43926.560734392246;43984.780076099414;44271;45193;42408.78795606126;42554.148917020866;42754.35868461913;42833;43541.78229108834;42553.361699573914;43443.131137377706;43467.782661086494;43851.342229867216;46033.30950035819;35470.64529354673;37562.436563451025;37675;37962.240755185296;38055.42916856194;29598;29670.554941675462;29762;29796.255093622833;30047.248818779706 10:32:45 INFO - PROCESS | 20070 | |2;jquery.html;404.30661415672154;407.1389012239113;408.54447291270236;417.41978649676946;428.0518651187619;15723.213839308046;17999.370022049214;18795.906020469913;19666.803331966676;19713.408597742073;18491.630167396645;18657.440276791684;18700.53248668784;19065.428037158872;19104.522386940334;5593.328800543941;5727.914081288784;5771.2497375341145;5809.244798176232;5818.156367326735;5575.442455754413;5679.261695979517;5699.430056994309;5721.170430287606;5729.799457019005;5651.2653355063785;5652.604317697763;5661.7735290588325;5683.658980461186;5685.317761868581;5581.274434323512;5606.859828504279;5651.9152212716845;5668.773249070032;5679.517241034517;4984.22744474607;5082.161443361878;5114.207297868799;5176.120059589879;5178.119719647631;21613.891930540405;22001.779982200133;22465.438364040867;22689.77310226893;22715.77284227153;2341.4497593065616;2370.3007612754277;2375.5011447596025;2448.1431498975394;2515.2328539795353;13764.93117534406;14314.284285785669;14518.70962580753;14574.854251457562;14910.105393676415;1974.2300502803919;2019.919203231869;2021.6765317549268;2026.6554685703466;2047.375550457125;80213.59893200497;80762.59618701869;81976;82967;83345.58327208325;10493.947530262452;10688.465576721133;10784.13726901846;10856.945715271373;10981.39602321864;13107.606771796862;13584.388702508411;14436.422543098159;15161.696766064617;15210.771838422432;8060.4760690556095;8154.143814899468;8398.496090234605;8645.351598630128;8687.305015598737;8073;8079.636416361278;8375.664973400995;8452.226867211255;8497.107803680648;6572.934270657328;6607.537472376984;6614.107095542136;6630.911262952155;6694.732210711517;1964.083336245674;1985.1761518969754;2000.2798992362739;2000.5698774763496;2001.109506269696;982.9459379734184;1003.6236411345745;1030.3457304611625;1105.3754628634956;1121.159130652011;17896;19127.713084303745;19145.329913452963;19229.519262018563;19495.415137545613;1026.481626778472;1030.175859312547;1076.3488089705772;1104.6354702948008;1110.1119104716195;10589.576416943237;10733.302335348177;10778.730531736612;10861.239713219999;10943.233973621771;470021;474306;474655;484832;485457;87931;97809;98440;99654;100176;1056.915446764257;1081.6268387406333;1092.0171845339257;1101.8512500812449;1120.1934607082887;17313.710395024904;17332.480025599252;17343.2195551198;17555.297788088334;17642.294308227527;33175.66824331822;38371.2325753489;39756.403653945796;43297;45456;56417.71791141018;59014.70492647509;59975;60374.396256036875;60475.395246048734;8745.256653184551;8756.299496040174;8829.911700883165;8977.91022089797;8984.23633991118;9902.752431189278;13035.674108147372;13133.408996594984;13176.670583235496;13770.724585508435;12055.095867810125;12058.51765929353;12233.938830305791;12312.076594255288;12315.876841231831;11124.388158651353;11662.475188616701;11857.52569897229;11860.169788115094;12045;11604.825927611262;12071.67211606705;12072.637820865388;12439.75120497567;12582.937085314516;7194.136703595602;7464.888026679496;7695.769126926201;8768.78078048054;8875.245604123464;8639.524826134622;11395.145364097893;11812.940935295268;11910.344931028876;11960.282383057045 10:32:45 INFO - PROCESS | 20070 | |3;mootools.html;1501.8948673592847;1561.5549568373015;1678.3789997700853;1853.7034074548067;1855.9072046397678;8035.357171426286;8840.160184782451;9047.366684332092;9704.223662107031;9711.951440242789;8886.42238254513;9034.90965090349;9181.540922953858;9245.907540924589;9281.257499400048;2404.290734233401;2466.0382450844186;2469.4196863737006;2470.086068154785;2471;2390.784829365357;2458.3731148557094;2461.9261422157365;2466.2971053249826;2467.679201703776;2384.0084375590804;2392.7726865947707;2416.9395765105837;2426.7209270933804;2435.5250726108416;2375.3349062262596;2392.8923198456023;2396.856188628688;2405.3505553500545;2406.1698713943747;2387.7850993410675;2400.3399065257017;2401.363638635763;2402.1952645863657;2402.3513651314047;8949;9005.279577633839;9051.637934482613;9069.183773460354;9077.773055673595;5578.358488773762;5671;5702.230198923134;5719.914201286984;5723.399043100456;3577.105723569108;3585.15748799032;3706.8517259309597;3736.7757934523743;3754.6057663945166;1166.119579717308;1180.6871179137536;1181.6750393641732;1188.2632767684004;1199.9760004799855;12928.87071129286;13138;13179.60461186166;13187.802182967167;13209.40557674907;4928.827491037868;4972.105021096165;5076.771545280471;5101.081805275012;5101.744912754348;11183.161262905314;11232.494537745657;11244.943775281072;11288.492017859217;11292.096632269398;5674.2623458950075;5784.103463963008;5800.970995144998;5840.123981402823;5867.207926929896;4559;5099.286099946011;5147.716875571879;5208.322918020633;5354.651947623392;4257.1698518788535;4271.829126834892;4338.739675619473;4398.23030969579;4399.472063352418;1353.8984576156827;1357.4525041452753;1367.9110857794212;1380.7376598446263;1383.75784237758;900.486722568143;951.2104952889085;974.4591751577942;1001.2640709078821;1048.2138396202847;6103.176071230416;6119.143319935212;6182.072689096582;6280.497560195174;6354;487.6732589165268;488.2895387211599;492.70191534122057;501.7340809371039;503.12205201922876;4181.247375472383;4210.936835947463;4274.786260686953;4329.891752706208;4345.760983145958;11073.280236784583;11345.432728363548;11511.079113670887;11519.48162332697;11551.826722599;11389.65831025054;11448.141389395829;11490.827637585442;11499.655010349703;11507.309561426342;8388.8741668875;8459.492430454193;8676.262517685942;8678;8852.734417967342;6305.464035557029;6451.225852897683;6548.3124271950755;6567.047778072058;6593.944968804968;10502.317349372266;10571;10587.735306617396;10678.946605266923;10693.786124277316;10510.316829406063;10658.573657053632;10791;10821.67534973952;10823.621173259213;7494.887576686245;8168.305694016075;8264;8376.748697539084;8378.706745263886;9285.442873427615;9286.535673216447;9335.719928402159;9370.859437108586;9375.765605859635;8225.259726624632;8381;8387.748367548984;8501.744947651581;8579.871301930601;8037.799055023671;8051.718189863327;8114.391420643357;8220.383471239562;8279.54462504568;7256.383207427428;7268.127824661075;7325.926740732738;7392.4086073115095;7403.666834992546;5214.42641309448;5239.26650268955;5241.135212689864;5245.868853278546;5302.098643230583;5348.5186333230195;5356.223347614652;5427.891442171055;5465.016297066566;5504.889902201853 10:32:45 INFO - PROCESS | 20070 | |4;prototype.html;335.76664218368234;342.3956716395561;343.23116219667946;346.6100636783618;351.3254551261579;5613.326400831901;5645.294338207729;5653.886922261562;5685.8578535536635;5687.431256874311;5561.443855614447;5591.384947655754;5615.831525054255;5620.269364982547;5633.183188437674;4190.203861266365;4273.145370925812;4334.32817913224;4348.086901750637;4401.80191891364;4292.892677683051;4307.117041006586;4339.110482351126;4346.848310086496;4380.824767009316;4326.718763280377;4331.5884990925815;4356.324769660692;4373.1690978714105;4385.8245670173155;4281.314989601648;4289.613934745872;4325.264705000158;4389.363542286351;4390.8024138913825;3809.580946095927;3821.14024344523;3844.808109486068;3860.768353898747;3881.340172170738;5415.1335786274;5415.6479828811;5421.241026256327;5428.8328009478155;5453.481919217668;4938.160512712811;4994.450610432849;5020.347354843847;5022.874428139326;5057.443681195065;5884.264466941632;5887.4406931341455;5896.734646940855;5905.320888097881;5984.880302393928;4321.719088259285;4327.242732521796;4329.675274354405;4337.587929146726;4338.305871060616;6038.939610603882;6099.194370589534;6114.96942515289;6125.387461253839;6134;4363.19280933022;4376.081022985209;4394;4401.823927042947;4413.801378937956;4370.8907277317685;4417.801198946056;4424.225760491965;4445.533219012022;4452.332150177499;4830.203016502238;4965.726885021359;4968.453470118284;4973.35346404965;4983.8504844854715;5831;5871.209281169285;5876;5893.852653683693;5928.407159284037;1483.5326872035275;1504.8720858726913;1511.2997877387938;1528.9923550382177;1536.109056747084;965.5220665770488;982.3025651787311;988.3378136648463;1037.0096557787294;1050.448514529878;5606.523445507096;5628.74670639814;5657.80197693087;5678.545716342683;5692.893629357164;6008.969955150196;6039.308993481832;6052.697365131726;6059.333473317932;6080.635161890301;5503.532199762985;5551.555875530029;5626.946164649873;5655.6606603603095;5667.263255776723;3164.6423414556302;3217.6485875932167;3228.6923795862713;3230.8384580770867;3244.367348367046;6047;6151.771668289742;6188.350223226586;6236.968815155895;6261.499080073583;6102.572819902564;6144.723487443076;6156.846078848064;6166.691665416712;6176.969115154396;5976.8804623908145;6135.263768347738;6154.599951003171;6196.690165491707;6205.928065607553;5824.94175058244;5926.288845338415;5962.701864906824;5971.522278217819;5994.160817485468;5881.500072493886;5894.469497745224;5900.970495147497;5914.881702366015;5957.523398128226;5939.406059394026;6180.245604822922;6242.032484964838;6268.592541484789;6273.874522509615;4363.520012798653;4381.890452738707;4382.496012958551;4399.890002749957;4423.712458690175;6009.669468179292;6048.5161187105805;6058.242719660043;6080.8750381179625;6089.177960975212;5581.665100094007;5911.349751527243;5926.881462370642;5943.316518600416;5945.840561090546;5970.641761494324;5986.311574169026;5998.370171131968;6001.339852616122;6026.397360263939;5276.707206734374;5790.160426738184;5794.275715535558;5816.331121921034;5863.706814659165;5878.412158784087;5887.8233652990475;5905.578712727761;5907.113932909926;5937.079752638348;5533.363663178625;5717.971410142923;5742.741576629145;5745.454181852718;5769.884602307847 10:32:45 INFO - PROCESS | 20070 | |5;yui.html;737.8745613245748;756.6405957170343;813.7762115418259;833.8665813469843;872.4198408058642;14549.490767823128;15051.096934183957;15272.541823745278;15283.694326113471;15288.464903728373;14137.151770893754;14151.858481415184;14203.644908877282;14214.431422743079;14231.58063129268;695.3046953046953;797.2505844506175;825.9132791056927;828.7720876758909;831.4512421801612;831.6049876308736;832.9250367466926;833.8874251975997;840.2983508770184;843.1779015459908;878.8813510176141;879.8416285068685;890.0520945193381;890.3900827932854;892.8437523433406;881.1981097201548;886.9068747781519;886.9911300886973;887.9023307436177;888.8533391990314;643.1510406263734;643.9678016099176;644.4200219802169;644.9806505804834;645.8514541655445;14091.718165636732;14103.435862565486;14185.219812910285;14191.361388737429;14217.50238741639;14041.508547200901;14380.712385752226;14447.78328325076;14579.271036448241;14698.11811291326;11812.940935295355;11838.644840654708;11996.460159292852;12019.338936358497;12048.939755301168;3937.598065180238;4004.739691920045;4033.1328764315813;4034.8184331705143;4037;57048.714756426365;58099.70950145264;58248.70875645637;58795;58921.41078589202;11363.204575679789;11528.884711152781;11606.937571849785;11722.824157637642;11833.88166118345;21021.579568408546;21033.15867365319;21039.474013149793;21040.89479552623;21047.263345782823;8353.122922093215;8446.662133514714;8474.27968622674;8583.828323433496;8792.34057445694;4858.3441235432765;4925.178984579064;4996.625253106032;4998.400191976986;5074.974625126851;3398.1164897126923;3483.390406678872;3486.599041110305;3494.685478306965;3494.965050349515;605.379486026826;616.4852348289229;626.1109224900651;627.7112528237062;627.8116565030473;709.1773542690454;733.3106879533221;807.7617102954642;819.2708489444399;826.5330088499978;9307.72076837696;9385.671501497414;9557;9687.41875487473;9760.609575617038;744.199985016099;772.7256823827461;784.1609477858636;791.3945831438954;795.920407959211;4721.5986641135205;4775.403074615673;4936.679115857458;4979.576735977483;5029.1450453423;61508;63468.36531634717;63541.682291588244;69409.30590694028;71056.289437106;59265.40734592599;59374.40625593775;59593;60736.39263607396;61526.38473615207;53733.46266537363;54076.18885716639;54976;55240.44759552433;56000.719996399755;9820.803583928424;9925.851112233178;9941.900580994097;10040.096391324816;10124.190064794651;37607.811960940024;37832.62167378401;38182.8090859555;38282.42576361413;38860;48235.276470852266;51141;51320.230196547825;52057;52169.47830521798;12844.807327890276;12854.807177892526;13065.738685226432;13085.934570327468;13116.899333217021;14237.21695306768;14409;14476.420943162155;14509.85490145085;14588.34352454121;13565.118267312593;13936.303184840921;14029.929850350683;14140.50508232207;14147.363368648641;12834.16099200101;12838.29389383593;13473.461061557427;13610.523631672844;14912.478063267734;13250.536231231861;13853.238071906142;13932.442702291795;13983.440662373798;14159.44246132904;10851.945740271249;10968.341899486057;11081;11280.830787538358;11346.602868899548;11101.833472497758;11252.386197684238;11409.144314176305;11415.942920285346;11649.708757281136 10:32:45 INFO - PROCESS | 20070 | __end_tp_report 10:32:45 INFO - PROCESS | 20070 | __start_cc_report 10:32:45 INFO - PROCESS | 20070 | _x_x_mozilla_cycle_collect,336 10:32:45 INFO - PROCESS | 20070 | __end_cc_report 10:32:45 INFO - PROCESS | 20070 | __startTimestamp1463074365503__endTimestamp 10:32:45 INFO - PROCESS | 20070 | 10:32:45 INFO - PROCESS | 20070 | ------- Summary: start ------- 10:32:45 INFO - PROCESS | 20070 | Number of tests: 6 10:32:45 INFO - PROCESS | 20070 | 10:32:45 INFO - PROCESS | 20070 | [#0] dojo.html Cycles:165 Average:5559.47 Median:5786.77 stddev:755.86 (13.1%) stddev-sans-first:736.06 10:32:45 INFO - PROCESS | 20070 | Values: 3245.6 3257.4 3281.4 3291.2 3314.8 5538.4 5551.9 5589.0 5603.5 5649.5 5530.9 5574.2 5599.4 5664.5 5678.5 5045.4 5081.1 5186.9 5202.4 5221.8 584.9 5185.7 5202.9 5225.0 5238.2 5099.2 5113.3 5122.7 5140.4 5149.6 5004.6 5111.3 5117.0 5117.7 5121.2 5047.5 5050.0 5053.0 5063.6 5083.7 5531.5 5545.0 5562.0 5587.1 5595.4 6008.2 6038.2 6062.1 6067.6 6087.7 6120.5 6144.9 6145.4 6157.4 6163.4 5697.6 5720.9 5723.7 5724.3 5753.6 6022.8 6139.2 6187.4 6203.9 6204.2 5963.0 5966.1 6006.1 6048.5 6050.2 6074.2 6100.3 6102.1 6103.3 6113.4 5843.2 5960.8 6000.5 6027.9 6063.5 5809.1 5919.0 5961.9 6011.3 6061.6 4487.9 4506.2 4516.8 4519.0 4554.9 3982.8 3990.1 4012.3 4029.3 4035.5 5692.4 5699.3 5719.5 5721.9 5727.8 6024.4 6042.6 6077.9 6093.3 6097.1 5623.9 5699.3 5705.2 5717.5 5720.3 5106.6 5114.6 5116.1 5122.6 5127.7 6089.0 6214.4 6222.3 6231.0 6236.2 6034.9 6057.8 6063.3 6081.1 6102.0 6253.4 6258.1 6264.5 6280.0 6282.1 5830.3 5865.4 5965.2 5967.6 6009.6 5975.4 6020.5 6030.0 6036.3 6068.0 5797.1 5818.6 5852.6 5855.6 5863.0 5728.7 5860.0 5879.8 5886.5 5905.0 5596.5 5611.0 5638.9 5661.2 5886.4 5770.4 5772.5 5799.1 5806.8 5813.9 5776.7 5786.8 5827.1 5883.8 5891.2 10:32:45 INFO - PROCESS | 20070 | 10:32:45 INFO - PROCESS | 20070 | [#1] ext.html Cycles:180 Average:58461.49 Median:4115.61 stddev:116284.66 (2825.5%) stddev-sans-first:116529.66 10:32:45 INFO - PROCESS | 20070 | Values: 576.8 646.8 661.5 663.0 679.8 38740.2 42386.8 42582.6 42672.1 42961.8 43712.3 44067.8 44091.8 44379.3 44384.6 8740.7 8981.3 8994.1 8996.7 9017.9 8763.3 8886.9 8901.5 8914.8 8928.7 8861.2 8944.5 8949.6 8955.3 8961.7 8876.2 8877.3 8884.6 8890.7 8931.3 8754.0 8820.0 8830.4 8868.7 8870.6 40114.4 40128.0 40476.2 40488.4 40492.0 3455.1 3520.3 3524.9 3656.1 4028.2 32450.2 32596.8 32715.3 32785.5 34430.3 4108.7 4110.6 4120.6 4219.9 4306.6 336118.0 336544.0 337389.0 337530.0 338165.0 32803.3 33348.8 33503.2 53327.0 54584.7 37863.2 38234.4 38250.2 38277.4 38323.2 15459.7 15544.7 15577.2 15594.8 15610.8 13148.7 13206.3 13207.0 13235.8 13241.9 8576.3 8686.0 8706.7 8724.6 8757.6 3290.1 3314.2 3369.6 3395.8 3446.7 1034.7 1037.5 1128.5 1165.2 1198.5 32464.7 32746.0 32780.3 33019.5 33954.7 1149.3 1150.8 1170.2 1202.4 1230.3 17471.9 17503.3 17531.1 17678.7 17924.6 503504.0 508377.0 508745.0 509787.0 512677.0 58240.4 58747.4 58779.0 59416.0 59477.7 1440.5 1441.4 1446.0 1455.1 1459.0 30572.0 31891.5 32679.8 32897.5 33386.2 51789.7 51827.7 52383.0 52444.0 52470.2 447877.0 451906.0 452546.0 452582.0 454545.0 28398.1 29458.3 29508.7 29571.0 29689.7 47395.3 48382.8 49015.3 49272.5 52668.7 42266.6 43926.6 43984.8 44271.0 45193.0 42408.8 42554.1 42754.4 42833.0 43541.8 42553.4 43443.1 43467.8 43851.3 46033.3 35470.6 37562.4 37675.0 37962.2 38055.4 29598.0 29670.6 29762.0 29796.3 30047.2 10:32:45 INFO - PROCESS | 20070 | 10:32:45 INFO - PROCESS | 20070 | [#2] jquery.html Cycles:180 Average:28882.75 Median:22577.61 stddev:78976.59 (349.8%) stddev-sans-first:79169.19 10:32:45 INFO - PROCESS | 20070 | Values: 404.3 407.1 408.5 417.4 428.1 15723.2 17999.4 18795.9 19666.8 19713.4 18491.6 18657.4 18700.5 19065.4 19104.5 5593.3 5727.9 5771.2 5809.2 5818.2 5575.4 5679.3 5699.4 5721.2 5729.8 5651.3 5652.6 5661.8 5683.7 5685.3 5581.3 5606.9 5651.9 5668.8 5679.5 4984.2 5082.2 5114.2 5176.1 5178.1 21613.9 22001.8 22465.4 22689.8 22715.8 2341.4 2370.3 2375.5 2448.1 2515.2 13764.9 14314.3 14518.7 14574.9 14910.1 1974.2 2019.9 2021.7 2026.7 2047.4 80213.6 80762.6 81976.0 82967.0 83345.6 10493.9 10688.5 10784.1 10856.9 10981.4 13107.6 13584.4 14436.4 15161.7 15210.8 8060.5 8154.1 8398.5 8645.4 8687.3 8073.0 8079.6 8375.7 8452.2 8497.1 6572.9 6607.5 6614.1 6630.9 6694.7 1964.1 1985.2 2000.3 2000.6 2001.1 982.9 1003.6 1030.3 1105.4 1121.2 17896.0 19127.7 19145.3 19229.5 19495.4 1026.5 1030.2 1076.3 1104.6 1110.1 10589.6 10733.3 10778.7 10861.2 10943.2 470021.0 474306.0 474655.0 484832.0 485457.0 87931.0 97809.0 98440.0 99654.0 100176.0 1056.9 1081.6 1092.0 1101.9 1120.2 17313.7 17332.5 17343.2 17555.3 17642.3 33175.7 38371.2 39756.4 43297.0 45456.0 56417.7 59014.7 59975.0 60374.4 60475.4 8745.3 8756.3 8829.9 8977.9 8984.2 9902.8 13035.7 13133.4 13176.7 13770.7 12055.1 12058.5 12233.9 12312.1 12315.9 11124.4 11662.5 11857.5 11860.2 12045.0 11604.8 12071.7 12072.6 12439.8 12582.9 7194.1 7464.9 7695.8 8768.8 8875.2 8639.5 11395.1 11812.9 11910.3 11960.3 10:32:45 INFO - PROCESS | 20070 | 10:32:45 INFO - PROCESS | 20070 | [#3] mootools.html Cycles:180 Average:6133.58 Median:2710.76 stddev:3510.59 (129.5%) stddev-sans-first:3503.19 10:32:45 INFO - PROCESS | 20070 | Values: 1501.9 1561.6 1678.4 1853.7 1855.9 8035.4 8840.2 9047.4 9704.2 9712.0 8886.4 9034.9 9181.5 9245.9 9281.3 2404.3 2466.0 2469.4 2470.1 2471.0 2390.8 2458.4 2461.9 2466.3 2467.7 2384.0 2392.8 2416.9 2426.7 2435.5 2375.3 2392.9 2396.9 2405.4 2406.2 2387.8 2400.3 2401.4 2402.2 2402.4 8949.0 9005.3 9051.6 9069.2 9077.8 5578.4 5671.0 5702.2 5719.9 5723.4 3577.1 3585.2 3706.9 3736.8 3754.6 1166.1 1180.7 1181.7 1188.3 1200.0 12928.9 13138.0 13179.6 13187.8 13209.4 4928.8 4972.1 5076.8 5101.1 5101.7 11183.2 11232.5 11244.9 11288.5 11292.1 5674.3 5784.1 5801.0 5840.1 5867.2 4559.0 5099.3 5147.7 5208.3 5354.7 4257.2 4271.8 4338.7 4398.2 4399.5 1353.9 1357.5 1367.9 1380.7 1383.8 900.5 951.2 974.5 1001.3 1048.2 6103.2 6119.1 6182.1 6280.5 6354.0 487.7 488.3 492.7 501.7 503.1 4181.2 4210.9 4274.8 4329.9 4345.8 11073.3 11345.4 11511.1 11519.5 11551.8 11389.7 11448.1 11490.8 11499.7 11507.3 8388.9 8459.5 8676.3 8678.0 8852.7 6305.5 6451.2 6548.3 6567.0 6593.9 10502.3 10571.0 10587.7 10678.9 10693.8 10510.3 10658.6 10791.0 10821.7 10823.6 7494.9 8168.3 8264.0 8376.7 8378.7 9285.4 9286.5 9335.7 9370.9 9375.8 8225.3 8381.0 8387.7 8501.7 8579.9 8037.8 8051.7 8114.4 8220.4 8279.5 7256.4 7268.1 7325.9 7392.4 7403.7 5214.4 5239.3 5241.1 5245.9 5302.1 5348.5 5356.2 5427.9 5465.0 5504.9 10:32:45 INFO - PROCESS | 20070 | 10:32:45 INFO - PROCESS | 20070 | [#4] prototype.html Cycles:180 Average:4953.90 Median:5639.24 stddev:1448.64 (25.7%) stddev-sans-first:1410.63 10:32:45 INFO - PROCESS | 20070 | Values: 335.8 342.4 343.2 346.6 351.3 5613.3 5645.3 5653.9 5685.9 5687.4 5561.4 5591.4 5615.8 5620.3 5633.2 4190.2 4273.1 4334.3 4348.1 4401.8 4292.9 4307.1 4339.1 4346.8 4380.8 4326.7 4331.6 4356.3 4373.2 4385.8 4281.3 4289.6 4325.3 4389.4 4390.8 3809.6 3821.1 3844.8 3860.8 3881.3 5415.1 5415.6 5421.2 5428.8 5453.5 4938.2 4994.5 5020.3 5022.9 5057.4 5884.3 5887.4 5896.7 5905.3 5984.9 4321.7 4327.2 4329.7 4337.6 4338.3 6038.9 6099.2 6115.0 6125.4 6134.0 4363.2 4376.1 4394.0 4401.8 4413.8 4370.9 4417.8 4424.2 4445.5 4452.3 4830.2 4965.7 4968.5 4973.4 4983.9 5831.0 5871.2 5876.0 5893.9 5928.4 1483.5 1504.9 1511.3 1529.0 1536.1 965.5 982.3 988.3 1037.0 1050.4 5606.5 5628.7 5657.8 5678.5 5692.9 6009.0 6039.3 6052.7 6059.3 6080.6 5503.5 5551.6 5626.9 5655.7 5667.3 3164.6 3217.6 3228.7 3230.8 3244.4 6047.0 6151.8 6188.4 6237.0 6261.5 6102.6 6144.7 6156.8 6166.7 6177.0 5976.9 6135.3 6154.6 6196.7 6205.9 5824.9 5926.3 5962.7 5971.5 5994.2 5881.5 5894.5 5901.0 5914.9 5957.5 5939.4 6180.2 6242.0 6268.6 6273.9 4363.5 4381.9 4382.5 4399.9 4423.7 6009.7 6048.5 6058.2 6080.9 6089.2 5581.7 5911.3 5926.9 5943.3 5945.8 5970.6 5986.3 5998.4 6001.3 6026.4 5276.7 5790.2 5794.3 5816.3 5863.7 5878.4 5887.8 5905.6 5907.1 5937.1 5533.4 5718.0 5742.7 5745.5 5769.9 10:32:45 INFO - PROCESS | 20070 | 10:32:45 INFO - PROCESS | 20070 | [#5] yui.html Cycles:180 Average:15949.16 Median:4891.76 stddev:18576.41 (379.7%) stddev-sans-first:18593.40 10:32:45 INFO - PROCESS | 20070 | Values: 737.9 756.6 813.8 833.9 872.4 14549.5 15051.1 15272.5 15283.7 15288.5 14137.2 14151.9 14203.6 14214.4 14231.6 695.3 797.3 825.9 828.8 831.5 831.6 832.9 833.9 840.3 843.2 878.9 879.8 890.1 890.4 892.8 881.2 886.9 887.0 887.9 888.9 643.2 644.0 644.4 645.0 645.9 14091.7 14103.4 14185.2 14191.4 14217.5 14041.5 14380.7 14447.8 14579.3 14698.1 11812.9 11838.6 11996.5 12019.3 12048.9 3937.6 4004.7 4033.1 4034.8 4037.0 57048.7 58099.7 58248.7 58795.0 58921.4 11363.2 11528.9 11606.9 11722.8 11833.9 21021.6 21033.2 21039.5 21040.9 21047.3 8353.1 8446.7 8474.3 8583.8 8792.3 4858.3 4925.2 4996.6 4998.4 5075.0 3398.1 3483.4 3486.6 3494.7 3495.0 605.4 616.5 626.1 627.7 627.8 709.2 733.3 807.8 819.3 826.5 9307.7 9385.7 9557.0 9687.4 9760.6 744.2 772.7 784.2 791.4 795.9 4721.6 4775.4 4936.7 4979.6 5029.1 61508.0 63468.4 63541.7 69409.3 71056.3 59265.4 59374.4 59593.0 60736.4 61526.4 53733.5 54076.2 54976.0 55240.4 56000.7 9820.8 9925.9 9941.9 10040.1 10124.2 37607.8 37832.6 38182.8 38282.4 38860.0 48235.3 51141.0 51320.2 52057.0 52169.5 12844.8 12854.8 13065.7 13085.9 13116.9 14237.2 14409.0 14476.4 14509.9 14588.3 13565.1 13936.3 14029.9 14140.5 14147.4 12834.2 12838.3 13473.5 13610.5 14912.5 13250.5 13853.2 13932.4 13983.4 14159.4 10851.9 10968.3 11081.0 11280.8 11346.6 11101.8 11252.4 11409.1 11415.9 11649.7 10:32:45 INFO - PROCESS | 20070 | -------- Summary: end -------- 10:32:45 INFO - PROCESS | 20070 | 10:32:46 INFO - TEST-INFO | 20070: exit 0 10:32:46 INFO - TEST-OK | dromaeo_css | took 1110172ms 10:32:46 INFO - TEST-START | kraken 10:32:46 INFO - operating with platform_type : linux_ 10:32:46 INFO - Initialising browser for kraken test... 10:32:46 INFO - TEST-INFO | started process 20304 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpUcWABH/profile http://localhost:49867/getInfo.html) 10:32:49 INFO - PROCESS | 20304 | 10:32:49 INFO - PROCESS | 20304 | (process:20374): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 10:32:50 INFO - PROCESS | 20304 | __metrics Screen width/height:1600/1200 10:32:50 INFO - PROCESS | 20304 | colorDepth:24 10:32:50 INFO - PROCESS | 20304 | Browser inner width/height: 1024/697 10:32:50 INFO - PROCESS | 20304 | __metrics 10:32:51 ERROR - PROCESS | 20304 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2946: TypeError: this.tabs is undefined 10:32:52 INFO - TEST-INFO | 20304: exit 0 10:32:52 INFO - Browser initialized. 10:32:52 INFO - Running cycle 1/1 for kraken test... 10:32:52 INFO - TEST-INFO | started process 20425 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpUcWABH/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 10:32:53 INFO - PROCESS | 20425 | 10:32:53 INFO - PROCESS | 20425 | (process:20487): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 10:33:03 INFO - PROCESS | 20425 | RSS: Main: 163926016 10:33:03 INFO - PROCESS | 20425 | 10:33:06 INFO - PROCESS | 20425 | Cycle 1(1): loaded http://localhost:49867/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49867/tests/kraken/driver.html?testName=audio-beat-detection) 10:33:07 INFO - PROCESS | 20425 | RSS: Main: 168046592 10:33:07 INFO - PROCESS | 20425 | 10:33:10 INFO - PROCESS | 20425 | Cycle 1(1): loaded http://localhost:49867/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49867/tests/kraken/driver.html?testName=audio-dft) 10:33:10 INFO - PROCESS | 20425 | RSS: Main: 168312832 10:33:10 INFO - PROCESS | 20425 | 10:33:13 INFO - PROCESS | 20425 | Cycle 1(1): loaded http://localhost:49867/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49867/tests/kraken/driver.html?testName=audio-fft) 10:33:14 INFO - PROCESS | 20425 | RSS: Main: 162844672 10:33:14 INFO - PROCESS | 20425 | 10:33:16 INFO - PROCESS | 20425 | Cycle 1(1): loaded http://localhost:49867/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49867/tests/kraken/driver.html?testName=audio-oscillator) 10:33:17 INFO - PROCESS | 20425 | RSS: Main: 163086336 10:33:17 INFO - PROCESS | 20425 | 10:33:19 INFO - PROCESS | 20425 | Cycle 1(1): loaded http://localhost:49867/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49867/tests/kraken/driver.html?testName=imaging-gaussian-blur) 10:33:19 INFO - PROCESS | 20425 | RSS: Main: 163532800 10:33:19 INFO - PROCESS | 20425 | 10:33:23 INFO - PROCESS | 20425 | Cycle 1(1): loaded http://localhost:49867/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49867/tests/kraken/driver.html?testName=imaging-darkroom) 10:33:23 INFO - PROCESS | 20425 | RSS: Main: 163598336 10:33:23 INFO - PROCESS | 20425 | 10:33:27 INFO - PROCESS | 20425 | Cycle 1(1): loaded http://localhost:49867/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49867/tests/kraken/driver.html?testName=imaging-desaturate) 10:33:27 INFO - PROCESS | 20425 | RSS: Main: 162177024 10:33:27 INFO - PROCESS | 20425 | 10:33:30 INFO - PROCESS | 20425 | Cycle 1(1): loaded http://localhost:49867/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49867/tests/kraken/driver.html?testName=json-parse-financial) 10:33:31 INFO - PROCESS | 20425 | RSS: Main: 162676736 10:33:31 INFO - PROCESS | 20425 | 10:33:33 INFO - PROCESS | 20425 | Cycle 1(1): loaded http://localhost:49867/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49867/tests/kraken/driver.html?testName=json-stringify-tinderbox) 10:33:33 INFO - PROCESS | 20425 | RSS: Main: 162926592 10:33:33 INFO - PROCESS | 20425 | 10:33:35 INFO - PROCESS | 20425 | Cycle 1(1): loaded http://localhost:49867/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49867/tests/kraken/driver.html?testName=stanford-crypto-aes) 10:33:36 INFO - PROCESS | 20425 | RSS: Main: 163528704 10:33:36 INFO - PROCESS | 20425 | 10:33:38 INFO - PROCESS | 20425 | Cycle 1(1): loaded http://localhost:49867/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49867/tests/kraken/driver.html?testName=stanford-crypto-ccm) 10:33:38 INFO - PROCESS | 20425 | RSS: Main: 164024320 10:33:38 INFO - PROCESS | 20425 | 10:33:41 INFO - PROCESS | 20425 | Cycle 1(1): loaded http://localhost:49867/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49867/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 10:33:42 INFO - PROCESS | 20425 | RSS: Main: 164093952 10:33:42 INFO - PROCESS | 20425 | 10:33:44 INFO - PROCESS | 20425 | Cycle 1(1): loaded http://localhost:49867/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49867/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 10:33:45 INFO - PROCESS | 20425 | RSS: Main: 163889152 10:33:45 INFO - PROCESS | 20425 | 10:33:47 INFO - PROCESS | 20425 | Cycle 1(1): loaded http://localhost:49867/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49867/tests/kraken/driver.html?testName=ai-astar) 10:33:47 INFO - PROCESS | 20425 | RSS: Main: 165560320 10:33:47 INFO - PROCESS | 20425 | 10:33:47 INFO - PROCESS | 20425 | __start_tp_report 10:33:47 INFO - PROCESS | 20425 | _x_x_mozilla_page_load 10:33:47 INFO - PROCESS | 20425 | _x_x_mozilla_page_load_details 10:33:47 INFO - PROCESS | 20425 | |i|pagename|runs| 10:33:47 INFO - PROCESS | 20425 | |0;ai-astar;109;110;107;113;113;113;107;111;112;111 10:33:47 INFO - PROCESS | 20425 | |1;audio-beat-detection;159;125;159;215;127;156;149;129;190;126 10:33:47 INFO - PROCESS | 20425 | |2;audio-dft;163;161;162;167;165;166;172;164;163;164 10:33:47 INFO - PROCESS | 20425 | |3;audio-fft;74;74;73;156;78;77;76;75;166;75 10:33:47 INFO - PROCESS | 20425 | |4;audio-oscillator;92;91;171;92;92;91;150;93;92;146 10:33:47 INFO - PROCESS | 20425 | |5;imaging-gaussian-blur;117;118;117;117;117;118;117;117;117;118 10:33:47 INFO - PROCESS | 20425 | |6;imaging-darkroom;147;146;147;148;147;147;147;147;148;147 10:33:47 INFO - PROCESS | 20425 | |7;imaging-desaturate;96;96;96;95;96;96;95;96;97;96 10:33:47 INFO - PROCESS | 20425 | |8;json-parse-financial;56;53;55;55;56;55;55;104;54;51 10:33:47 INFO - PROCESS | 20425 | |9;json-stringify-tinderbox;59;59;59;60;60;60;59;60;59;60 10:33:47 INFO - PROCESS | 20425 | |10;stanford-crypto-aes;84;79;77;81;80;81;80;80;80;79 10:33:47 INFO - PROCESS | 20425 | |11;stanford-crypto-ccm;123;121;119;123;132;118;137;124;187;139 10:33:47 INFO - PROCESS | 20425 | |12;stanford-crypto-pbkdf2;169;159;164;158;160;158;160;162;158;158 10:33:47 INFO - PROCESS | 20425 | |13;stanford-crypto-sha256-iterative;63;63;63;63;65;61;68;62;62;63 10:33:47 INFO - PROCESS | 20425 | __end_tp_report 10:33:47 INFO - PROCESS | 20425 | __start_cc_report 10:33:47 INFO - PROCESS | 20425 | _x_x_mozilla_cycle_collect,831 10:33:47 INFO - PROCESS | 20425 | __end_cc_report 10:33:47 INFO - PROCESS | 20425 | __startTimestamp1463074427533__endTimestamp 10:33:47 INFO - PROCESS | 20425 | 10:33:47 INFO - PROCESS | 20425 | ------- Summary: start ------- 10:33:47 INFO - PROCESS | 20425 | Number of tests: 14 10:33:47 INFO - PROCESS | 20425 | 10:33:47 INFO - PROCESS | 20425 | [#0] ai-astar Cycles:10 Average:110.60 Median:111.50 stddev:2.32 (2.1%) stddev-sans-first:2.39 10:33:47 INFO - PROCESS | 20425 | Values: 109.0 110.0 107.0 113.0 113.0 113.0 107.0 111.0 112.0 111.0 10:33:47 INFO - PROCESS | 20425 | 10:33:47 INFO - PROCESS | 20425 | [#1] audio-beat-detection Cycles:10 Average:153.50 Median:157.50 stddev:29.95 (19.0%) stddev-sans-first:31.70 10:33:47 INFO - PROCESS | 20425 | Values: 159.0 125.0 159.0 215.0 127.0 156.0 149.0 129.0 190.0 126.0 10:33:47 INFO - PROCESS | 20425 | 10:33:47 INFO - PROCESS | 20425 | [#2] audio-dft Cycles:10 Average:164.70 Median:164.50 stddev:3.13 (1.9%) stddev-sans-first:3.26 10:33:47 INFO - PROCESS | 20425 | Values: 163.0 161.0 162.0 167.0 165.0 166.0 172.0 164.0 163.0 164.0 10:33:47 INFO - PROCESS | 20425 | 10:33:47 INFO - PROCESS | 20425 | [#3] audio-fft Cycles:10 Average:92.40 Median:75.00 stddev:36.26 (48.3%) stddev-sans-first:37.85 10:33:47 INFO - PROCESS | 20425 | Values: 74.0 74.0 73.0 156.0 78.0 77.0 76.0 75.0 166.0 75.0 10:33:47 INFO - PROCESS | 20425 | 10:33:47 INFO - PROCESS | 20425 | [#4] audio-oscillator Cycles:10 Average:111.00 Median:92.00 stddev:31.47 (34.2%) stddev-sans-first:32.62 10:33:47 INFO - PROCESS | 20425 | Values: 92.0 91.0 171.0 92.0 92.0 91.0 150.0 93.0 92.0 146.0 10:33:47 INFO - PROCESS | 20425 | 10:33:47 INFO - PROCESS | 20425 | [#5] imaging-gaussian-blur Cycles:10 Average:117.30 Median:117.00 stddev:0.48 (0.4%) stddev-sans-first:0.50 10:33:47 INFO - PROCESS | 20425 | Values: 117.0 118.0 117.0 117.0 117.0 118.0 117.0 117.0 117.0 118.0 10:33:47 INFO - PROCESS | 20425 | 10:33:47 INFO - PROCESS | 20425 | [#6] imaging-darkroom Cycles:10 Average:147.10 Median:147.00 stddev:0.57 (0.4%) stddev-sans-first:0.60 10:33:47 INFO - PROCESS | 20425 | Values: 147.0 146.0 147.0 148.0 147.0 147.0 147.0 147.0 148.0 147.0 10:33:47 INFO - PROCESS | 20425 | 10:33:47 INFO - PROCESS | 20425 | [#7] imaging-desaturate Cycles:10 Average:95.90 Median:96.00 stddev:0.57 (0.6%) stddev-sans-first:0.60 10:33:47 INFO - PROCESS | 20425 | Values: 96.0 96.0 96.0 95.0 96.0 96.0 95.0 96.0 97.0 96.0 10:33:47 INFO - PROCESS | 20425 | 10:33:47 INFO - PROCESS | 20425 | [#8] json-parse-financial Cycles:10 Average:59.40 Median:55.00 stddev:15.74 (28.6%) stddev-sans-first:16.65 10:33:47 INFO - PROCESS | 20425 | Values: 56.0 53.0 55.0 55.0 56.0 55.0 55.0 104.0 54.0 51.0 10:33:47 INFO - PROCESS | 20425 | 10:33:47 INFO - PROCESS | 20425 | [#9] json-stringify-tinderbox Cycles:10 Average:59.50 Median:60.00 stddev:0.53 (0.9%) stddev-sans-first:0.53 10:33:47 INFO - PROCESS | 20425 | Values: 59.0 59.0 59.0 60.0 60.0 60.0 59.0 60.0 59.0 60.0 10:33:47 INFO - PROCESS | 20425 | 10:33:47 INFO - PROCESS | 20425 | [#10] stanford-crypto-aes Cycles:10 Average:80.10 Median:80.00 stddev:1.79 (2.2%) stddev-sans-first:1.22 10:33:47 INFO - PROCESS | 20425 | Values: 84.0 79.0 77.0 81.0 80.0 81.0 80.0 80.0 80.0 79.0 10:33:47 INFO - PROCESS | 20425 | 10:33:47 INFO - PROCESS | 20425 | [#11] stanford-crypto-ccm Cycles:10 Average:132.30 Median:128.00 stddev:20.58 (16.1%) stddev-sans-first:21.55 10:33:47 INFO - PROCESS | 20425 | Values: 123.0 121.0 119.0 123.0 132.0 118.0 137.0 124.0 187.0 139.0 10:33:47 INFO - PROCESS | 20425 | 10:33:47 INFO - PROCESS | 20425 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:160.60 Median:160.00 stddev:3.57 (2.2%) stddev-sans-first:2.12 10:33:47 INFO - PROCESS | 20425 | Values: 169.0 159.0 164.0 158.0 160.0 158.0 160.0 162.0 158.0 158.0 10:33:47 INFO - PROCESS | 20425 | 10:33:47 INFO - PROCESS | 20425 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:63.30 Median:63.00 stddev:1.95 (3.1%) stddev-sans-first:2.06 10:33:47 INFO - PROCESS | 20425 | Values: 63.0 63.0 63.0 63.0 65.0 61.0 68.0 62.0 62.0 63.0 10:33:47 INFO - PROCESS | 20425 | -------- Summary: end -------- 10:33:47 INFO - PROCESS | 20425 | 10:33:48 INFO - TEST-INFO | 20425: exit 0 10:33:48 INFO - TEST-OK | kraken | took 62281ms 10:33:48 INFO - SUITE-END | took 1172s 10:33:48 INFO - Completed test suite (00:19:32) 10:33:48 INFO - javascript benchmark 10:33:48 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7318.107548264537, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3245.5618491503647, 3257.3973814844258, 3281.442154833678, 3291.2265617579865, 3314.7679662423625, 5538.446155384465, 5551.944480555193, 5589.021921163795, 5603.467670571299, 5649.519790817785, 5530.917036244449, 5574.1917421973785, 5599.440055994409, 5664.518515926151, 5678.517326027282, 5045.4197767256865, 5081.136206844845, 5186.896262074756, 5202.375714914197, 5221.843344699646, 584.9449162659026, 5185.662931909414, 5202.92195617066, 5225.03336882676, 5238.240455134003, 5099.235114732801, 5113.335266415361, 5122.743862806863, 5140.434552199255, 5149.562287205592, 5004.649674522785, 5111.309973153614, 5117.0, 5117.7185254810975, 5121.2318152277085, 5047.520485553867, 5049.974750126225, 5053.039922414766, 5063.594912407036, 5083.745812709387, 5531.502164805147, 5544.972275138599, 5562.0, 5587.0502014657195, 5595.433839856518, 6008.158857759917, 6038.2150320458495, 6062.1209924561135, 6067.605605635619, 6087.695615219265, 6120.510359171256, 6144.863200307913, 6145.4161854623735, 6157.384261573851, 6163.445289923929, 5697.629654072513, 5720.856978575527, 5723.685197314146, 5724.284464441945, 5753.568482363798, 6022.789202377896, 6139.246828488627, 6187.443130118311, 6203.906941395882, 6204.162438070803, 5962.970185149134, 5966.105084237399, 6006.069059295816, 6048.455638992512, 6050.152978583002, 6074.240719910012, 6100.267967843798, 6102.115193296947, 6103.328633850273, 6113.419225173601, 5843.2403787507355, 5960.791372301948, 6000.459958603659, 6027.8794424111275, 6063.454289114001, 5809.070548712186, 5919.0, 5961.910571341434, 6011.308699499614, 6061.605995610271, 4487.865364039084, 4506.233940230169, 4516.81932722694, 4518.9548104518535, 4554.931676024796, 3982.820773065219, 3990.06233535119, 4012.337964235927, 4029.294873397144, 4035.515738111387, 5692.430756924357, 5699.2590963174525, 5719.5138413235345, 5721.914171287434, 5727.828165155052, 6024.427679370453, 6042.6072305300895, 6077.878442431215, 6093.268807743099, 6097.085437184369, 5623.887522249532, 5699.287589051369, 5705.229793977843, 5717.514011309002, 5720.2849643794525, 5106.617003724736, 5114.64197506171, 5116.053530096944, 5122.564582010571, 5127.743612819344, 6089.0, 6214.378562143749, 6222.284437289679, 6230.968845155836, 6236.220472440945, 6034.939650603438, 6057.7879774207695, 6063.333033366414, 6081.087836824512, 6102.0, 6253.437190652863, 6258.12386265914, 6264.49884009269, 6280.026595877646, 6282.089097080989, 5830.329512106162, 5865.442782935615, 5965.224520812267, 5967.6121052131475, 6009.609375390585, 5975.37258587842, 6020.548458865515, 6029.974904266198, 6036.275646922398, 6067.969660151671, 5797.101449275369, 5818.592698511233, 5852.619579727304, 5855.560832937462, 5862.970685146547, 5728.656280623176, 5859.970700146472, 5879.764809407747, 5886.470217680429, 5904.9704751475965, 5596.524295434933, 5610.971945140412, 5638.85902852432, 5661.207430959751, 5886.3525012247765, 5770.3652598215, 5772.509336706427, 5799.101139323411, 5806.767729290781, 5813.854653633693, 5776.7111644418455, 5786.768529258951, 5827.096799996008, 5883.823485295448, 5891.204687367151], "value": 5510.135274284133, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [576.8298351986164, 646.7962591783588, 661.5071771530211, 662.9569078009932, 679.8368391586021, 38740.22519549611, 42386.7880660597, 42582.57417425825, 42672.14655706884, 42961.78519107404, 43712.3443148353, 44067.77966110173, 44091.77954110233, 44379.334309985374, 44384.55615443845, 8740.650373985032, 8981.326400519954, 8994.055624159468, 8996.730098097067, 9017.909820901805, 8763.298936085097, 8886.86669699955, 8901.510416927067, 8914.821703565925, 8928.687495937644, 8861.202491775739, 8944.463332200088, 8949.552522373888, 8955.283577313832, 8961.686340978067, 8876.201141897229, 8877.334199934998, 8884.555772211364, 8890.73327800167, 8931.285497160245, 8754.037055923844, 8820.0, 8830.381873268874, 8868.733937981806, 8870.556472176366, 40114.39828402576, 40128.0, 40476.190476190604, 40488.380464781374, 40492.0, 3455.1362159460136, 3520.2783429396914, 3524.8766293179615, 3656.104254457675, 4028.1742242840146, 32450.18874528132, 32596.83701581477, 32715.345693086005, 32785.50821737676, 34430.31139377224, 4108.732932359387, 4110.609492098246, 4120.608542188487, 4219.873403797891, 4306.590873866978, 336118.0, 336544.0, 337389.0, 337530.0, 338164.99999999756, 32803.34393312121, 33348.83325583357, 33503.16242093918, 53327.0, 54584.72707636436, 37863.24273514569, 38234.426483602765, 38250.234995299936, 38277.42583861244, 38323.233535329135, 15459.690806183813, 15544.689106218038, 15577.221138943007, 15594.766078508832, 15610.76583851243, 13148.737025259441, 13206.33968301581, 13207.0, 13235.801462978063, 13241.933790330986, 8576.271016963503, 8686.0, 8706.738797836075, 8724.607392667218, 8757.605907734167, 3290.0952238134228, 3314.204590898167, 3369.646187150314, 3395.762296639261, 3446.672566106216, 1034.6740776655329, 1037.4501514197336, 1128.4696192789377, 1165.2309475745967, 1198.4726720243066, 32464.67535324664, 32746.0, 32780.344393112005, 33019.504707429405, 33954.66045339515, 1149.287441786098, 1150.8273758936227, 1170.1633332167542, 1202.392791640216, 1230.3171739684383, 17471.91264043697, 17503.299868005393, 17531.123443827757, 17678.734818977468, 17924.608470924446, 503504.0, 508377.0, 508745.0, 509787.0, 512677.0, 58240.41759582435, 58747.41252587505, 58779.0, 59416.0, 59477.70261148667, 1440.4598275646633, 1441.3730027438098, 1445.9710805784036, 1455.0978393396163, 1459.0370355565276, 30572.0, 31891.521627175145, 32679.836600816845, 32897.50653740148, 33386.16534586558, 51789.7410512945, 51827.74086129545, 52383.0, 52444.0, 52470.21294680659, 447877.0, 451906.0, 452546.0, 452582.0, 454545.0, 28398.148055558366, 29458.263543411587, 29508.704912950594, 29571.0, 29689.734129245335, 47395.289070663275, 48382.758086209345, 49015.26477102775, 49272.50727492679, 52668.736656316476, 42266.57733422749, 43926.560734392246, 43984.780076099414, 44271.0, 45193.0, 42408.78795606126, 42554.148917020866, 42754.35868461913, 42833.0, 43541.78229108834, 42553.361699573914, 43443.131137377706, 43467.782661086494, 43851.342229867216, 46033.30950035819, 35470.64529354673, 37562.436563451025, 37675.0, 37962.240755185296, 38055.42916856194, 29598.0, 29670.554941675462, 29762.0, 29796.255093622833, 30047.248818779706], "value": 19154.341724640857, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [404.30661415672154, 407.1389012239113, 408.54447291270236, 417.41978649676946, 428.0518651187619, 15723.213839308046, 17999.370022049214, 18795.906020469913, 19666.803331966676, 19713.408597742073, 18491.630167396645, 18657.440276791684, 18700.53248668784, 19065.428037158872, 19104.522386940334, 5593.328800543941, 5727.914081288784, 5771.2497375341145, 5809.244798176232, 5818.156367326735, 5575.442455754413, 5679.261695979517, 5699.430056994309, 5721.170430287606, 5729.799457019005, 5651.2653355063785, 5652.604317697763, 5661.7735290588325, 5683.658980461186, 5685.317761868581, 5581.274434323512, 5606.859828504279, 5651.9152212716845, 5668.773249070032, 5679.517241034517, 4984.22744474607, 5082.161443361878, 5114.207297868799, 5176.120059589879, 5178.119719647631, 21613.891930540405, 22001.779982200133, 22465.438364040867, 22689.77310226893, 22715.77284227153, 2341.4497593065616, 2370.3007612754277, 2375.5011447596025, 2448.1431498975394, 2515.2328539795353, 13764.93117534406, 14314.284285785669, 14518.70962580753, 14574.854251457562, 14910.105393676415, 1974.2300502803919, 2019.919203231869, 2021.6765317549268, 2026.6554685703466, 2047.375550457125, 80213.59893200497, 80762.59618701869, 81976.0, 82967.0, 83345.58327208325, 10493.947530262452, 10688.465576721133, 10784.13726901846, 10856.945715271373, 10981.39602321864, 13107.606771796862, 13584.388702508411, 14436.422543098159, 15161.696766064617, 15210.771838422432, 8060.4760690556095, 8154.143814899468, 8398.496090234605, 8645.351598630128, 8687.305015598737, 8073.0, 8079.636416361278, 8375.664973400995, 8452.226867211255, 8497.107803680648, 6572.934270657328, 6607.537472376984, 6614.107095542136, 6630.911262952155, 6694.732210711517, 1964.083336245674, 1985.1761518969754, 2000.2798992362739, 2000.5698774763496, 2001.109506269696, 982.9459379734184, 1003.6236411345745, 1030.3457304611625, 1105.3754628634956, 1121.159130652011, 17896.0, 19127.713084303745, 19145.329913452963, 19229.519262018563, 19495.415137545613, 1026.481626778472, 1030.175859312547, 1076.3488089705772, 1104.6354702948008, 1110.1119104716195, 10589.576416943237, 10733.302335348177, 10778.730531736612, 10861.239713219999, 10943.233973621771, 470021.0, 474306.0, 474655.0, 484832.0, 485457.0, 87931.0, 97809.0, 98440.0, 99654.0, 100176.0, 1056.915446764257, 1081.6268387406333, 1092.0171845339257, 1101.8512500812449, 1120.1934607082887, 17313.710395024904, 17332.480025599252, 17343.2195551198, 17555.297788088334, 17642.294308227527, 33175.66824331822, 38371.2325753489, 39756.403653945796, 43297.0, 45456.0, 56417.71791141018, 59014.70492647509, 59975.0, 60374.396256036875, 60475.395246048734, 8745.256653184551, 8756.299496040174, 8829.911700883165, 8977.91022089797, 8984.23633991118, 9902.752431189278, 13035.674108147372, 13133.408996594984, 13176.670583235496, 13770.724585508435, 12055.095867810125, 12058.51765929353, 12233.938830305791, 12312.076594255288, 12315.876841231831, 11124.388158651353, 11662.475188616701, 11857.52569897229, 11860.169788115094, 12045.0, 11604.825927611262, 12071.67211606705, 12072.637820865388, 12439.75120497567, 12582.937085314516, 7194.136703595602, 7464.888026679496, 7695.769126926201, 8768.78078048054, 8875.245604123464, 8639.524826134622, 11395.145364097893, 11812.940935295268, 11910.344931028876, 11960.282383057045], "value": 9415.001894766556, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1501.8948673592847, 1561.5549568373015, 1678.3789997700853, 1853.7034074548067, 1855.9072046397678, 8035.357171426286, 8840.160184782451, 9047.366684332092, 9704.223662107031, 9711.951440242789, 8886.42238254513, 9034.90965090349, 9181.540922953858, 9245.907540924589, 9281.257499400048, 2404.290734233401, 2466.0382450844186, 2469.4196863737006, 2470.086068154785, 2471.0, 2390.784829365357, 2458.3731148557094, 2461.9261422157365, 2466.2971053249826, 2467.679201703776, 2384.0084375590804, 2392.7726865947707, 2416.9395765105837, 2426.7209270933804, 2435.5250726108416, 2375.3349062262596, 2392.8923198456023, 2396.856188628688, 2405.3505553500545, 2406.1698713943747, 2387.7850993410675, 2400.3399065257017, 2401.363638635763, 2402.1952645863657, 2402.3513651314047, 8949.0, 9005.279577633839, 9051.637934482613, 9069.183773460354, 9077.773055673595, 5578.358488773762, 5671.0, 5702.230198923134, 5719.914201286984, 5723.399043100456, 3577.105723569108, 3585.15748799032, 3706.8517259309597, 3736.7757934523743, 3754.6057663945166, 1166.119579717308, 1180.6871179137536, 1181.6750393641732, 1188.2632767684004, 1199.9760004799855, 12928.87071129286, 13138.0, 13179.60461186166, 13187.802182967167, 13209.40557674907, 4928.827491037868, 4972.105021096165, 5076.771545280471, 5101.081805275012, 5101.744912754348, 11183.161262905314, 11232.494537745657, 11244.943775281072, 11288.492017859217, 11292.096632269398, 5674.2623458950075, 5784.103463963008, 5800.970995144998, 5840.123981402823, 5867.207926929896, 4559.0, 5099.286099946011, 5147.716875571879, 5208.322918020633, 5354.651947623392, 4257.1698518788535, 4271.829126834892, 4338.739675619473, 4398.23030969579, 4399.472063352418, 1353.8984576156827, 1357.4525041452753, 1367.9110857794212, 1380.7376598446263, 1383.75784237758, 900.486722568143, 951.2104952889085, 974.4591751577942, 1001.2640709078821, 1048.2138396202847, 6103.176071230416, 6119.143319935212, 6182.072689096582, 6280.497560195174, 6354.0, 487.6732589165268, 488.2895387211599, 492.70191534122057, 501.7340809371039, 503.12205201922876, 4181.247375472383, 4210.936835947463, 4274.786260686953, 4329.891752706208, 4345.760983145958, 11073.280236784583, 11345.432728363548, 11511.079113670887, 11519.48162332697, 11551.826722599, 11389.65831025054, 11448.141389395829, 11490.827637585442, 11499.655010349703, 11507.309561426342, 8388.8741668875, 8459.492430454193, 8676.262517685942, 8678.0, 8852.734417967342, 6305.464035557029, 6451.225852897683, 6548.3124271950755, 6567.047778072058, 6593.944968804968, 10502.317349372266, 10571.0, 10587.735306617396, 10678.946605266923, 10693.786124277316, 10510.316829406063, 10658.573657053632, 10791.0, 10821.67534973952, 10823.621173259213, 7494.887576686245, 8168.305694016075, 8264.0, 8376.748697539084, 8378.706745263886, 9285.442873427615, 9286.535673216447, 9335.719928402159, 9370.859437108586, 9375.765605859635, 8225.259726624632, 8381.0, 8387.748367548984, 8501.744947651581, 8579.871301930601, 8037.799055023671, 8051.718189863327, 8114.391420643357, 8220.383471239562, 8279.54462504568, 7256.383207427428, 7268.127824661075, 7325.926740732738, 7392.4086073115095, 7403.666834992546, 5214.42641309448, 5239.26650268955, 5241.135212689864, 5245.868853278546, 5302.098643230583, 5348.5186333230195, 5356.223347614652, 5427.891442171055, 5465.016297066566, 5504.889902201853], "value": 4820.242830181891, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [335.76664218368234, 342.3956716395561, 343.23116219667946, 346.6100636783618, 351.3254551261579, 5613.326400831901, 5645.294338207729, 5653.886922261562, 5685.8578535536635, 5687.431256874311, 5561.443855614447, 5591.384947655754, 5615.831525054255, 5620.269364982547, 5633.183188437674, 4190.203861266365, 4273.145370925812, 4334.32817913224, 4348.086901750637, 4401.80191891364, 4292.892677683051, 4307.117041006586, 4339.110482351126, 4346.848310086496, 4380.824767009316, 4326.718763280377, 4331.5884990925815, 4356.324769660692, 4373.1690978714105, 4385.8245670173155, 4281.314989601648, 4289.613934745872, 4325.264705000158, 4389.363542286351, 4390.8024138913825, 3809.580946095927, 3821.14024344523, 3844.808109486068, 3860.768353898747, 3881.340172170738, 5415.1335786274, 5415.6479828811, 5421.241026256327, 5428.8328009478155, 5453.481919217668, 4938.160512712811, 4994.450610432849, 5020.347354843847, 5022.874428139326, 5057.443681195065, 5884.264466941632, 5887.4406931341455, 5896.734646940855, 5905.320888097881, 5984.880302393928, 4321.719088259285, 4327.242732521796, 4329.675274354405, 4337.587929146726, 4338.305871060616, 6038.939610603882, 6099.194370589534, 6114.96942515289, 6125.387461253839, 6134.0, 4363.19280933022, 4376.081022985209, 4394.0, 4401.823927042947, 4413.801378937956, 4370.8907277317685, 4417.801198946056, 4424.225760491965, 4445.533219012022, 4452.332150177499, 4830.203016502238, 4965.726885021359, 4968.453470118284, 4973.35346404965, 4983.8504844854715, 5831.0, 5871.209281169285, 5876.0, 5893.852653683693, 5928.407159284037, 1483.5326872035275, 1504.8720858726913, 1511.2997877387938, 1528.9923550382177, 1536.109056747084, 965.5220665770488, 982.3025651787311, 988.3378136648463, 1037.0096557787294, 1050.448514529878, 5606.523445507096, 5628.74670639814, 5657.80197693087, 5678.545716342683, 5692.893629357164, 6008.969955150196, 6039.308993481832, 6052.697365131726, 6059.333473317932, 6080.635161890301, 5503.532199762985, 5551.555875530029, 5626.946164649873, 5655.6606603603095, 5667.263255776723, 3164.6423414556302, 3217.6485875932167, 3228.6923795862713, 3230.8384580770867, 3244.367348367046, 6047.0, 6151.771668289742, 6188.350223226586, 6236.968815155895, 6261.499080073583, 6102.572819902564, 6144.723487443076, 6156.846078848064, 6166.691665416712, 6176.969115154396, 5976.8804623908145, 6135.263768347738, 6154.599951003171, 6196.690165491707, 6205.928065607553, 5824.94175058244, 5926.288845338415, 5962.701864906824, 5971.522278217819, 5994.160817485468, 5881.500072493886, 5894.469497745224, 5900.970495147497, 5914.881702366015, 5957.523398128226, 5939.406059394026, 6180.245604822922, 6242.032484964838, 6268.592541484789, 6273.874522509615, 4363.520012798653, 4381.890452738707, 4382.496012958551, 4399.890002749957, 4423.712458690175, 6009.669468179292, 6048.5161187105805, 6058.242719660043, 6080.8750381179625, 6089.177960975212, 5581.665100094007, 5911.349751527243, 5926.881462370642, 5943.316518600416, 5945.840561090546, 5970.641761494324, 5986.311574169026, 5998.370171131968, 6001.339852616122, 6026.397360263939, 5276.707206734374, 5790.160426738184, 5794.275715535558, 5816.331121921034, 5863.706814659165, 5878.412158784087, 5887.8233652990475, 5905.578712727761, 5907.113932909926, 5937.079752638348, 5533.363663178625, 5717.971410142923, 5742.741576629145, 5745.454181852718, 5769.884602307847], "value": 4489.615331645966, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [737.8745613245748, 756.6405957170343, 813.7762115418259, 833.8665813469843, 872.4198408058642, 14549.490767823128, 15051.096934183957, 15272.541823745278, 15283.694326113471, 15288.464903728373, 14137.151770893754, 14151.858481415184, 14203.644908877282, 14214.431422743079, 14231.58063129268, 695.3046953046953, 797.2505844506175, 825.9132791056927, 828.7720876758909, 831.4512421801612, 831.6049876308736, 832.9250367466926, 833.8874251975997, 840.2983508770184, 843.1779015459908, 878.8813510176141, 879.8416285068685, 890.0520945193381, 890.3900827932854, 892.8437523433406, 881.1981097201548, 886.9068747781519, 886.9911300886973, 887.9023307436177, 888.8533391990314, 643.1510406263734, 643.9678016099176, 644.4200219802169, 644.9806505804834, 645.8514541655445, 14091.718165636732, 14103.435862565486, 14185.219812910285, 14191.361388737429, 14217.50238741639, 14041.508547200901, 14380.712385752226, 14447.78328325076, 14579.271036448241, 14698.11811291326, 11812.940935295355, 11838.644840654708, 11996.460159292852, 12019.338936358497, 12048.939755301168, 3937.598065180238, 4004.739691920045, 4033.1328764315813, 4034.8184331705143, 4037.0, 57048.714756426365, 58099.70950145264, 58248.70875645637, 58795.0, 58921.41078589202, 11363.204575679789, 11528.884711152781, 11606.937571849785, 11722.824157637642, 11833.88166118345, 21021.579568408546, 21033.15867365319, 21039.474013149793, 21040.89479552623, 21047.263345782823, 8353.122922093215, 8446.662133514714, 8474.27968622674, 8583.828323433496, 8792.34057445694, 4858.3441235432765, 4925.178984579064, 4996.625253106032, 4998.400191976986, 5074.974625126851, 3398.1164897126923, 3483.390406678872, 3486.599041110305, 3494.685478306965, 3494.965050349515, 605.379486026826, 616.4852348289229, 626.1109224900651, 627.7112528237062, 627.8116565030473, 709.1773542690454, 733.3106879533221, 807.7617102954642, 819.2708489444399, 826.5330088499978, 9307.72076837696, 9385.671501497414, 9557.0, 9687.41875487473, 9760.609575617038, 744.199985016099, 772.7256823827461, 784.1609477858636, 791.3945831438954, 795.920407959211, 4721.5986641135205, 4775.403074615673, 4936.679115857458, 4979.576735977483, 5029.1450453423, 61508.0, 63468.36531634717, 63541.682291588244, 69409.30590694028, 71056.289437106, 59265.40734592599, 59374.40625593775, 59593.0, 60736.39263607396, 61526.38473615207, 53733.46266537363, 54076.18885716639, 54976.0, 55240.44759552433, 56000.719996399755, 9820.803583928424, 9925.851112233178, 9941.900580994097, 10040.096391324816, 10124.190064794651, 37607.811960940024, 37832.62167378401, 38182.8090859555, 38282.42576361413, 38860.0, 48235.276470852266, 51141.0, 51320.230196547825, 52057.0, 52169.47830521798, 12844.807327890276, 12854.807177892526, 13065.738685226432, 13085.934570327468, 13116.899333217021, 14237.21695306768, 14409.0, 14476.420943162155, 14509.85490145085, 14588.34352454121, 13565.118267312593, 13936.303184840921, 14029.929850350683, 14140.50508232207, 14147.363368648641, 12834.16099200101, 12838.29389383593, 13473.461061557427, 13610.523631672844, 14912.478063267734, 13250.536231231861, 13853.238071906142, 13932.442702291795, 13983.440662373798, 14159.44246132904, 10851.945740271249, 10968.341899486057, 11081.0, 11280.830787538358, 11346.602868899548, 11101.833472497758, 11252.386197684238, 11409.144314176305, 11415.942920285346, 11649.708757281136], "value": 7142.094563847088, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1547.6999999999998, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [109.0, 110.0, 107.0, 113.0, 113.0, 113.0, 107.0, 111.0, 112.0, 111.0], "value": 110.6, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [159.0, 125.0, 159.0, 215.0, 127.0, 156.0, 149.0, 129.0, 190.0, 126.0], "value": 153.5, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 161.0, 162.0, 167.0, 165.0, 166.0, 172.0, 164.0, 163.0, 164.0], "value": 164.7, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [74.0, 74.0, 73.0, 156.0, 78.0, 77.0, 76.0, 75.0, 166.0, 75.0], "value": 92.4, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [92.0, 91.0, 171.0, 92.0, 92.0, 91.0, 150.0, 93.0, 92.0, 146.0], "value": 111.0, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 118.0, 117.0, 117.0, 117.0, 118.0, 117.0, 117.0, 117.0, 118.0], "value": 117.3, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 146.0, 147.0, 148.0, 147.0, 147.0, 147.0, 147.0, 148.0, 147.0], "value": 147.1, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 96.0, 96.0, 95.0, 96.0, 96.0, 95.0, 96.0, 97.0, 96.0], "value": 95.9, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [56.0, 53.0, 55.0, 55.0, 56.0, 55.0, 55.0, 104.0, 54.0, 51.0], "value": 59.4, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [59.0, 59.0, 59.0, 60.0, 60.0, 60.0, 59.0, 60.0, 59.0, 60.0], "value": 59.5, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 79.0, 77.0, 81.0, 80.0, 81.0, 80.0, 80.0, 80.0, 79.0], "value": 80.1, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [123.0, 121.0, 119.0, 123.0, 132.0, 118.0, 137.0, 124.0, 187.0, 139.0], "value": 132.3, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [169.0, 159.0, 164.0, 158.0, 160.0, 158.0, 160.0, 162.0, 158.0, 158.0], "value": 160.6, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [63.0, 63.0, 63.0, 63.0, 65.0, 61.0, 68.0, 62.0, 62.0, 63.0], "value": 63.3, "unit": "score"}]}]} 10:33:48 INFO - Return code: 0 10:33:48 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 10:33:48 ERROR - # TBPL SUCCESS # 10:33:48 INFO - Running post-action listener: _resource_record_post_action 10:33:48 INFO - ##### 10:33:48 INFO - ##### Finished run-tests step (success) 10:33:48 INFO - ##### 10:33:48 INFO - Running post-run listener: _resource_record_post_run 10:33:49 INFO - Total resource usage - Wall time: 1190s; CPU: 13.0%; Read bytes: 0; Write bytes: 545034240; Read time: 0; Write time: 430488 10:33:49 INFO - TinderboxPrint: CPU usage
13.4% 10:33:49 INFO - TinderboxPrint: I/O read bytes / time
0 / 0 10:33:49 INFO - TinderboxPrint: I/O write bytes / time
545,034,240 / 430,488 10:33:49 INFO - TinderboxPrint: CPU idle
8,225.0 (86.6%) 10:33:49 INFO - TinderboxPrint: CPU user
1,214.1 (12.8%) 10:33:49 INFO - TinderboxPrint: Swap in / out
0 / 0 10:33:49 INFO - install - Wall time: 17s; CPU: 14.0%; Read bytes: 0; Write bytes: 254939136; Read time: 0; Write time: 249540 10:33:49 INFO - run-tests - Wall time: 1174s; CPU: 13.0%; Read bytes: 0; Write bytes: 290095104; Read time: 0; Write time: 180948 10:33:49 INFO - Running post-run listener: _upload_blobber_files 10:33:49 INFO - Blob upload gear active. 10:33:49 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 10:33:49 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 10:33:49 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', 'Mozilla-Inbound', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 10:33:49 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 Mozilla-Inbound -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 10:33:50 INFO - (blobuploader) - INFO - Open directory for files ... 10:33:50 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 10:33:50 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 10:33:50 INFO - (blobuploader) - INFO - Uploading, attempt #1. 10:33:51 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 10:33:51 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 10:33:51 INFO - (blobuploader) - INFO - Done attempting. 10:33:51 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 10:33:51 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 10:33:51 INFO - (blobuploader) - INFO - Uploading, attempt #1. 10:33:52 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 10:33:52 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 10:33:52 INFO - (blobuploader) - INFO - Done attempting. 10:33:52 INFO - (blobuploader) - INFO - Iteration through files over. 10:33:52 INFO - Return code: 0 10:33:52 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 10:33:52 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 10:33:52 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/7c36a2f592ebbac8eeb60f56ce1e6223bf29d4908ef27c6325ab22b7a23df419d9c088b43903e07d1bd879161add34b5fd40bbbabbf529db9c855f152c6ae65e", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/42f7a48f40a346c2807830470d72967280c1fa3cfb586cb56c91fd38785589ec8ad9399f282c7755d9858512d0877b76557025d69b9dd4303c33af4cdcc08969"} 10:33:52 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 10:33:52 INFO - Writing to file /builds/slave/test/properties/blobber_files 10:33:52 INFO - Contents: 10:33:52 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/7c36a2f592ebbac8eeb60f56ce1e6223bf29d4908ef27c6325ab22b7a23df419d9c088b43903e07d1bd879161add34b5fd40bbbabbf529db9c855f152c6ae65e", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/42f7a48f40a346c2807830470d72967280c1fa3cfb586cb56c91fd38785589ec8ad9399f282c7755d9858512d0877b76557025d69b9dd4303c33af4cdcc08969"} 10:33:52 INFO - Running post-run listener: copy_logs_to_upload_dir 10:33:52 INFO - Copying logs to upload dir... 10:33:52 INFO - mkdir: /builds/slave/test/build/upload/logs 10:33:52 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1228.668760 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 28 secs) (at 2016-05-12 10:33:51.965071) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-05-12 10:33:51.969245) ========= 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=8887e36bb8e381bfd44124ac000001a8-1463073025.835199-1380263536 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/7c36a2f592ebbac8eeb60f56ce1e6223bf29d4908ef27c6325ab22b7a23df419d9c088b43903e07d1bd879161add34b5fd40bbbabbf529db9c855f152c6ae65e", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/42f7a48f40a346c2807830470d72967280c1fa3cfb586cb56c91fd38785589ec8ad9399f282c7755d9858512d0877b76557025d69b9dd4303c33af4cdcc08969"} build_url:https://queue.taskcluster.net/v1/task/BfYG2V16QFaaQ9tmX6zBbA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011196 build_url: 'https://queue.taskcluster.net/v1/task/BfYG2V16QFaaQ9tmX6zBbA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/7c36a2f592ebbac8eeb60f56ce1e6223bf29d4908ef27c6325ab22b7a23df419d9c088b43903e07d1bd879161add34b5fd40bbbabbf529db9c855f152c6ae65e", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/42f7a48f40a346c2807830470d72967280c1fa3cfb586cb56c91fd38785589ec8ad9399f282c7755d9858512d0877b76557025d69b9dd4303c33af4cdcc08969"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-05-12 10:33:51.994064) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-05-12 10:33:51.994396) ========= 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=8887e36bb8e381bfd44124ac000001a8-1463073025.835199-1380263536 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004453 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-05-12 10:33:52.077758) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-05-12 10:33:52.078083) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-05-12 10:33:52.078396) ========= ========= Total master_lag: 0.17 =========