builder: mozilla-central_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-011 starttime: 1464865831.54 results: success (0) buildid: 20160602025543 builduid: 9d7146f8a9884e41987381eaf75c9bc4 revision: 7c0dce574b3f2d5e8f6e4e60caab5532f8e13fd6 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-06-02 04:10:31.539716) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-06-02 04:10:31.540091) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-02 04:10:31.540354) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-02 04:10:31.555662) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-02 04:10:31.556020) ========= 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=5cf47e208febbcd81da23b2e0000026f-1464864800.711397-173241730 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-06-02 04:10:31-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 225M=0s 2016-06-02 04:10:31 (225 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.081140 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-02 04:10:31.652793) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-02 04:10:31.653109) ========= 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=5cf47e208febbcd81da23b2e0000026f-1464864800.711397-173241730 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.018951 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-02 04:10:31.703269) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-02 04:10:31.703685) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 7c0dce574b3f2d5e8f6e4e60caab5532f8e13fd6 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo mozilla-central --rev 7c0dce574b3f2d5e8f6e4e60caab5532f8e13fd6 --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=5cf47e208febbcd81da23b2e0000026f-1464864800.711397-173241730 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-06-02 04:10:31,844 truncating revision to first 12 chars 2016-06-02 04:10:31,844 Setting DEBUG logging. 2016-06-02 04:10:31,844 attempt 1/10 2016-06-02 04:10:31,845 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/7c0dce574b3f?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-06-02 04:10:32,170 unpacking tar archive at: mozilla-central-7c0dce574b3f/testing/mozharness/ program finished with exit code 0 elapsedTime=0.664866 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-02 04:10:32.381422) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-02 04:10:32.381717) ========= script_repo_revision: 7c0dce574b3f2d5e8f6e4e60caab5532f8e13fd6 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-02 04:10:32.382291) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-02 04:10:32.382778) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-02 04:10:32.395053) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 8 secs) (at 2016-06-02 04:10:32.395322) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-Non-PGO in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox-Non-PGO'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=5cf47e208febbcd81da23b2e0000026f-1464864800.711397-173241730 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 04:10:32 INFO - MultiFileLogger online at 20160602 04:10:32 in /builds/slave/test 04:10:32 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-Non-PGO 04:10:32 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 04:10:32 INFO - {'append_to_log': False, 04:10:32 INFO - 'base_work_dir': '/builds/slave/test', 04:10:32 INFO - 'blob_upload_branch': 'Firefox-Non-PGO', 04:10:32 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 04:10:32 INFO - 'branch': 'Firefox-Non-PGO', 04:10:32 INFO - 'buildbot_json_path': 'buildprops.json', 04:10:32 INFO - 'config_files': ('talos/linux_config.py',), 04:10:32 INFO - 'default_actions': ('clobber', 04:10:32 INFO - 'read-buildbot-config', 04:10:32 INFO - 'download-and-extract', 04:10:32 INFO - 'populate-webroot', 04:10:32 INFO - 'create-virtualenv', 04:10:32 INFO - 'install', 04:10:32 INFO - 'run-tests'), 04:10:32 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 04:10:32 INFO - 'download_minidump_stackwalk': True, 04:10:32 INFO - 'download_symbols': 'ondemand', 04:10:32 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 04:10:32 INFO - 'tooltool.py': '/tools/tooltool.py', 04:10:32 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 04:10:32 INFO - '/tools/misc-python/virtualenv.py')}, 04:10:32 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 04:10:32 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 04:10:32 INFO - 'installer_path': 'installer.exe', 04:10:32 INFO - 'log_level': 'info', 04:10:32 INFO - 'log_name': 'talos', 04:10:32 INFO - 'log_to_console': True, 04:10:32 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 04:10:32 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 04:10:32 INFO - 'opt_config_files': (), 04:10:32 INFO - 'pip_index': False, 04:10:32 INFO - 'sps_profile': False, 04:10:32 INFO - 'sps_profile_interval': 0, 04:10:32 INFO - 'suite': 'dromaeojs-e10s', 04:10:32 INFO - 'system_bits': '32', 04:10:32 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 04:10:32 INFO - 'title': 'talos-linux64-ix-011', 04:10:32 INFO - 'tooltool_cache': '/builds/tooltool_cache', 04:10:32 INFO - 'use_talos_json': True, 04:10:32 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 04:10:32 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 04:10:32 INFO - 'work_dir': 'build'} 04:10:32 INFO - ##### 04:10:32 INFO - ##### Running clobber step. 04:10:32 INFO - ##### 04:10:32 INFO - Running pre-action listener: _resource_record_pre_action 04:10:32 INFO - Running main action method: clobber 04:10:32 INFO - rmtree: /builds/slave/test/build 04:10:32 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 04:10:33 INFO - Running post-action listener: _resource_record_post_action 04:10:33 INFO - ##### 04:10:33 INFO - ##### Finished clobber step (success) 04:10:33 INFO - ##### 04:10:33 INFO - ##### 04:10:33 INFO - ##### Running read-buildbot-config step. 04:10:33 INFO - ##### 04:10:33 INFO - Running pre-action listener: _resource_record_pre_action 04:10:33 INFO - Running main action method: read_buildbot_config 04:10:33 INFO - Using buildbot properties: 04:10:33 INFO - { 04:10:33 INFO - "project": "", 04:10:33 INFO - "product": "firefox", 04:10:33 INFO - "script_repo_revision": "production", 04:10:33 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs-e10s", 04:10:33 INFO - "repository": "", 04:10:33 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central talos dromaeojs-e10s", 04:10:33 INFO - "buildid": "20160602025543", 04:10:33 INFO - "pgo_build": "False", 04:10:33 INFO - "basedir": "/builds/slave/test", 04:10:33 INFO - "buildnumber": 366, 04:10:33 INFO - "slavename": "talos-linux64-ix-011", 04:10:33 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 04:10:33 INFO - "platform": "ubuntu64_hw", 04:10:33 INFO - "scheduler": "tests-mozilla-central-linux64-talos", 04:10:33 INFO - "branch": "mozilla-central", 04:10:33 INFO - "repo_path": "mozilla-central", 04:10:33 INFO - "revision": "7c0dce574b3f2d5e8f6e4e60caab5532f8e13fd6", 04:10:33 INFO - "stage_platform": "linux64", 04:10:33 INFO - "builduid": "9d7146f8a9884e41987381eaf75c9bc4", 04:10:33 INFO - "slavebuilddir": "test" 04:10:33 INFO - } 04:10:33 INFO - Found installer url https://queue.taskcluster.net/v1/task/LDIbvV_2TDyhmXd1cbv8Tg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2. 04:10:33 INFO - Running post-action listener: _resource_record_post_action 04:10:33 INFO - ##### 04:10:33 INFO - ##### Finished read-buildbot-config step (success) 04:10:33 INFO - ##### 04:10:33 INFO - ##### 04:10:33 INFO - ##### Running download-and-extract step. 04:10:33 INFO - ##### 04:10:33 INFO - Running pre-action listener: _resource_record_pre_action 04:10:33 INFO - Running main action method: download_and_extract 04:10:33 INFO - mkdir: /builds/slave/test/build/tests 04:10:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:10:33 INFO - https://queue.taskcluster.net/v1/task/LDIbvV_2TDyhmXd1cbv8Tg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 04:10:33 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LDIbvV_2TDyhmXd1cbv8Tg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 04:10:33 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LDIbvV_2TDyhmXd1cbv8Tg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 04:10:33 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LDIbvV_2TDyhmXd1cbv8Tg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 04:10:33 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LDIbvV_2TDyhmXd1cbv8Tg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 04:10:41 INFO - Downloaded 1361 bytes. 04:10:41 INFO - Reading from file /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 04:10:41 INFO - Using the following test package requirements: 04:10:41 INFO - {u'common': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'], 04:10:41 INFO - u'cppunittest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 04:10:41 INFO - u'firefox-49.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 04:10:41 INFO - u'gtest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 04:10:41 INFO - u'firefox-49.0a1.en-US.linux-x86_64.gtest.tests.zip'], 04:10:41 INFO - u'jittest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 04:10:41 INFO - u'jsshell-linux-x86_64.zip'], 04:10:41 INFO - u'mochitest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 04:10:41 INFO - u'firefox-49.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 04:10:41 INFO - u'mozbase': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'], 04:10:41 INFO - u'reftest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 04:10:41 INFO - u'firefox-49.0a1.en-US.linux-x86_64.reftest.tests.zip'], 04:10:41 INFO - u'talos': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 04:10:41 INFO - u'firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip'], 04:10:41 INFO - u'web-platform': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 04:10:41 INFO - u'firefox-49.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 04:10:41 INFO - u'xpcshell': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 04:10:41 INFO - u'firefox-49.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 04:10:41 INFO - Downloading packages: [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 04:10: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')]} 04:10:41 INFO - https://queue.taskcluster.net/v1/task/LDIbvV_2TDyhmXd1cbv8Tg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 04:10:41 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LDIbvV_2TDyhmXd1cbv8Tg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 04:10:41 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LDIbvV_2TDyhmXd1cbv8Tg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 04:10:41 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LDIbvV_2TDyhmXd1cbv8Tg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 04:10:41 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LDIbvV_2TDyhmXd1cbv8Tg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 04:10:47 INFO - Downloaded 22849819 bytes. 04:10:47 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 04:10:47 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 04:10:48 INFO - Return code: 0 04:10:48 INFO - Downloading packages: [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 04:10: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')]} 04:10:48 INFO - https://queue.taskcluster.net/v1/task/LDIbvV_2TDyhmXd1cbv8Tg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 04:10:48 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LDIbvV_2TDyhmXd1cbv8Tg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 04:10:48 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LDIbvV_2TDyhmXd1cbv8Tg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 04:10:48 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LDIbvV_2TDyhmXd1cbv8Tg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 04:10:48 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LDIbvV_2TDyhmXd1cbv8Tg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 04:10:57 INFO - Downloaded 22849819 bytes. 04:10:57 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 04:10:57 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 04:11:01 INFO - Return code: 0 04:11:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:11:01 INFO - https://queue.taskcluster.net/v1/task/LDIbvV_2TDyhmXd1cbv8Tg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 04:11:01 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LDIbvV_2TDyhmXd1cbv8Tg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip 04:11:01 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LDIbvV_2TDyhmXd1cbv8Tg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip 04:11:01 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LDIbvV_2TDyhmXd1cbv8Tg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip 04:11:01 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LDIbvV_2TDyhmXd1cbv8Tg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 04:11:02 INFO - Downloaded 10834055 bytes. 04:11:02 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 04:11:02 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 04:11:02 INFO - Return code: 0 04:11:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:11:02 INFO - https://queue.taskcluster.net/v1/task/LDIbvV_2TDyhmXd1cbv8Tg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 04:11:02 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LDIbvV_2TDyhmXd1cbv8Tg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 04:11:02 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LDIbvV_2TDyhmXd1cbv8Tg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 04:11:02 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LDIbvV_2TDyhmXd1cbv8Tg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 04:11:02 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/LDIbvV_2TDyhmXd1cbv8Tg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 04:11:05 INFO - Downloaded 55062268 bytes. 04:11:05 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/LDIbvV_2TDyhmXd1cbv8Tg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 04:11:05 INFO - mkdir: /builds/slave/test/properties 04:11:05 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 04:11:05 INFO - Writing to file /builds/slave/test/properties/build_url 04:11:05 INFO - Contents: 04:11:05 INFO - build_url:https://queue.taskcluster.net/v1/task/LDIbvV_2TDyhmXd1cbv8Tg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 04:11:06 INFO - Running post-action listener: _resource_record_post_action 04:11:06 INFO - Running post-action listener: set_extra_try_arguments 04:11:06 INFO - ##### 04:11:06 INFO - ##### Finished download-and-extract step (success) 04:11:06 INFO - ##### 04:11:06 INFO - ##### 04:11:06 INFO - ##### Running populate-webroot step. 04:11:06 INFO - ##### 04:11:06 INFO - Running pre-action listener: _resource_record_pre_action 04:11:06 INFO - Running main action method: populate_webroot 04:11:06 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 04:11:06 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 04:11:06 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 04:11:06 INFO - '--tppagecycles', 04:11:06 INFO - '7'], 04:11:06 INFO - 'tests': ['tsvgm']}}, 04:11:06 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 04:11:06 INFO - 'tests': ['tresize', 'tcanvasmark']}, 04:11:06 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 04:11:06 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 04:11:06 INFO - 'tests': ['dromaeo_css', 'kraken']}, 04:11:06 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 04:11:06 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:11:06 INFO - 'talos_options': ['--disable-e10s'], 04:11:06 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:11:06 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:11:06 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:11:06 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:11:06 INFO - 'talos_options': ['--disable-e10s'], 04:11:06 INFO - 'tests': ['damp', 'tps']}, 04:11:06 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:11:06 INFO - 'tests': ['damp', 'tps']}, 04:11:06 INFO - 'g3': {'talos_options': ['--disable-e10s'], 04:11:06 INFO - 'tests': ['dromaeo_dom']}, 04:11:06 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 04:11:06 INFO - 'other': {'talos_options': ['--disable-e10s'], 04:11:06 INFO - 'tests': ['a11yr', 04:11:06 INFO - 'ts_paint', 04:11:06 INFO - 'tpaint', 04:11:06 INFO - 'sessionrestore', 04:11:06 INFO - 'sessionrestore_no_auto_restore', 04:11:06 INFO - 'tabpaint']}, 04:11:06 INFO - 'other-e10s': {'tests': ['a11yr', 04:11:06 INFO - 'ts_paint', 04:11:06 INFO - 'tpaint', 04:11:06 INFO - 'sessionrestore', 04:11:06 INFO - 'sessionrestore_no_auto_restore', 04:11:06 INFO - 'tabpaint']}, 04:11:06 INFO - 'other-e10s_l64': {'tests': ['a11yr', 04:11:06 INFO - 'ts_paint', 04:11:06 INFO - 'tpaint', 04:11:06 INFO - 'sessionrestore', 04:11:06 INFO - 'sessionrestore_no_auto_restore', 04:11:06 INFO - 'tabpaint']}, 04:11:06 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 04:11:06 INFO - 'ts_paint', 04:11:06 INFO - 'tpaint', 04:11:06 INFO - 'sessionrestore', 04:11:06 INFO - 'sessionrestore_no_auto_restore', 04:11:06 INFO - 'tabpaint']}, 04:11:06 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 04:11:06 INFO - 'tests': ['a11yr', 04:11:06 INFO - 'ts_paint', 04:11:06 INFO - 'tpaint', 04:11:06 INFO - 'sessionrestore', 04:11:06 INFO - 'sessionrestore_no_auto_restore', 04:11:06 INFO - 'tabpaint']}, 04:11:06 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 04:11:06 INFO - 'tests': ['a11yr', 04:11:06 INFO - 'ts_paint', 04:11:06 INFO - 'tpaint', 04:11:06 INFO - 'sessionrestore', 04:11:06 INFO - 'sessionrestore_no_auto_restore', 04:11:06 INFO - 'tabpaint']}, 04:11:06 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 04:11:06 INFO - 'tests': ['tsvgx', 04:11:06 INFO - 'tsvgr_opacity', 04:11:06 INFO - 'tart', 04:11:06 INFO - 'tscrollx', 04:11:06 INFO - 'cart']}, 04:11:06 INFO - 'svgr-e10s': {'tests': ['tsvgx', 04:11:06 INFO - 'tsvgr_opacity', 04:11:06 INFO - 'tart', 04:11:06 INFO - 'tscrollx', 04:11:06 INFO - 'cart']}, 04:11:06 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:11:06 INFO - 'talos_options': ['--disable-e10s'], 04:11:06 INFO - 'tests': ['tp5o']}, 04:11:06 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:11:06 INFO - 'tests': ['tp5o']}, 04:11:06 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:11:06 INFO - 'talos_options': ['--disable-e10s', 04:11:06 INFO - '--xperf_path', 04:11:06 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:11:06 INFO - 'tests': ['tp5n']}, 04:11:06 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:11:06 INFO - 'talos_options': ['--xperf_path', 04:11:06 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:11:06 INFO - 'tests': ['tp5n']}}, 04:11:06 INFO - 'talos.zip': {'path': '', 04:11:06 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 04:11:06 INFO - Running post-action listener: _resource_record_post_action 04:11:06 INFO - ##### 04:11:06 INFO - ##### Finished populate-webroot step (success) 04:11:06 INFO - ##### 04:11:06 INFO - ##### 04:11:06 INFO - ##### Running create-virtualenv step. 04:11:06 INFO - ##### 04:11:06 INFO - Running pre-action listener: _resource_record_pre_action 04:11:06 INFO - Running main action method: create_virtualenv 04:11:06 INFO - Creating virtualenv /builds/slave/test/build/venv 04:11:06 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 04:11:06 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 04:11:06 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 04:11:06 INFO - Using real prefix '/usr' 04:11:06 INFO - New python executable in /builds/slave/test/build/venv/bin/python 04:11:06 INFO - Installing distribute.............................................................................................................................................................................................done. 04:11:08 INFO - Installing pip.................done. 04:11:08 INFO - Return code: 0 04:11:08 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 04:11:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:11:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:11:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:11:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:11:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:11:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:11:08 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 0x7f5f987e7f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fde8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20a9770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21389c0>, '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 0x21398c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2139d50>, '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': '5cf47e208febbcd81da23b2e0000026f-1464864800.711397-173241730', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:11:08 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 04:11:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 04:11:08 INFO - Using env: {'DISPLAY': ':0', 04:11:08 INFO - 'HOME': '/home/cltbld', 04:11:08 INFO - 'LANG': 'en_US.UTF-8', 04:11:08 INFO - 'LANGUAGE': 'en_US:en', 04:11:08 INFO - 'LOGNAME': 'cltbld', 04:11:08 INFO - 'MAIL': '/var/mail/cltbld', 04:11:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:11:08 INFO - 'MOZ_NO_REMOTE': '1', 04:11:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:11:08 INFO - 'NO_EM_RESTART': '1', 04:11:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:11:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:11:08 INFO - 'PWD': '/builds/slave/test', 04:11:08 INFO - 'SHELL': '/bin/bash', 04:11:08 INFO - 'SHLVL': '1', 04:11:08 INFO - 'TERM': 'linux', 04:11:08 INFO - 'TMOUT': '86400', 04:11:08 INFO - 'USER': 'cltbld', 04:11:08 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1464864800.711397-173241730', 04:11:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:11:08 INFO - '_': '/tools/buildbot/bin/python'} 04:11:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:11:08 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 04:11:08 INFO - Cleaning up... 04:11:08 INFO - Return code: 0 04:11:08 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 04:11:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:11:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:11:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:11:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:11:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:11:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:11:08 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f5f987e7f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fde8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20a9770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21389c0>, '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 0x21398c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2139d50>, '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': '5cf47e208febbcd81da23b2e0000026f-1464864800.711397-173241730', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:11:08 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 04:11:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 04:11:08 INFO - Using env: {'DISPLAY': ':0', 04:11:08 INFO - 'HOME': '/home/cltbld', 04:11:08 INFO - 'LANG': 'en_US.UTF-8', 04:11:08 INFO - 'LANGUAGE': 'en_US:en', 04:11:08 INFO - 'LOGNAME': 'cltbld', 04:11:08 INFO - 'MAIL': '/var/mail/cltbld', 04:11:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:11:08 INFO - 'MOZ_NO_REMOTE': '1', 04:11:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:11:08 INFO - 'NO_EM_RESTART': '1', 04:11:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:11:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:11:08 INFO - 'PWD': '/builds/slave/test', 04:11:08 INFO - 'SHELL': '/bin/bash', 04:11:08 INFO - 'SHLVL': '1', 04:11:08 INFO - 'TERM': 'linux', 04:11:08 INFO - 'TMOUT': '86400', 04:11:08 INFO - 'USER': 'cltbld', 04:11:08 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1464864800.711397-173241730', 04:11:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:11:08 INFO - '_': '/tools/buildbot/bin/python'} 04:11:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:11:09 INFO - Downloading/unpacking psutil>=3.1.1 04:11:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:11:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:11:09 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:11:09 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:11:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:11:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:11:11 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 04:11:11 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:11:11 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:11:11 INFO - Installing collected packages: psutil 04:11:11 INFO - Running setup.py install for psutil 04:11:11 INFO - building 'psutil._psutil_linux' extension 04:11:11 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 04:11:11 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 04:11:11 INFO - building 'psutil._psutil_posix' extension 04:11:11 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 04:11:11 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 04:11:14 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:11:14 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:11:14 INFO - Successfully installed psutil 04:11:14 INFO - Cleaning up... 04:11:14 INFO - Return code: 0 04:11:14 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 04:11:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:11:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:11:14 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:11:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:11:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:11:14 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:11:14 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f5f987e7f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fde8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20a9770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21389c0>, '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 0x21398c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2139d50>, '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': '5cf47e208febbcd81da23b2e0000026f-1464864800.711397-173241730', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:11:14 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 04:11:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 04:11:14 INFO - Using env: {'DISPLAY': ':0', 04:11:14 INFO - 'HOME': '/home/cltbld', 04:11:14 INFO - 'LANG': 'en_US.UTF-8', 04:11:14 INFO - 'LANGUAGE': 'en_US:en', 04:11:14 INFO - 'LOGNAME': 'cltbld', 04:11:14 INFO - 'MAIL': '/var/mail/cltbld', 04:11:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:11:14 INFO - 'MOZ_NO_REMOTE': '1', 04:11:14 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:11:14 INFO - 'NO_EM_RESTART': '1', 04:11:14 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:11:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:11:14 INFO - 'PWD': '/builds/slave/test', 04:11:14 INFO - 'SHELL': '/bin/bash', 04:11:14 INFO - 'SHLVL': '1', 04:11:14 INFO - 'TERM': 'linux', 04:11:14 INFO - 'TMOUT': '86400', 04:11:14 INFO - 'USER': 'cltbld', 04:11:14 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1464864800.711397-173241730', 04:11:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:11:14 INFO - '_': '/tools/buildbot/bin/python'} 04:11:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:11:14 INFO - Downloading/unpacking mozsystemmonitor==0.3 04:11:14 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:11:14 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:11:14 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:11:14 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:11:14 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:11:14 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:11:16 INFO - Downloading mozsystemmonitor-0.3.tar.gz 04:11:16 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 04:11:16 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 04:11:16 INFO - Installing collected packages: mozsystemmonitor 04:11:16 INFO - Running setup.py install for mozsystemmonitor 04:11:16 INFO - Successfully installed mozsystemmonitor 04:11:16 INFO - Cleaning up... 04:11:16 INFO - Return code: 0 04:11:16 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 04:11:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:11:16 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:11:16 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:11:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:11:16 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:11:16 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:11:16 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7f5f987e7f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fde8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20a9770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21389c0>, '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 0x21398c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2139d50>, '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': '5cf47e208febbcd81da23b2e0000026f-1464864800.711397-173241730', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:11:16 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 04:11:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 04:11:16 INFO - Using env: {'DISPLAY': ':0', 04:11:16 INFO - 'HOME': '/home/cltbld', 04:11:16 INFO - 'LANG': 'en_US.UTF-8', 04:11:16 INFO - 'LANGUAGE': 'en_US:en', 04:11:16 INFO - 'LOGNAME': 'cltbld', 04:11:16 INFO - 'MAIL': '/var/mail/cltbld', 04:11:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:11:16 INFO - 'MOZ_NO_REMOTE': '1', 04:11:16 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:11:16 INFO - 'NO_EM_RESTART': '1', 04:11:16 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:11:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:11:16 INFO - 'PWD': '/builds/slave/test', 04:11:16 INFO - 'SHELL': '/bin/bash', 04:11:16 INFO - 'SHLVL': '1', 04:11:16 INFO - 'TERM': 'linux', 04:11:16 INFO - 'TMOUT': '86400', 04:11:16 INFO - 'USER': 'cltbld', 04:11:16 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1464864800.711397-173241730', 04:11:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:11:16 INFO - '_': '/tools/buildbot/bin/python'} 04:11:16 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:11:16 INFO - Downloading/unpacking blobuploader==1.2.4 04:11:16 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:11:16 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:11:16 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:11:16 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:11:16 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:11:16 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:11:18 INFO - Downloading blobuploader-1.2.4.tar.gz 04:11:18 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 04:11:18 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 04:11:18 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:11:18 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:11:18 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:11:18 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:11:18 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:11:18 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:11:19 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 04:11:19 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 04:11:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:11:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:11:19 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:11:19 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:11:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:11:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:11:19 INFO - Downloading docopt-0.6.1.tar.gz 04:11:19 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 04:11:19 INFO - Installing collected packages: blobuploader, requests, docopt 04:11:19 INFO - Running setup.py install for blobuploader 04:11:19 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 04:11:19 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 04:11:19 INFO - Running setup.py install for requests 04:11:19 INFO - Running setup.py install for docopt 04:11:20 INFO - Successfully installed blobuploader requests docopt 04:11:20 INFO - Cleaning up... 04:11:20 INFO - Return code: 0 04:11:20 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:11:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:11:20 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:11:20 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:11:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:11:20 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:11:20 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:11:20 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 0x7f5f987e7f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fde8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20a9770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21389c0>, '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 0x21398c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2139d50>, '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': '5cf47e208febbcd81da23b2e0000026f-1464864800.711397-173241730', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:11:20 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 04:11:20 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 04:11:20 INFO - Using env: {'DISPLAY': ':0', 04:11:20 INFO - 'HOME': '/home/cltbld', 04:11:20 INFO - 'LANG': 'en_US.UTF-8', 04:11:20 INFO - 'LANGUAGE': 'en_US:en', 04:11:20 INFO - 'LOGNAME': 'cltbld', 04:11:20 INFO - 'MAIL': '/var/mail/cltbld', 04:11:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:11:20 INFO - 'MOZ_NO_REMOTE': '1', 04:11:20 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:11:20 INFO - 'NO_EM_RESTART': '1', 04:11:20 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:11:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:11:20 INFO - 'PWD': '/builds/slave/test', 04:11:20 INFO - 'SHELL': '/bin/bash', 04:11:20 INFO - 'SHLVL': '1', 04:11:20 INFO - 'TERM': 'linux', 04:11:20 INFO - 'TMOUT': '86400', 04:11:20 INFO - 'USER': 'cltbld', 04:11:20 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1464864800.711397-173241730', 04:11:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:11:20 INFO - '_': '/tools/buildbot/bin/python'} 04:11:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:11:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:11:20 INFO - Running setup.py (path:/tmp/pip-XbIAuM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:11:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:11:20 INFO - Running setup.py (path:/tmp/pip-maSgBK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:11:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:11:20 INFO - Running setup.py (path:/tmp/pip-yPedZN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:11:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:11:20 INFO - Running setup.py (path:/tmp/pip-HCjuEG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:11:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:11:20 INFO - Running setup.py (path:/tmp/pip-4012xE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:11:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:11:20 INFO - Running setup.py (path:/tmp/pip-tHCBHp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:11:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:11:20 INFO - Running setup.py (path:/tmp/pip-YwSgfg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:11:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:11:20 INFO - Running setup.py (path:/tmp/pip-_7UbXa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:11:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:11:20 INFO - Running setup.py (path:/tmp/pip-qxVq9b-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:11:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:11:21 INFO - Running setup.py (path:/tmp/pip-N4xUZw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:11:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:11:21 INFO - Running setup.py (path:/tmp/pip-YENOEL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:11:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:11:21 INFO - Running setup.py (path:/tmp/pip-gXzA95-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:11:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:11:21 INFO - Running setup.py (path:/tmp/pip-d6ZbO_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:11:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:11:21 INFO - Running setup.py (path:/tmp/pip-_lt4Tn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:11:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:11:21 INFO - Running setup.py (path:/tmp/pip-UwBCVK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:11:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:11:21 INFO - Running setup.py (path:/tmp/pip-mX2t2w-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:11:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:11:21 INFO - Running setup.py (path:/tmp/pip-6O6v_Y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:11:21 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 04:11:21 INFO - Running setup.py install for manifestparser 04:11:21 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 04:11:21 INFO - Running setup.py install for mozcrash 04:11:21 INFO - Running setup.py install for mozdebug 04:11:21 INFO - Running setup.py install for mozdevice 04:11:22 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 04:11:22 INFO - Installing dm script to /builds/slave/test/build/venv/bin 04:11:22 INFO - Running setup.py install for mozfile 04:11:22 INFO - Running setup.py install for mozhttpd 04:11:22 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 04:11:22 INFO - Running setup.py install for mozinfo 04:11:22 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 04:11:22 INFO - Running setup.py install for mozInstall 04:11:22 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 04:11:22 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 04:11:22 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 04:11:22 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 04:11:22 INFO - Running setup.py install for mozleak 04:11:22 INFO - Running setup.py install for mozlog 04:11:22 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 04:11:22 INFO - Running setup.py install for moznetwork 04:11:22 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 04:11:22 INFO - Running setup.py install for mozprocess 04:11:22 INFO - Running setup.py install for mozprofile 04:11:22 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 04:11:22 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 04:11:22 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 04:11:22 INFO - Running setup.py install for mozrunner 04:11:23 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 04:11:23 INFO - Running setup.py install for mozscreenshot 04:11:23 INFO - Running setup.py install for moztest 04:11:23 INFO - Running setup.py install for mozversion 04:11:23 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 04:11:23 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 04:11:23 INFO - Cleaning up... 04:11:23 INFO - Return code: 0 04:11:23 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:11:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:11:23 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:11:23 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:11:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:11:23 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:11:23 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:11:23 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 0x7f5f987e7f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fde8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20a9770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21389c0>, '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 0x21398c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2139d50>, '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': '5cf47e208febbcd81da23b2e0000026f-1464864800.711397-173241730', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:11:23 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 04:11:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 04:11:23 INFO - Using env: {'DISPLAY': ':0', 04:11:23 INFO - 'HOME': '/home/cltbld', 04:11:23 INFO - 'LANG': 'en_US.UTF-8', 04:11:23 INFO - 'LANGUAGE': 'en_US:en', 04:11:23 INFO - 'LOGNAME': 'cltbld', 04:11:23 INFO - 'MAIL': '/var/mail/cltbld', 04:11:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:11:23 INFO - 'MOZ_NO_REMOTE': '1', 04:11:23 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:11:23 INFO - 'NO_EM_RESTART': '1', 04:11:23 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:11:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:11:23 INFO - 'PWD': '/builds/slave/test', 04:11:23 INFO - 'SHELL': '/bin/bash', 04:11:23 INFO - 'SHLVL': '1', 04:11:23 INFO - 'TERM': 'linux', 04:11:23 INFO - 'TMOUT': '86400', 04:11:23 INFO - 'USER': 'cltbld', 04:11:23 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1464864800.711397-173241730', 04:11:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:11:23 INFO - '_': '/tools/buildbot/bin/python'} 04:11:23 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:11:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:11:23 INFO - Running setup.py (path:/tmp/pip-ZkPtV8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:11:23 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 04:11:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:11:23 INFO - Running setup.py (path:/tmp/pip-V2U8lI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:11:23 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 04:11:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:11:23 INFO - Running setup.py (path:/tmp/pip-IUec24-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:11:23 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 04:11:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:11:23 INFO - Running setup.py (path:/tmp/pip-PgjVVU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:11:23 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 04:11:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:11:23 INFO - Running setup.py (path:/tmp/pip-d02yBf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:11:23 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 04:11:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:11:23 INFO - Running setup.py (path:/tmp/pip-lUgb1r-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:11:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 04:11:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:11:24 INFO - Running setup.py (path:/tmp/pip-HYzNbL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:11:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 04:11:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:11:24 INFO - Running setup.py (path:/tmp/pip-SZd943-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:11:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 04:11:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:11:24 INFO - Running setup.py (path:/tmp/pip-tYnxZF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:11:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 04:11:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:11:24 INFO - Running setup.py (path:/tmp/pip-NtIy_b-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:11:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.2 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 04:11:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:11:24 INFO - Running setup.py (path:/tmp/pip-3_Zmte-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:11:24 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 04:11:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:11:24 INFO - Running setup.py (path:/tmp/pip-dv_Y3o-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:11:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 04:11:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:11:24 INFO - Running setup.py (path:/tmp/pip-p_4wTF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:11:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 04:11:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:11:24 INFO - Running setup.py (path:/tmp/pip-ZAjslb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:11:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 04:11:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:11:24 INFO - Running setup.py (path:/tmp/pip-HKmkAh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:11:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 04:11:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:11:24 INFO - Running setup.py (path:/tmp/pip-bNox09-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:11:24 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 04:11:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:11:24 INFO - Running setup.py (path:/tmp/pip-XNA95t-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:11:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 04:11:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 04:11:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 04:11:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 04:11:24 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 04:11:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 04:11:24 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.2->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 04:11:24 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:11:24 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:11:24 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:11:24 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:11:24 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:11:24 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:11:26 INFO - Downloading blessings-1.6.tar.gz 04:11:26 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 04:11:26 INFO - Installing collected packages: blessings 04:11:26 INFO - Running setup.py install for blessings 04:11:26 INFO - Successfully installed blessings 04:11:26 INFO - Cleaning up... 04:11:26 INFO - Return code: 0 04:11:26 INFO - Done creating virtualenv /builds/slave/test/build/venv. 04:11:26 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:11:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:11:27 INFO - Reading from file tmpfile_stdout 04:11:27 INFO - Current package versions: 04:11:27 INFO - argparse == 1.2.1 04:11:27 INFO - blessings == 1.6 04:11:27 INFO - blobuploader == 1.2.4 04:11:27 INFO - docopt == 0.6.1 04:11:27 INFO - manifestparser == 1.1 04:11:27 INFO - mozInstall == 1.12 04:11:27 INFO - mozcrash == 0.17 04:11:27 INFO - mozdebug == 0.1 04:11:27 INFO - mozdevice == 0.48 04:11:27 INFO - mozfile == 1.2 04:11:27 INFO - mozhttpd == 0.7 04:11:27 INFO - mozinfo == 0.9 04:11:27 INFO - mozleak == 0.1 04:11:27 INFO - mozlog == 3.2 04:11:27 INFO - moznetwork == 0.27 04:11:27 INFO - mozprocess == 0.22 04:11:27 INFO - mozprofile == 0.28 04:11:27 INFO - mozrunner == 6.11 04:11:27 INFO - mozscreenshot == 0.1 04:11:27 INFO - mozsystemmonitor == 0.3 04:11:27 INFO - moztest == 0.7 04:11:27 INFO - mozversion == 1.4 04:11:27 INFO - psutil == 3.1.1 04:11:27 INFO - requests == 1.2.3 04:11:27 INFO - wsgiref == 0.1.2 04:11:27 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:11:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:11:27 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:11:27 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:11:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:11:27 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:11:27 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:11:27 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 0x7f5f987e7f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fde8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20a9770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21389c0>, '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 0x21398c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2139d50>, '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': '5cf47e208febbcd81da23b2e0000026f-1464864800.711397-173241730', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:11:27 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 04:11:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 04:11:27 INFO - Using env: {'DISPLAY': ':0', 04:11:27 INFO - 'HOME': '/home/cltbld', 04:11:27 INFO - 'LANG': 'en_US.UTF-8', 04:11:27 INFO - 'LANGUAGE': 'en_US:en', 04:11:27 INFO - 'LOGNAME': 'cltbld', 04:11:27 INFO - 'MAIL': '/var/mail/cltbld', 04:11:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:11:27 INFO - 'MOZ_NO_REMOTE': '1', 04:11:27 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:11:27 INFO - 'NO_EM_RESTART': '1', 04:11:27 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:11:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:11:27 INFO - 'PWD': '/builds/slave/test', 04:11:27 INFO - 'SHELL': '/bin/bash', 04:11:27 INFO - 'SHLVL': '1', 04:11:27 INFO - 'TERM': 'linux', 04:11:27 INFO - 'TMOUT': '86400', 04:11:27 INFO - 'USER': 'cltbld', 04:11:27 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1464864800.711397-173241730', 04:11:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:11:27 INFO - '_': '/tools/buildbot/bin/python'} 04:11:27 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:11:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 04:11:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 04:11:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 04:11:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 04:11:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 04:11:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 04:11:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 04:11:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 04:11:27 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 04:11:27 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 04:11:27 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 04:11:27 INFO - Cleaning up... 04:11:27 INFO - Return code: 0 04:11:27 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 04:11:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:11:27 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:11:27 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:11:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:11:27 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:11:27 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:11:27 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 0x7f5f987e7f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fde8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20a9770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21389c0>, '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 0x21398c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2139d50>, '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': '5cf47e208febbcd81da23b2e0000026f-1464864800.711397-173241730', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:11:27 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 04:11:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 04:11:27 INFO - Using env: {'DISPLAY': ':0', 04:11:27 INFO - 'HOME': '/home/cltbld', 04:11:27 INFO - 'LANG': 'en_US.UTF-8', 04:11:27 INFO - 'LANGUAGE': 'en_US:en', 04:11:27 INFO - 'LOGNAME': 'cltbld', 04:11:27 INFO - 'MAIL': '/var/mail/cltbld', 04:11:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:11:27 INFO - 'MOZ_NO_REMOTE': '1', 04:11:27 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:11:27 INFO - 'NO_EM_RESTART': '1', 04:11:27 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:11:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:11:27 INFO - 'PWD': '/builds/slave/test', 04:11:27 INFO - 'SHELL': '/bin/bash', 04:11:27 INFO - 'SHLVL': '1', 04:11:27 INFO - 'TERM': 'linux', 04:11:27 INFO - 'TMOUT': '86400', 04:11:27 INFO - 'USER': 'cltbld', 04:11:27 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1464864800.711397-173241730', 04:11:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:11:27 INFO - '_': '/tools/buildbot/bin/python'} 04:11:27 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:11:27 INFO - Downloading/unpacking jsonschema 04:11:27 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:11:27 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:11:27 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:11:27 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:11:27 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:11:27 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:11:29 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 04:11:29 INFO - Downloading/unpacking functools32 (from jsonschema) 04:11:29 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:11:29 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:11:29 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:11:29 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:11:29 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:11:29 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:11:29 INFO - Downloading functools32-3.2.3-2.tar.gz 04:11:29 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 04:11:29 INFO - warning: no files found matching '*.txt' 04:11:29 INFO - no previously-included directories found matching 'build' 04:11:29 INFO - no previously-included directories found matching 'dist' 04:11:29 INFO - no previously-included directories found matching '.git*' 04:11:29 INFO - Installing collected packages: jsonschema, functools32 04:11:29 INFO - Running setup.py install for functools32 04:11:29 INFO - warning: no files found matching '*.txt' 04:11:29 INFO - no previously-included directories found matching 'build' 04:11:29 INFO - no previously-included directories found matching 'dist' 04:11:29 INFO - no previously-included directories found matching '.git*' 04:11:29 INFO - Successfully installed jsonschema functools32 04:11:29 INFO - Cleaning up... 04:11:29 INFO - Return code: 0 04:11:29 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 04:11:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:11:29 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:11:29 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:11:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:11:29 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:11:29 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:11:29 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 0x7f5f987e7f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fde8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20a9770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21389c0>, '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 0x21398c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2139d50>, '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': '5cf47e208febbcd81da23b2e0000026f-1464864800.711397-173241730', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:11:29 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8'] in /builds/slave/test/build 04:11:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub flake8 04:11:29 INFO - Using env: {'DISPLAY': ':0', 04:11:29 INFO - 'HOME': '/home/cltbld', 04:11:29 INFO - 'LANG': 'en_US.UTF-8', 04:11:29 INFO - 'LANGUAGE': 'en_US:en', 04:11:29 INFO - 'LOGNAME': 'cltbld', 04:11:29 INFO - 'MAIL': '/var/mail/cltbld', 04:11:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:11:29 INFO - 'MOZ_NO_REMOTE': '1', 04:11:29 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:11:29 INFO - 'NO_EM_RESTART': '1', 04:11:29 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:11:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:11:29 INFO - 'PWD': '/builds/slave/test', 04:11:29 INFO - 'SHELL': '/bin/bash', 04:11:29 INFO - 'SHLVL': '1', 04:11:29 INFO - 'TERM': 'linux', 04:11:29 INFO - 'TMOUT': '86400', 04:11:29 INFO - 'USER': 'cltbld', 04:11:29 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1464864800.711397-173241730', 04:11:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:11:29 INFO - '_': '/tools/buildbot/bin/python'} 04:11:30 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:11:30 INFO - Downloading/unpacking flake8 04:11:30 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:11:30 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:11:30 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:11:30 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:11:30 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:11:30 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:11:32 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 04:11:32 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 04:11:32 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:11:32 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:11:32 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:11:32 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:11:32 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:11:32 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:11:32 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 04:11:32 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 04:11:32 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:11:32 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:11:32 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:11:32 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:11:32 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:11:32 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:11:32 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 04:11:32 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:11:32 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:11:32 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:11:32 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:11:32 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:11:32 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:11:32 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 04:11:32 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 04:11:32 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 04:11:32 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 04:11:32 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 04:11:32 INFO - no previously-included directories found matching 'docs/_build' 04:11:32 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 04:11:32 INFO - Running setup.py install for pep8 04:11:32 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 04:11:32 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 04:11:32 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 04:11:32 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 04:11:32 INFO - no previously-included directories found matching 'docs/_build' 04:11:32 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 04:11:32 INFO - Successfully installed flake8 mccabe pyflakes pep8 04:11:32 INFO - Cleaning up... 04:11:33 INFO - Return code: 0 04:11:33 INFO - Running post-action listener: _resource_record_post_action 04:11:33 INFO - Running post-action listener: _start_resource_monitoring 04:11:33 INFO - Starting resource monitoring. 04:11:33 INFO - ##### 04:11:33 INFO - ##### Finished create-virtualenv step (success) 04:11:33 INFO - ##### 04:11:33 INFO - ##### 04:11:33 INFO - ##### Running install step. 04:11:33 INFO - ##### 04:11:33 INFO - Running pre-action listener: _resource_record_pre_action 04:11:33 INFO - Running main action method: install 04:11:33 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:11:33 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:11:33 INFO - Reading from file tmpfile_stdout 04:11:33 INFO - Detecting whether we're running mozinstall >=1.0... 04:11:33 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 04:11:33 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 04:11:33 INFO - Reading from file tmpfile_stdout 04:11:33 INFO - Output received: 04:11:33 INFO - Usage: mozinstall [options] installer 04:11:33 INFO - Options: 04:11:33 INFO - -h, --help show this help message and exit 04:11:33 INFO - -d DEST, --destination=DEST 04:11:33 INFO - Directory to install application into. [default: 04:11:33 INFO - "/builds/slave/test"] 04:11:33 INFO - --app=APP Application being installed. [default: firefox] 04:11:33 INFO - mkdir: /builds/slave/test/build/application 04:11:33 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 04:11:33 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 04:11:49 INFO - Reading from file tmpfile_stdout 04:11:49 INFO - Output received: 04:11:49 INFO - /builds/slave/test/build/application/firefox/firefox 04:11:49 INFO - Running post-action listener: _resource_record_post_action 04:11:49 INFO - ##### 04:11:49 INFO - ##### Finished install step (success) 04:11:49 INFO - ##### 04:11:49 INFO - ##### 04:11:49 INFO - ##### Running run-tests step. 04:11:49 INFO - ##### 04:11:49 INFO - Running pre-action listener: _resource_record_pre_action 04:11:49 INFO - Running main action method: run_tests 04:11:49 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 04:11:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 04:11:49 INFO - Python 2.7.3 04:11:49 INFO - Return code: 0 04:11:49 INFO - grabbing minidump binary from tooltool 04:11:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:11:49 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 0x21389c0>, '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 0x21398c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2139d50>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 04:11:49 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 04:11:49 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 04:11:49 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 04:11:49 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 04:11:49 INFO - Return code: 0 04:11:49 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 04:11:49 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 04:11:49 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 04:11:49 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 04:11:49 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 04:11:49 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 04:11:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 04:11:50 INFO - Return code: 0 04:11:50 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/LDIbvV_2TDyhmXd1cbv8Tg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-011', '--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 04:11:50 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox-Non-PGO --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/LDIbvV_2TDyhmXd1cbv8Tg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-011 --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 04:11:50 INFO - Using env: {'DISPLAY': ':0', 04:11:50 INFO - 'HOME': '/home/cltbld', 04:11:50 INFO - 'LANG': 'en_US.UTF-8', 04:11:50 INFO - 'LANGUAGE': 'en_US:en', 04:11:50 INFO - 'LOGNAME': 'cltbld', 04:11:50 INFO - 'MAIL': '/var/mail/cltbld', 04:11:50 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 04:11:50 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 04:11:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:11:50 INFO - 'MOZ_NO_REMOTE': '1', 04:11:50 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 04:11:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:11:50 INFO - 'NO_EM_RESTART': '1', 04:11:50 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:11:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:11:50 INFO - 'PWD': '/builds/slave/test', 04:11:50 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 04:11:50 INFO - 'SHELL': '/bin/bash', 04:11:50 INFO - 'SHLVL': '1', 04:11:50 INFO - 'TERM': 'linux', 04:11:50 INFO - 'TMOUT': '86400', 04:11:50 INFO - 'USER': 'cltbld', 04:11:50 INFO - 'XDG_SESSION_COOKIE': '5cf47e208febbcd81da23b2e0000026f-1464864800.711397-173241730', 04:11:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:11:50 INFO - '_': '/tools/buildbot/bin/python'} 04:11:50 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/LDIbvV_2TDyhmXd1cbv8Tg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-011', '--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 04:11:50 INFO - mozversion application_buildid: 20160602025543 04:11:50 INFO - mozversion application_changeset: 7c0dce574b3f2d5e8f6e4e60caab5532f8e13fd6 04:11:50 INFO - mozversion application_display_name: Nightly 04:11:50 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 04:11:50 INFO - mozversion application_name: Firefox 04:11:50 INFO - mozversion application_remotingname: firefox 04:11:50 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 04:11:50 INFO - mozversion application_vendor: Mozilla 04:11:50 INFO - mozversion application_version: 49.0a1 04:11:50 INFO - mozversion platform_buildid: 20160602025543 04:11:50 INFO - mozversion platform_changeset: 7c0dce574b3f2d5e8f6e4e60caab5532f8e13fd6 04:11:50 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 04:11:50 INFO - mozversion platform_version: 49.0a1 04:11:50 INFO - using testdate: 1464865910 04:11:50 INFO - actual date: 1464865910 04:11:50 INFO - starting webserver on 'localhost:57442' 04:11:50 INFO - SUITE-START | Running 2 tests 04:11:50 INFO - TEST-START | dromaeo_css 04:11:50 INFO - operating with platform_type : linux_ 04:11:50 INFO - Initialising browser for dromaeo_css test... 04:11:50 INFO - TEST-INFO | started process 3983 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpEM7VCc/profile http://localhost:57442/getInfo.html) 04:11:57 INFO - PROCESS | 3983 | __metrics Screen width/height:1600/1200 04:11:57 INFO - PROCESS | 3983 | colorDepth:24 04:11:57 INFO - PROCESS | 3983 | Browser inner width/height: 1024/697 04:11:57 INFO - PROCESS | 3983 | __metrics 04:11:58 ERROR - PROCESS | 3983 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2938: TypeError: this.tabs is undefined 04:11:59 INFO - TEST-INFO | 3983: exit 0 04:11:59 INFO - Browser initialized. 04:11:59 INFO - Running cycle 1/1 for dromaeo_css test... 04:11:59 INFO - TEST-INFO | started process 4101 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpEM7VCc/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 04:12:11 INFO - PROCESS | 4101 | RSS: Main: 168181760 04:12:11 INFO - PROCESS | 4101 | 04:13:00 INFO - PROCESS | 4101 | 1464865980842 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 04:15:11 INFO - PROCESS | 4101 | Cycle 1(1): loaded http://localhost:57442/tests/dromaeo/cssquery-dojo.html (next: http://localhost:57442/tests/dromaeo/cssquery-ext.html) 04:15:12 INFO - PROCESS | 4101 | RSS: Main: 170848256 04:15:12 INFO - PROCESS | 4101 | 04:18:14 INFO - PROCESS | 4101 | Cycle 1(1): loaded http://localhost:57442/tests/dromaeo/cssquery-ext.html (next: http://localhost:57442/tests/dromaeo/cssquery-jquery.html) 04:18:15 INFO - PROCESS | 4101 | RSS: Main: 169873408 04:18:15 INFO - PROCESS | 4101 | 04:21:17 INFO - PROCESS | 4101 | Cycle 1(1): loaded http://localhost:57442/tests/dromaeo/cssquery-jquery.html (next: http://localhost:57442/tests/dromaeo/cssquery-mootools.html) 04:21:17 INFO - PROCESS | 4101 | RSS: Main: 171601920 04:21:17 INFO - PROCESS | 4101 | 04:24:19 INFO - PROCESS | 4101 | Cycle 1(1): loaded http://localhost:57442/tests/dromaeo/cssquery-mootools.html (next: http://localhost:57442/tests/dromaeo/cssquery-prototype.html) 04:24:20 INFO - PROCESS | 4101 | RSS: Main: 168779776 04:24:20 INFO - PROCESS | 4101 | 04:27:22 INFO - PROCESS | 4101 | Cycle 1(1): loaded http://localhost:57442/tests/dromaeo/cssquery-prototype.html (next: http://localhost:57442/tests/dromaeo/cssquery-yui.html) 04:27:23 INFO - PROCESS | 4101 | RSS: Main: 170627072 04:27:23 INFO - PROCESS | 4101 | 04:30:25 INFO - PROCESS | 4101 | Cycle 1(1): loaded http://localhost:57442/tests/dromaeo/cssquery-yui.html (next: http://localhost:57442/tests/dromaeo/cssquery-dojo.html) 04:30:26 INFO - PROCESS | 4101 | RSS: Main: 171962368 04:30:26 INFO - PROCESS | 4101 | 04:30:26 INFO - PROCESS | 4101 | __start_tp_report 04:30:26 INFO - PROCESS | 4101 | _x_x_mozilla_page_load 04:30:26 INFO - PROCESS | 4101 | _x_x_mozilla_page_load_details 04:30:26 INFO - PROCESS | 4101 | |i|pagename|runs| 04:30:26 INFO - PROCESS | 4101 | |0;dojo.html;2630.8816103275353;2665.586834040724;2669.2259244819;2675.3846615278485;2696.1641891013774;4634.212183928736;4644.442666879975;4674.041821426608;4713.363695901053;4757.548032936874;4528.479224889139;4636.907261854761;4653.464851542074;4667.019925815583;4688.999999999992;4198.559151289124;4291.763952982585;4341.500727416356;4367.890802729941;4370.169667763115;14.689640039551858;4203.348480985437;4272.487301523822;4297.871063868073;4393.934090988638;4224.155168966188;4237.788110594473;4275.593818587229;4278.358246263055;4333.349997500369;4228.640565551932;4263.232618128766;4272.380504826782;4276.850310239158;4313.28830742927;4216.9156616867795;4218.78906054696;4232.407462955189;4248.277792775236;4296.291111966521;4505.594496495299;4516.54834516549;4554.043650833296;4555.111753208126;4582.473015603182;4981.053599816023;4999.775010124553;5006.349174607314;5010.073136469765;5045.016221836743;4901.852944411673;4930.531599498042;4949.307097006422;4970.13022721026;4980.477049909779;4629.328747331651;4667.976660116746;4675.392199014141;4680.906381872343;4713.81144754206;5040.445550989388;5089.440161582223;5097.515736005073;5110.233464980282;5145.022445735298;4895.8041678332465;4900.411950565955;4920.089783390084;4930.2851086592245;4956.727379994135;5021.799128034911;5023.974880125576;5024.799008039638;5030.044291584587;5083.2375143727995;4871;4900.411950565884;4981.028699403654;4985.850424487271;5031.094403007421;4882.462929077798;4918.6556941014505;4933.6793108448555;4938.75306234694;4981.601471882241;4231.87304380869;4233.470816147981;4236.301010333322;4252.55348188442;4275.5724427557;3654.3787556115526;3710.870119545857;3711.870084547082;3734.2531493701367;3751.099736063325;4259;4307.913841723148;4316.568343165721;4366.432363792686;4427.203103441411;5017;5021.271915572294;5036.219385995177;5039;5080.034793389244;4235.576442355739;4342.544032876565;4343.348497725303;4347.673924455616;4395.450568678915;4557.680962332671;4564.84023059198;4574.748388838646;4619.491855895849;4642.628589712815;4768.427788665383;4784.808607655725;4790.233562630032;4801.4958429364415;4855.101806165871;4867.61059115277;4977.676451030671;5004.899902002013;5086.694798312114;5101.489851014869;4709.693869898446;4739;4764.976175119103;4799.904001919872;4805.423349198119;4938.061768264019;4947.183714687037;4948.05986862495;4953.207486802238;4986.526280003394;4882.218844984785;5017;5018.723970181675;5027.622928280321;5064.468230835857;4899.559039686445;4905.632077594266;4929.211326187793;4938.037082768826;4980.526849949249;4929.728864912464;4931.580815630711;4936.9259461107395;4938.75306234694;4982.676126051795;4673.509281525391;4795.976020119877;4801.927971080367;4828.903421931612;4907.97546012282;4915.729634870117;4936.3829521309835;4945.950540494549;4962.404511458648;4986.675866068694;4843.4430040545785;4845.854624361275;4848.660593758545;4850.442199147002;4902.362692849907 04:30:26 INFO - PROCESS | 4101 | |1;ext.html;543.9020976224281;599.4724642314762;600.4775845014835;601.1373678770964;608.3490664988464;30160.396792064173;39453.408198877005;40183.799081004625;40549;43939.56060439395;42201.788991055;42540;42774;42831.357529637084;42903.141937161236;7607.61961901904;7746.535207887517;7759.650815713307;7760.650770715331;7760.961195194016;7654.349380302681;7749.070111586618;7777.611119444005;7788.844223115534;7796.883046754303;7686.192949740281;7754.418418618598;7777.8055548611455;7816.062072551302;7827.412944029192;7744.457887947846;7769.6115194240065;7792.41556883236;7798.376129909594;7807.258310460497;7562.432817538706;7602.809929751746;7629.618519074024;7646.350060244886;7659.655315510815;38942.22115557701;39334.80332598319;39367.803160984295;39473.605263947284;39487.8025609873;3164.984175079133;3222.822744749038;3252.8861489847977;3330.5170750241077;3422.4866270059442;29412.852935735184;29796.255093622833;30185.698143018508;30687.079387618185;30729.692703072906;3428.5200071989943;3440.1055725511546;3452.205992621686;3460.5501284833063;3479.2171761353748;251258;251639;252367;253251;253359;29145.56281655777;29498.115056548337;29727;53484.73257633765;53754.731226344404;34023.31953360919;34035.65964340374;34157.316853662785;34188;34195.31609367799;12745.808812867814;12806.03954703401;12872.420741066488;12873.549425770054;12878.613641590768;11298.54805807775;11310.60412885545;11386.373749443861;11393.658190254306;11394.65816025504;7884.526928384315;7932.484388514728;8004.359651227888;8009.839803203903;8019.318357939641;3136.8274744888795;3145.937081258408;3176.0630613968933;3187;3215.389076075538;883.8188171424842;919.7838507950627;947.4552132523827;986.2750878104588;995.0745806400117;27994.86002569974;28265.434691306058;28539.85730071378;28840.423191536473;28840.711592883803;994.8457989011715;996.9252306076928;1071.0788721699332;1086.9021788039115;1087.3258579680648;14812;15120.924395378173;15180.165090919885;15382.230888455533;15431.459898903484;363366;363605;369035;369307;369409;50024;50050;50300.245496317584;50361.74819125881;50427.495725043016;1192.5408717643595;1196.475693853835;1215.6960759810047;1234.2964510229083;1240.665020444493;26533.469330613665;27522.17433476999;27557;27912.441751164457;28040.43919121647;42614.36078458764;42701.35947960845;43045.35431968586;43068.35397468978;43275.35086973635;318793;318804;319175;319655;320014;18775;18778.718319225496;18783.6243275131;18879.43361699151;18934.147963341406;42370.15259694727;42703.57296426996;42748.572514274456;46215.537844621125;46378.768106160605;35461.46807797834;37398;37914.43128353132;38134;38776.612233878426;35627.64372356243;36101.81949090238;36245.63754362422;36590.451143233404;37218.44172337363;31297.687023129478;36080.63919360773;36211.637883620824;36736;36816.44775328426;31346;32606.51090233696;32765;33351.83324083364;33356.332873342886;25071.498570028863;25629.743702562737;25845.48309033771;26123.346916327242;26143.346416339744 04:30:26 INFO - PROCESS | 4101 | |2;jquery.html;361.3387500873402;369.0883517711253;379.5464420018078;383.77165586476036;387.146342315195;15537;15727.84272157278;16923.407680731176;16954.915225423887;16968.575785605368;16037.919810400961;16542.090185039848;17177.742333865;17182.054986975712;17187.570310742238;4976.178930476467;5118.181091025437;5130.794768209267;5136.871578210537;5145.81989630363;4960.553550180483;5035.471275516073;5039.370078740158;5087.414947281054;5129.461406552315;5011.749412529359;5047.974760126194;5090.720010399426;5100.33695619569;5105.668131571455;4988.87527811804;5017.147084995541;5022.096022715909;5030.723310217936;5065.544101030925;5223.3209682741;5250.684958902478;5273.657212281228;5287.550558202557;5301.469853014706;12327.445264963098;16278.77909156818;19824.306149284705;20405.183792648277;20420.591588168154;1719.6990526657785;1774.7870255569414;1795.2549691877855;1837.127364501851;1940.398476472284;9549.761255968657;9557.713268601952;10183.643572475003;10933.671989840317;12864.935675321563;1758.3669878843607;1760.2958816473385;1787.0350010994048;1787.258287810557;1834.9266029358944;67643.3235667642;69420;71288.64355678241;71357.28642713558;71668.64165679138;9838.704838854846;10027.448490333101;10109.494525273707;10242.692719218436;10350.275480716278;14321.212333321768;14393.064450810663;14400.207988560729;14455.78316325256;14463.78304325436;7168.892466613005;7330.157031941395;7459.440541959375;7568.772936811904;7579.772606821804;6953.269906659829;7012;7072.752453664097;7115.644217789089;7196.748113815991;4350.934735978963;4404.7357158570585;4451.532589078165;4473.217186992263;4477.910441791211;1850.1766713812224;1882.8870267783977;1903.381401044666;1905.4664693885734;1927.4121392974996;842.7808769719794;868.5961028121953;934.63082082577;944.8629948657406;945.5603144537823;16509.83490165107;16660.75008874868;16881.49355519312;16997.575060623585;17189.484315470556;836.690424542923;844.7930257087053;855.2174760094443;890.7105190813012;902.7743064233941;9164.725058248263;9403.247740180768;9488.193503552275;9515.524223788922;9589.376690515233;399099;406897;412220;412603;412772;75684;77534;77791;77871.2212877864;78835.21164788393;886.609891647673;899.6086702284528;922.2529750901657;924.653255029364;982.5431174503747;14998.850011499746;15541.766873497132;15789;15904.681906362039;16092.678146436772;35440.822795885855;36418.63581364152;37162;37302.8134859324;37619.435708464945;49159.50840491692;50082.74958625183;50717;50762;51571;7152.892706609301;7261.164966028974;7408.555486670817;7458.440616953641;7541.057367829021;9295.581698823704;9810.117089461983;10251.333663311862;10527.315724477885;10624.628138015132;8596.957015214884;8921.732348029569;9192.31057670664;9198.67804626835;9417.670381536887;9275.118863707938;9396.624135034795;9473.810523789623;9542.761430964003;9602.375845570015;9036.412633178823;9340.579673914826;9375.343725939392;9395.201407880406;9481.810363792823;7401.888971665322;7409.333160015624;7448.702051917862;7497.175310715926;7626.54240745557;7396.630168491662;8631.654733810577;9158.771030724285;9203.677871274473;9392.530373481162 04:30:26 INFO - PROCESS | 4101 | |3;mootools.html;1402.0746307437093;1411.3648858013894;1541.1831729183536;1738.1222482646263;1746.1443892492682;6832.897506537406;7486.251374862511;7509.699612015526;7999.400044996627;8013.15861834507;7657.310842024217;7737.187595302496;7798.4151188660935;7866.095399029114;7868.645910934008;2189.879556624385;2215.125025614881;2227.3318004598555;2230.4423894026495;2232.9665055024107;2187.9781202188015;2199.7580266170708;2234.530748542808;2239.261043855524;2250.0662225176616;2221.1559607349186;2225.877576733279;2227.543353612514;2237.4853783629774;2247.314569056437;2176.064292354287;2180.607490651682;2185.2897808212315;2186.606410846047;2191.9780802191935;2126.542793299448;2135.0392323454507;2137.6045431595203;2141.635921893282;2142.7964343387353;7802.258785415376;7866.567338796364;7882.211778822129;7885.8028549286155;7912.4065695073095;4576.702514336557;4687.7656117194;4692.0381321828945;4700.318453824177;4703.741294228816;2957.364166704169;2990.1029691092804;2991.5781219757837;3078.415101130778;3136.8588413521447;917.2341095185528;950.3110245072336;960.2270172511126;962.0331566775416;970.8203982263304;10462.476876156237;10577.84133238002;10655.200859935458;10690;10690.251682382237;4232.661387089087;4308.202982448257;4382.912341753147;4402.141582391467;4407.2507673695545;9021.188093071654;9023.548822558845;9099.317551183687;9154.130357616015;9291.76770580741;4658.836940707059;4664.207084795593;4666.090112428112;4673.649476289292;4674.158651442705;3672.192117734094;4121.752694838319;4140.834366625361;4280.122574872144;4292.077203401283;3681.0981309579324;3695.981520092382;3774.0753515388906;3805.0487378155462;3889.397143442771;1206.6500714792787;1217.7381862899342;1233.173773571709;1236;1237.7029512916836;705.7847356556197;871.4640496094856;874.6501399440275;876.4565969099199;884.969026084084;4976.377952755905;5166.560842328369;5173.63784535079;5258.2638430619745;5287.259783630295;417.1344460245004;430.74801241274207;433.02137169996035;435.29264944465245;441.271901362754;3644.489771432002;3665.083729067733;3724.2923844469465;3736.308782875177;3777.301199278142;9371.718848434422;9483.099105584959;9490.90509094914;9597.9040209597;9609.279304052225;9212.953935230282;9470.337076404585;9500.857487137699;9513.66702165421;9560.76098097553;7264.200937896721;7289;7323.487355885037;7358.742444014434;7418.962905185547;5080.923786143137;5157.303763991813;5259;5260.605454590997;5294.761735721825;8780.868286975829;8821.60302786389;8826.338024648305;8828.64685412602;8842.425242359226;8729.563521824011;8948.463092214228;8974.86537701948;9135.223506002065;9136.132067453582;5997.970010149921;6549.181352330958;6758.053872457762;6849.554778939353;6872.656367181721;7538.547687138789;7548.509346892434;7557.05536807899;7569.432292578189;7592.392608591189;6709.664516774239;6943.826404339932;6949.930500694928;6984.7206111757;7049.400800931979;6503.187101612299;6511;6514.51141164424;6829.282925292971;6909.378155965786;6007.609505382136;6301.306856245901;6380.042993550819;6406.263279722705;6415.486761059011;4559.521250268674;4602.930956035595;4703.788329525111;4708.81164753406;4775.617950564016;4670.789814458425;4682.2508398656055;4794.832180873653;4812.133815913169;4821.180399332052 04:30:26 INFO - PROCESS | 4101 | |4;prototype.html;306.3566510328311;308.1863879358494;309.91322429719673;310.2290807343752;312.97652676049296;5035.532589031372;5039.773210205541;5079.780852595378;5080.415752188499;5097.082525145482;4988.875278118049;4994.475580064095;5043.067032598962;5054.924176137351;5069.822556210534;3725.236326553057;3805.2009078093633;3897.473841031467;3912.8630497932577;3927.6465118139363;3867.9226415471676;3899.922001559967;3909.198614284079;3911.061345277127;3931.7247792654525;3906.2187562487616;3939.7833119178435;3947.6841852651864;3948.072203032285;3956.4460975463458;3831.59768224338;3887.2031233597045;3909.960900390988;3929.5677475477673;3939.763614183158;3441.8795342162903;3463.8787642432394;3479.6346383629607;3484.0767196692896;3493.528373669573;4757.5718185363485;4777.856664300077;4778.665493415462;4788.904221915577;4797.40032495938;4429.6522842893;4490.3040028795585;4499.707519011254;4501.909961800779;4533.38799262102;5242.737863106868;5256.237845512417;5266.4733526647415;5266.631335806495;5289.947100528984;3749.850005999757;3788.1287303919976;3796.772193668361;3797.411401232813;3799.734018618698;5407.567394608422;5539.6150962259435;5541.778328866841;5542.889142217133;5551.833444996657;3889.358255887747;3890.6109389060866;3903.707221958308;3912.374020156818;3912.56961734209;3924.3328634132267;3936.9331101172115;3941.9014524637114;3942.448057271984;3966.147278335172;4481.843135490242;4493.483249426293;4497.145542346943;4505.256632655575;4511.8646440606835;5106.617003724736;5167.974160129175;5274.129768588216;5277.313949186581;5300.946990530122;1361.360160724458;1380.151207007703;1380.544420341305;1380.6686395265065;1384.7992041154178;857.4812238595684;872.7556284240296;897.3673560140217;899.7255836969787;907.1699395053585;4521.570450807234;4585.312203169551;4633.606143477842;4644.2801365788355;4661.254199328091;5376.4085950545405;5405.648632838932;5414.536385944386;5423.207048370093;5448.874938773882;4553.362529245908;4572.35986961819;4614.861554153381;4630.513796051433;4651.116287905287;2883.2935930697113;2895.0880472651047;2900.303927057491;2900.3461832423095;2927;5106.570160355107;5107.923381149286;5115.7442127893455;5129.589632829365;5132;5478.700591456296;5509.713468910358;5565.081761509306;5573.498385145356;5632.324121105494;5050.141475949097;5107.336046313955;5117.769700363493;5183.50756678115;5189.169732842727;5403.5136837684795;5406.675599464044;5419.593530485151;5490.450954904478;5513.255710479034;5105.2597373381395;5209;5309.893802124013;5326.999999999845;5330.333708286465;5083.1358669027095;5088.49115088503;5090.872728181825;5102.974485127551;5136.203888397305;3932.4691166692132;3937.8424863005157;3938.7636741795586;3946.506686664167;3956.8812935611977;5339.225812257123;5462.508374246337;5464.480874316933;5505.862353441196;5528.419515950928;5251.632385732962;5268.841934741964;5294.470552944675;5318.627696061239;5331.893362132813;5178.71517066565;5203.27154198405;5257.868553286198;5268.420473747808;5303.117393325469;4997.600191984705;5152.355955505562;5179.715115668674;5184.611154163377;5196.298499702491;5021.221710634857;5109.846704598868;5280.867978300574;5305.2307415423775;5338.519533242027;5070.366204224472;5105.668131571436;5133.281340612392;5158.3552055993005;5204.375474943031 04:30:26 INFO - PROCESS | 4101 | |5;yui.html;577.5639392258844;593.1281016905148;643.4659232836746;647.1328419917313;682.5938566552902;10236.539355728992;11380.658580242596;12074;12077.15459917805;12452.190607610522;13386.799198012037;13471.595852124452;13503.797443038362;13549.525766598172;13555.25446100464;797.9002624671931;802.3500964218972;807.4912804932884;808.0343988933228;808.6724876425058;788.9763307100797;795.7930937956115;796.4623878881731;799.8240387114826;800.5676934455387;818.893543839303;824.0605709491185;824.1799409587469;825.475822852487;825.8141918068446;819.0376307838296;819.8278361544083;820.2945466898462;821.9095899451056;822.0546371672565;585.6515373352848;608.0514397539852;610.1183789424284;610.8320211941707;613.4356392119261;11010.449477526092;11247.60633377836;11247.887521124847;11253.099752019818;11282.605108821233;10493.108085812715;10636.30863993838;10641.414722190277;11211.495482703298;11271.774564508745;10511.316764410365;10689.30519516229;10895.237333386665;10920.890791092066;11021.173411994132;3989.16227592206;4058.939115913264;4092.263392589333;4136.648384887289;4163.708540402173;46622.76688616569;47411.76294118542;48392.27411588829;48539.02921941577;48931;9090.318226133066;9182.86225706615;9282.767930801649;9524.476153811469;10041.146502547219;16904;17037;17048.744268835977;17066;17125.48623541296;6317.557770955989;6354.3010268870385;6508.414242718178;6591.736330546821;6620.040094186413;3487.877924272689;3505.964940350615;3574.303010912847;3644.599094099647;3693.686036686912;2757.2968892932577;2836.7446929776006;2845;2845.1037923054173;2850.1164638961986;530.9628326017219;537.7472587883689;541.4720647368863;544.9918251226235;551.0494397164939;561.3936948096047;608.8964875971095;620.4354037825557;632.0645444741716;639.2744235292884;7792.532448053022;7887.132415434297;8105.31104856082;8121;8176.831976683286;514.5266354953452;577.9682117483579;638.8179368879847;645.1000853808911;650.8047585724264;3709.1839795245005;3803.372443546784;3841.7310788244554;3864.768113913174;3897.8635747748694;55675.1541088188;56829;57470.7126464365;57493.425065749645;57503.71248143816;45331;49982.75008624933;50240.24639630409;51280.23079653808;51318;47099.29351059737;47440;47625.28562071572;47788.7610561945;47924.52075479201;8088.352931765562;8120.025596928406;8234;8237.217464340878;8541.487510749375;30329.393412131194;30732.385352293277;31227.84386078055;31595.21011974719;32864.67135328616;41644;41683.166336673705;42111.7894410526;42570.361444577735;42687.14625707406;10171.389716617026;10268.178545716175;10287.177025838064;10338.948305258726;10626.309289896131;10992.450377481255;11014.669559913216;11404.600838970597;11631.185816992729;12030;10001.699949001542;10086.596536138471;10295.742606434898;10411.323263987817;10637.574497020032;10526.473676316;10547.419891905713;10863.945680271549;10927.56289748433;11285.492152852978;10449;10559.313644613076;10714.14286857034;10760.946195268974;11033.117350611772;8958.328125390492;8988.505632190292;9115.407498512575;9129.908700912905;9379.202767764544;9100.22648074921;9367.250619950524;9399.671011514838;9481.383710058824;9490 04:30:26 INFO - PROCESS | 4101 | __end_tp_report 04:30:26 INFO - PROCESS | 4101 | __start_cc_report 04:30:26 INFO - PROCESS | 4101 | _x_x_mozilla_cycle_collect,382 04:30:26 INFO - PROCESS | 4101 | __end_cc_report 04:30:26 INFO - PROCESS | 4101 | __startTimestamp1464867026193__endTimestamp 04:30:26 INFO - PROCESS | 4101 | 04:30:26 INFO - PROCESS | 4101 | ------- Summary: start ------- 04:30:26 INFO - PROCESS | 4101 | Number of tests: 6 04:30:26 INFO - PROCESS | 4101 | 04:30:26 INFO - PROCESS | 4101 | [#0] dojo.html Cycles:165 Average:4603.03 Median:4795.98 stddev:599.84 (12.5%) stddev-sans-first:581.39 04:30:26 INFO - PROCESS | 4101 | Values: 2630.9 2665.6 2669.2 2675.4 2696.2 4634.2 4644.4 4674.0 4713.4 4757.5 4528.5 4636.9 4653.5 4667.0 4689.0 4198.6 4291.8 4341.5 4367.9 4370.2 14.7 4203.3 4272.5 4297.9 4393.9 4224.2 4237.8 4275.6 4278.4 4333.3 4228.6 4263.2 4272.4 4276.9 4313.3 4216.9 4218.8 4232.4 4248.3 4296.3 4505.6 4516.5 4554.0 4555.1 4582.5 4981.1 4999.8 5006.3 5010.1 5045.0 4901.9 4930.5 4949.3 4970.1 4980.5 4629.3 4668.0 4675.4 4680.9 4713.8 5040.4 5089.4 5097.5 5110.2 5145.0 4895.8 4900.4 4920.1 4930.3 4956.7 5021.8 5024.0 5024.8 5030.0 5083.2 4871.0 4900.4 4981.0 4985.9 5031.1 4882.5 4918.7 4933.7 4938.8 4981.6 4231.9 4233.5 4236.3 4252.6 4275.6 3654.4 3710.9 3711.9 3734.3 3751.1 4259.0 4307.9 4316.6 4366.4 4427.2 5017.0 5021.3 5036.2 5039.0 5080.0 4235.6 4342.5 4343.3 4347.7 4395.5 4557.7 4564.8 4574.7 4619.5 4642.6 4768.4 4784.8 4790.2 4801.5 4855.1 4867.6 4977.7 5004.9 5086.7 5101.5 4709.7 4739.0 4765.0 4799.9 4805.4 4938.1 4947.2 4948.1 4953.2 4986.5 4882.2 5017.0 5018.7 5027.6 5064.5 4899.6 4905.6 4929.2 4938.0 4980.5 4929.7 4931.6 4936.9 4938.8 4982.7 4673.5 4796.0 4801.9 4828.9 4908.0 4915.7 4936.4 4946.0 4962.4 4986.7 4843.4 4845.9 4848.7 4850.4 4902.4 04:30:26 INFO - PROCESS | 4101 | 04:30:26 INFO - PROCESS | 4101 | [#1] ext.html Cycles:180 Average:45622.59 Median:36091.23 stddev:83380.27 (231.0%) stddev-sans-first:83545.48 04:30:26 INFO - PROCESS | 4101 | Values: 543.9 599.5 600.5 601.1 608.3 30160.4 39453.4 40183.8 40549.0 43939.6 42201.8 42540.0 42774.0 42831.4 42903.1 7607.6 7746.5 7759.7 7760.7 7761.0 7654.3 7749.1 7777.6 7788.8 7796.9 7686.2 7754.4 7777.8 7816.1 7827.4 7744.5 7769.6 7792.4 7798.4 7807.3 7562.4 7602.8 7629.6 7646.4 7659.7 38942.2 39334.8 39367.8 39473.6 39487.8 3165.0 3222.8 3252.9 3330.5 3422.5 29412.9 29796.3 30185.7 30687.1 30729.7 3428.5 3440.1 3452.2 3460.6 3479.2 251258.0 251639.0 252367.0 253251.0 253359.0 29145.6 29498.1 29727.0 53484.7 53754.7 34023.3 34035.7 34157.3 34188.0 34195.3 12745.8 12806.0 12872.4 12873.5 12878.6 11298.5 11310.6 11386.4 11393.7 11394.7 7884.5 7932.5 8004.4 8009.8 8019.3 3136.8 3145.9 3176.1 3187.0 3215.4 883.8 919.8 947.5 986.3 995.1 27994.9 28265.4 28539.9 28840.4 28840.7 994.8 996.9 1071.1 1086.9 1087.3 14812.0 15120.9 15180.2 15382.2 15431.5 363366.0 363605.0 369035.0 369307.0 369409.0 50024.0 50050.0 50300.2 50361.7 50427.5 1192.5 1196.5 1215.7 1234.3 1240.7 26533.5 27522.2 27557.0 27912.4 28040.4 42614.4 42701.4 43045.4 43068.4 43275.4 318793.0 318804.0 319175.0 319655.0 320014.0 18775.0 18778.7 18783.6 18879.4 18934.1 42370.2 42703.6 42748.6 46215.5 46378.8 35461.5 37398.0 37914.4 38134.0 38776.6 35627.6 36101.8 36245.6 36590.5 37218.4 31297.7 36080.6 36211.6 36736.0 36816.4 31346.0 32606.5 32765.0 33351.8 33356.3 25071.5 25629.7 25845.5 26123.3 26143.3 04:30:26 INFO - PROCESS | 4101 | 04:30:26 INFO - PROCESS | 4101 | [#2] jquery.html Cycles:180 Average:24625.57 Median:5089.07 stddev:67444.13 (1325.3%) stddev-sans-first:67608.72 04:30:26 INFO - PROCESS | 4101 | Values: 361.3 369.1 379.5 383.8 387.1 15537.0 15727.8 16923.4 16954.9 16968.6 16037.9 16542.1 17177.7 17182.1 17187.6 4976.2 5118.2 5130.8 5136.9 5145.8 4960.6 5035.5 5039.4 5087.4 5129.5 5011.7 5048.0 5090.7 5100.3 5105.7 4988.9 5017.1 5022.1 5030.7 5065.5 5223.3 5250.7 5273.7 5287.6 5301.5 12327.4 16278.8 19824.3 20405.2 20420.6 1719.7 1774.8 1795.3 1837.1 1940.4 9549.8 9557.7 10183.6 10933.7 12864.9 1758.4 1760.3 1787.0 1787.3 1834.9 67643.3 69420.0 71288.6 71357.3 71668.6 9838.7 10027.4 10109.5 10242.7 10350.3 14321.2 14393.1 14400.2 14455.8 14463.8 7168.9 7330.2 7459.4 7568.8 7579.8 6953.3 7012.0 7072.8 7115.6 7196.7 4350.9 4404.7 4451.5 4473.2 4477.9 1850.2 1882.9 1903.4 1905.5 1927.4 842.8 868.6 934.6 944.9 945.6 16509.8 16660.8 16881.5 16997.6 17189.5 836.7 844.8 855.2 890.7 902.8 9164.7 9403.2 9488.2 9515.5 9589.4 399099.0 406897.0 412220.0 412603.0 412772.0 75684.0 77534.0 77791.0 77871.2 78835.2 886.6 899.6 922.3 924.7 982.5 14998.9 15541.8 15789.0 15904.7 16092.7 35440.8 36418.6 37162.0 37302.8 37619.4 49159.5 50082.7 50717.0 50762.0 51571.0 7152.9 7261.2 7408.6 7458.4 7541.1 9295.6 9810.1 10251.3 10527.3 10624.6 8597.0 8921.7 9192.3 9198.7 9417.7 9275.1 9396.6 9473.8 9542.8 9602.4 9036.4 9340.6 9375.3 9395.2 9481.8 7401.9 7409.3 7448.7 7497.2 7626.5 7396.6 8631.7 9158.8 9203.7 9392.5 04:30:26 INFO - PROCESS | 4101 | 04:30:26 INFO - PROCESS | 4101 | [#3] mootools.html Cycles:180 Average:5145.15 Median:5028.65 stddev:2859.78 (56.9%) stddev-sans-first:2853.97 04:30:26 INFO - PROCESS | 4101 | Values: 1402.1 1411.4 1541.2 1738.1 1746.1 6832.9 7486.3 7509.7 7999.4 8013.2 7657.3 7737.2 7798.4 7866.1 7868.6 2189.9 2215.1 2227.3 2230.4 2233.0 2188.0 2199.8 2234.5 2239.3 2250.1 2221.2 2225.9 2227.5 2237.5 2247.3 2176.1 2180.6 2185.3 2186.6 2192.0 2126.5 2135.0 2137.6 2141.6 2142.8 7802.3 7866.6 7882.2 7885.8 7912.4 4576.7 4687.8 4692.0 4700.3 4703.7 2957.4 2990.1 2991.6 3078.4 3136.9 917.2 950.3 960.2 962.0 970.8 10462.5 10577.8 10655.2 10690.0 10690.3 4232.7 4308.2 4382.9 4402.1 4407.3 9021.2 9023.5 9099.3 9154.1 9291.8 4658.8 4664.2 4666.1 4673.6 4674.2 3672.2 4121.8 4140.8 4280.1 4292.1 3681.1 3696.0 3774.1 3805.0 3889.4 1206.7 1217.7 1233.2 1236.0 1237.7 705.8 871.5 874.7 876.5 885.0 4976.4 5166.6 5173.6 5258.3 5287.3 417.1 430.7 433.0 435.3 441.3 3644.5 3665.1 3724.3 3736.3 3777.3 9371.7 9483.1 9490.9 9597.9 9609.3 9213.0 9470.3 9500.9 9513.7 9560.8 7264.2 7289.0 7323.5 7358.7 7419.0 5080.9 5157.3 5259.0 5260.6 5294.8 8780.9 8821.6 8826.3 8828.6 8842.4 8729.6 8948.5 8974.9 9135.2 9136.1 5998.0 6549.2 6758.1 6849.6 6872.7 7538.5 7548.5 7557.1 7569.4 7592.4 6709.7 6943.8 6949.9 6984.7 7049.4 6503.2 6511.0 6514.5 6829.3 6909.4 6007.6 6301.3 6380.0 6406.3 6415.5 4559.5 4602.9 4703.8 4708.8 4775.6 4670.8 4682.3 4794.8 4812.1 4821.2 04:30:26 INFO - PROCESS | 4101 | 04:30:26 INFO - PROCESS | 4101 | [#4] prototype.html Cycles:180 Average:4380.65 Median:5041.42 stddev:1265.03 (25.1%) stddev-sans-first:1231.06 04:30:26 INFO - PROCESS | 4101 | Values: 306.4 308.2 309.9 310.2 313.0 5035.5 5039.8 5079.8 5080.4 5097.1 4988.9 4994.5 5043.1 5054.9 5069.8 3725.2 3805.2 3897.5 3912.9 3927.6 3867.9 3899.9 3909.2 3911.1 3931.7 3906.2 3939.8 3947.7 3948.1 3956.4 3831.6 3887.2 3910.0 3929.6 3939.8 3441.9 3463.9 3479.6 3484.1 3493.5 4757.6 4777.9 4778.7 4788.9 4797.4 4429.7 4490.3 4499.7 4501.9 4533.4 5242.7 5256.2 5266.5 5266.6 5289.9 3749.9 3788.1 3796.8 3797.4 3799.7 5407.6 5539.6 5541.8 5542.9 5551.8 3889.4 3890.6 3903.7 3912.4 3912.6 3924.3 3936.9 3941.9 3942.4 3966.1 4481.8 4493.5 4497.1 4505.3 4511.9 5106.6 5168.0 5274.1 5277.3 5300.9 1361.4 1380.2 1380.5 1380.7 1384.8 857.5 872.8 897.4 899.7 907.2 4521.6 4585.3 4633.6 4644.3 4661.3 5376.4 5405.6 5414.5 5423.2 5448.9 4553.4 4572.4 4614.9 4630.5 4651.1 2883.3 2895.1 2900.3 2900.3 2927.0 5106.6 5107.9 5115.7 5129.6 5132.0 5478.7 5509.7 5565.1 5573.5 5632.3 5050.1 5107.3 5117.8 5183.5 5189.2 5403.5 5406.7 5419.6 5490.5 5513.3 5105.3 5209.0 5309.9 5327.0 5330.3 5083.1 5088.5 5090.9 5103.0 5136.2 3932.5 3937.8 3938.8 3946.5 3956.9 5339.2 5462.5 5464.5 5505.9 5528.4 5251.6 5268.8 5294.5 5318.6 5331.9 5178.7 5203.3 5257.9 5268.4 5303.1 4997.6 5152.4 5179.7 5184.6 5196.3 5021.2 5109.8 5280.9 5305.2 5338.5 5070.4 5105.7 5133.3 5158.4 5204.4 04:30:26 INFO - PROCESS | 4101 | 04:30:26 INFO - PROCESS | 4101 | [#5] yui.html Cycles:180 Average:13207.96 Median:47532.64 stddev:15675.80 (33.0%) stddev-sans-first:15691.08 04:30:26 INFO - PROCESS | 4101 | Values: 577.6 593.1 643.5 647.1 682.6 10236.5 11380.7 12074.0 12077.2 12452.2 13386.8 13471.6 13503.8 13549.5 13555.3 797.9 802.4 807.5 808.0 808.7 789.0 795.8 796.5 799.8 800.6 818.9 824.1 824.2 825.5 825.8 819.0 819.8 820.3 821.9 822.1 585.7 608.1 610.1 610.8 613.4 11010.4 11247.6 11247.9 11253.1 11282.6 10493.1 10636.3 10641.4 11211.5 11271.8 10511.3 10689.3 10895.2 10920.9 11021.2 3989.2 4058.9 4092.3 4136.6 4163.7 46622.8 47411.8 48392.3 48539.0 48931.0 9090.3 9182.9 9282.8 9524.5 10041.1 16904.0 17037.0 17048.7 17066.0 17125.5 6317.6 6354.3 6508.4 6591.7 6620.0 3487.9 3506.0 3574.3 3644.6 3693.7 2757.3 2836.7 2845.0 2845.1 2850.1 531.0 537.7 541.5 545.0 551.0 561.4 608.9 620.4 632.1 639.3 7792.5 7887.1 8105.3 8121.0 8176.8 514.5 578.0 638.8 645.1 650.8 3709.2 3803.4 3841.7 3864.8 3897.9 55675.2 56829.0 57470.7 57493.4 57503.7 45331.0 49982.8 50240.2 51280.2 51318.0 47099.3 47440.0 47625.3 47788.8 47924.5 8088.4 8120.0 8234.0 8237.2 8541.5 30329.4 30732.4 31227.8 31595.2 32864.7 41644.0 41683.2 42111.8 42570.4 42687.1 10171.4 10268.2 10287.2 10338.9 10626.3 10992.5 11014.7 11404.6 11631.2 12030.0 10001.7 10086.6 10295.7 10411.3 10637.6 10526.5 10547.4 10863.9 10927.6 11285.5 10449.0 10559.3 10714.1 10760.9 11033.1 8958.3 8988.5 9115.4 9129.9 9379.2 9100.2 9367.3 9399.7 9481.4 9490.0 04:30:26 INFO - PROCESS | 4101 | -------- Summary: end -------- 04:30:26 INFO - PROCESS | 4101 | 04:30:27 INFO - TEST-INFO | 4101: exit 0 04:30:27 INFO - TEST-OK | dromaeo_css | took 1116738ms 04:30:27 INFO - TEST-START | kraken 04:30:27 INFO - operating with platform_type : linux_ 04:30:27 INFO - Initialising browser for kraken test... 04:30:27 INFO - TEST-INFO | started process 4334 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpZFsnR0/profile http://localhost:57442/getInfo.html) 04:30:33 INFO - PROCESS | 4334 | __metrics Screen width/height:1600/1200 04:30:33 INFO - PROCESS | 4334 | colorDepth:24 04:30:33 INFO - PROCESS | 4334 | Browser inner width/height: 1024/697 04:30:33 INFO - PROCESS | 4334 | __metrics 04:30:34 ERROR - PROCESS | 4334 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2938: TypeError: this.tabs is undefined 04:30:35 INFO - TEST-INFO | 4334: exit 0 04:30:35 INFO - Browser initialized. 04:30:35 INFO - Running cycle 1/1 for kraken test... 04:30:35 INFO - TEST-INFO | started process 4454 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpZFsnR0/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 04:30:48 INFO - PROCESS | 4454 | RSS: Main: 167542784 04:30:48 INFO - PROCESS | 4454 | 04:30:50 INFO - PROCESS | 4454 | Cycle 1(1): loaded http://localhost:57442/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:57442/tests/kraken/driver.html?testName=audio-beat-detection) 04:30:51 INFO - PROCESS | 4454 | RSS: Main: 171692032 04:30:51 INFO - PROCESS | 4454 | 04:30:54 INFO - PROCESS | 4454 | Cycle 1(1): loaded http://localhost:57442/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:57442/tests/kraken/driver.html?testName=audio-dft) 04:30:55 INFO - PROCESS | 4454 | RSS: Main: 171421696 04:30:55 INFO - PROCESS | 4454 | 04:30:58 INFO - PROCESS | 4454 | Cycle 1(1): loaded http://localhost:57442/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:57442/tests/kraken/driver.html?testName=audio-fft) 04:30:58 INFO - PROCESS | 4454 | RSS: Main: 167063552 04:30:58 INFO - PROCESS | 4454 | 04:31:00 INFO - PROCESS | 4454 | Cycle 1(1): loaded http://localhost:57442/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:57442/tests/kraken/driver.html?testName=audio-oscillator) 04:31:01 INFO - PROCESS | 4454 | RSS: Main: 167702528 04:31:01 INFO - PROCESS | 4454 | 04:31:03 INFO - PROCESS | 4454 | Cycle 1(1): loaded http://localhost:57442/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:57442/tests/kraken/driver.html?testName=imaging-gaussian-blur) 04:31:04 INFO - PROCESS | 4454 | RSS: Main: 168316928 04:31:04 INFO - PROCESS | 4454 | 04:31:07 INFO - PROCESS | 4454 | Cycle 1(1): loaded http://localhost:57442/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:57442/tests/kraken/driver.html?testName=imaging-darkroom) 04:31:08 INFO - PROCESS | 4454 | RSS: Main: 168714240 04:31:08 INFO - PROCESS | 4454 | 04:31:11 INFO - PROCESS | 4454 | Cycle 1(1): loaded http://localhost:57442/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:57442/tests/kraken/driver.html?testName=imaging-desaturate) 04:31:12 INFO - PROCESS | 4454 | RSS: Main: 166051840 04:31:12 INFO - PROCESS | 4454 | 04:31:15 INFO - PROCESS | 4454 | Cycle 1(1): loaded http://localhost:57442/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:57442/tests/kraken/driver.html?testName=json-parse-financial) 04:31:15 INFO - PROCESS | 4454 | RSS: Main: 167788544 04:31:15 INFO - PROCESS | 4454 | 04:31:17 INFO - PROCESS | 4454 | Cycle 1(1): loaded http://localhost:57442/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:57442/tests/kraken/driver.html?testName=json-stringify-tinderbox) 04:31:18 INFO - PROCESS | 4454 | RSS: Main: 167755776 04:31:18 INFO - PROCESS | 4454 | 04:31:20 INFO - PROCESS | 4454 | Cycle 1(1): loaded http://localhost:57442/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:57442/tests/kraken/driver.html?testName=stanford-crypto-aes) 04:31:20 INFO - PROCESS | 4454 | RSS: Main: 168038400 04:31:20 INFO - PROCESS | 4454 | 04:31:23 INFO - PROCESS | 4454 | Cycle 1(1): loaded http://localhost:57442/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:57442/tests/kraken/driver.html?testName=stanford-crypto-ccm) 04:31:23 INFO - PROCESS | 4454 | RSS: Main: 168026112 04:31:23 INFO - PROCESS | 4454 | 04:31:26 INFO - PROCESS | 4454 | Cycle 1(1): loaded http://localhost:57442/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:57442/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 04:31:27 INFO - PROCESS | 4454 | RSS: Main: 168583168 04:31:27 INFO - PROCESS | 4454 | 04:31:30 INFO - PROCESS | 4454 | Cycle 1(1): loaded http://localhost:57442/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:57442/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 04:31:30 INFO - PROCESS | 4454 | RSS: Main: 167673856 04:31:30 INFO - PROCESS | 4454 | 04:31:32 INFO - PROCESS | 4454 | Cycle 1(1): loaded http://localhost:57442/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:57442/tests/kraken/driver.html?testName=ai-astar) 04:31:32 INFO - PROCESS | 4454 | RSS: Main: 169033728 04:31:32 INFO - PROCESS | 4454 | 04:31:32 INFO - PROCESS | 4454 | __start_tp_report 04:31:32 INFO - PROCESS | 4454 | _x_x_mozilla_page_load 04:31:32 INFO - PROCESS | 4454 | _x_x_mozilla_page_load_details 04:31:32 INFO - PROCESS | 4454 | |i|pagename|runs| 04:31:32 INFO - PROCESS | 4454 | |0;ai-astar;113;108;113;113;115;113;113;113;114;115 04:31:32 INFO - PROCESS | 4454 | |1;audio-beat-detection;154;130;162;191;130;170;163;135;183;130 04:31:32 INFO - PROCESS | 4454 | |2;audio-dft;163;163;164;171;162;163;161;161;160;161 04:31:32 INFO - PROCESS | 4454 | |3;audio-fft;76;75;78;150;79;77;76;76;173;78 04:31:32 INFO - PROCESS | 4454 | |4;audio-oscillator;85;85;147;89;86;84;138;84;85;138 04:31:32 INFO - PROCESS | 4454 | |5;imaging-gaussian-blur;118;118;117;119;118;120;121;118;118;117 04:31:32 INFO - PROCESS | 4454 | |6;imaging-darkroom;148;149;148;150;147;149;148;149;148;149 04:31:32 INFO - PROCESS | 4454 | |7;imaging-desaturate;95;96;95;96;95;96;103;96;95;96 04:31:32 INFO - PROCESS | 4454 | |8;json-parse-financial;64;65;67;65;65;66;66;66;67;65 04:31:32 INFO - PROCESS | 4454 | |9;json-stringify-tinderbox;66;67;65;66;66;66;66;66;66;66 04:31:32 INFO - PROCESS | 4454 | |10;stanford-crypto-aes;84;91;85;84;86;90;88;87;112;94 04:31:32 INFO - PROCESS | 4454 | |11;stanford-crypto-ccm;132;143;145;134;135;131;141;136;152;155 04:31:32 INFO - PROCESS | 4454 | |12;stanford-crypto-pbkdf2;171;169;167;167;175;169;165;171;168;169 04:31:32 INFO - PROCESS | 4454 | |13;stanford-crypto-sha256-iterative;67;66;68;67;71;65;65;65;66;65 04:31:32 INFO - PROCESS | 4454 | __end_tp_report 04:31:32 INFO - PROCESS | 4454 | __start_cc_report 04:31:32 INFO - PROCESS | 4454 | _x_x_mozilla_cycle_collect,965 04:31:32 INFO - PROCESS | 4454 | __end_cc_report 04:31:32 INFO - PROCESS | 4454 | __startTimestamp1464867092814__endTimestamp 04:31:32 INFO - PROCESS | 4454 | 04:31:32 INFO - PROCESS | 4454 | ------- Summary: start ------- 04:31:32 INFO - PROCESS | 4454 | Number of tests: 14 04:31:32 INFO - PROCESS | 4454 | 04:31:32 INFO - PROCESS | 4454 | [#0] ai-astar Cycles:10 Average:113.00 Median:113.00 stddev:1.94 (1.7%) stddev-sans-first:2.06 04:31:32 INFO - PROCESS | 4454 | Values: 113.0 108.0 113.0 113.0 115.0 113.0 113.0 113.0 114.0 115.0 04:31:32 INFO - PROCESS | 4454 | 04:31:32 INFO - PROCESS | 4454 | [#1] audio-beat-detection Cycles:10 Average:154.80 Median:162.50 stddev:22.84 (14.1%) stddev-sans-first:24.22 04:31:32 INFO - PROCESS | 4454 | Values: 154.0 130.0 162.0 191.0 130.0 170.0 163.0 135.0 183.0 130.0 04:31:32 INFO - PROCESS | 4454 | 04:31:32 INFO - PROCESS | 4454 | [#2] audio-dft Cycles:10 Average:162.90 Median:163.00 stddev:3.11 (1.9%) stddev-sans-first:3.30 04:31:32 INFO - PROCESS | 4454 | Values: 163.0 163.0 164.0 171.0 162.0 163.0 161.0 161.0 160.0 161.0 04:31:32 INFO - PROCESS | 4454 | 04:31:32 INFO - PROCESS | 4454 | [#3] audio-fft Cycles:10 Average:93.80 Median:76.50 stddev:36.11 (47.2%) stddev-sans-first:37.72 04:31:32 INFO - PROCESS | 4454 | Values: 76.0 75.0 78.0 150.0 79.0 77.0 76.0 76.0 173.0 78.0 04:31:32 INFO - PROCESS | 4454 | 04:31:32 INFO - PROCESS | 4454 | [#4] audio-oscillator Cycles:10 Average:102.10 Median:85.00 stddev:26.99 (31.8%) stddev-sans-first:27.91 04:31:32 INFO - PROCESS | 4454 | Values: 85.0 85.0 147.0 89.0 86.0 84.0 138.0 84.0 85.0 138.0 04:31:32 INFO - PROCESS | 4454 | 04:31:32 INFO - PROCESS | 4454 | [#5] imaging-gaussian-blur Cycles:10 Average:118.40 Median:118.00 stddev:1.26 (1.1%) stddev-sans-first:1.33 04:31:32 INFO - PROCESS | 4454 | Values: 118.0 118.0 117.0 119.0 118.0 120.0 121.0 118.0 118.0 117.0 04:31:32 INFO - PROCESS | 4454 | 04:31:32 INFO - PROCESS | 4454 | [#6] imaging-darkroom Cycles:10 Average:148.50 Median:149.00 stddev:0.85 (0.6%) stddev-sans-first:0.88 04:31:32 INFO - PROCESS | 4454 | Values: 148.0 149.0 148.0 150.0 147.0 149.0 148.0 149.0 148.0 149.0 04:31:32 INFO - PROCESS | 4454 | 04:31:32 INFO - PROCESS | 4454 | [#7] imaging-desaturate Cycles:10 Average:96.30 Median:96.00 stddev:2.41 (2.5%) stddev-sans-first:2.51 04:31:32 INFO - PROCESS | 4454 | Values: 95.0 96.0 95.0 96.0 95.0 96.0 103.0 96.0 95.0 96.0 04:31:32 INFO - PROCESS | 4454 | 04:31:32 INFO - PROCESS | 4454 | [#8] json-parse-financial Cycles:10 Average:65.60 Median:66.00 stddev:0.97 (1.5%) stddev-sans-first:0.83 04:31:32 INFO - PROCESS | 4454 | Values: 64.0 65.0 67.0 65.0 65.0 66.0 66.0 66.0 67.0 65.0 04:31:32 INFO - PROCESS | 4454 | 04:31:32 INFO - PROCESS | 4454 | [#9] json-stringify-tinderbox Cycles:10 Average:66.00 Median:66.00 stddev:0.47 (0.7%) stddev-sans-first:0.50 04:31:32 INFO - PROCESS | 4454 | Values: 66.0 67.0 65.0 66.0 66.0 66.0 66.0 66.0 66.0 66.0 04:31:32 INFO - PROCESS | 4454 | 04:31:32 INFO - PROCESS | 4454 | [#10] stanford-crypto-aes Cycles:10 Average:90.10 Median:87.50 stddev:8.35 (9.5%) stddev-sans-first:8.56 04:31:32 INFO - PROCESS | 4454 | Values: 84.0 91.0 85.0 84.0 86.0 90.0 88.0 87.0 112.0 94.0 04:31:32 INFO - PROCESS | 4454 | 04:31:32 INFO - PROCESS | 4454 | [#11] stanford-crypto-ccm Cycles:10 Average:140.40 Median:142.00 stddev:8.33 (5.9%) stddev-sans-first:8.26 04:31:32 INFO - PROCESS | 4454 | Values: 132.0 143.0 145.0 134.0 135.0 131.0 141.0 136.0 152.0 155.0 04:31:32 INFO - PROCESS | 4454 | 04:31:32 INFO - PROCESS | 4454 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:169.10 Median:169.00 stddev:2.77 (1.6%) stddev-sans-first:2.85 04:31:32 INFO - PROCESS | 4454 | Values: 171.0 169.0 167.0 167.0 175.0 169.0 165.0 171.0 168.0 169.0 04:31:32 INFO - PROCESS | 4454 | 04:31:32 INFO - PROCESS | 4454 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:66.50 Median:66.50 stddev:1.90 (2.9%) stddev-sans-first:2.01 04:31:32 INFO - PROCESS | 4454 | Values: 67.0 66.0 68.0 67.0 71.0 65.0 65.0 65.0 66.0 65.0 04:31:32 INFO - PROCESS | 4454 | -------- Summary: end -------- 04:31:32 INFO - PROCESS | 4454 | 04:31:33 INFO - TEST-INFO | 4454: exit 0 04:31:33 INFO - TEST-OK | kraken | took 66785ms 04:31:33 INFO - SUITE-END | took 1183s 04:31:33 INFO - Completed test suite (00:19:43) 04:31:33 INFO - javascript benchmark 04:31:34 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 6232.523223666088, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2630.8816103275353, 2665.586834040724, 2669.2259244819, 2675.3846615278485, 2696.1641891013774, 4634.212183928736, 4644.442666879975, 4674.041821426608, 4713.363695901053, 4757.548032936874, 4528.479224889139, 4636.907261854761, 4653.464851542074, 4667.019925815583, 4688.999999999992, 4198.559151289124, 4291.763952982585, 4341.500727416356, 4367.890802729941, 4370.169667763115, 14.689640039551858, 4203.348480985437, 4272.487301523822, 4297.871063868073, 4393.934090988638, 4224.155168966188, 4237.788110594473, 4275.593818587229, 4278.358246263055, 4333.349997500369, 4228.640565551932, 4263.232618128766, 4272.380504826782, 4276.850310239158, 4313.28830742927, 4216.9156616867795, 4218.78906054696, 4232.407462955189, 4248.277792775236, 4296.291111966521, 4505.594496495299, 4516.54834516549, 4554.043650833296, 4555.111753208126, 4582.473015603182, 4981.053599816023, 4999.775010124553, 5006.349174607314, 5010.073136469765, 5045.016221836743, 4901.852944411673, 4930.531599498042, 4949.307097006422, 4970.13022721026, 4980.477049909779, 4629.328747331651, 4667.976660116746, 4675.392199014141, 4680.906381872343, 4713.81144754206, 5040.445550989388, 5089.440161582223, 5097.515736005073, 5110.233464980282, 5145.022445735298, 4895.8041678332465, 4900.411950565955, 4920.089783390084, 4930.2851086592245, 4956.727379994135, 5021.799128034911, 5023.974880125576, 5024.799008039638, 5030.044291584587, 5083.2375143727995, 4871.0, 4900.411950565884, 4981.028699403654, 4985.850424487271, 5031.094403007421, 4882.462929077798, 4918.6556941014505, 4933.6793108448555, 4938.75306234694, 4981.601471882241, 4231.87304380869, 4233.470816147981, 4236.301010333322, 4252.55348188442, 4275.5724427557, 3654.3787556115526, 3710.870119545857, 3711.870084547082, 3734.2531493701367, 3751.099736063325, 4259.0, 4307.913841723148, 4316.568343165721, 4366.432363792686, 4427.203103441411, 5017.0, 5021.271915572294, 5036.219385995177, 5039.0, 5080.034793389244, 4235.576442355739, 4342.544032876565, 4343.348497725303, 4347.673924455616, 4395.450568678915, 4557.680962332671, 4564.84023059198, 4574.748388838646, 4619.491855895849, 4642.628589712815, 4768.427788665383, 4784.808607655725, 4790.233562630032, 4801.4958429364415, 4855.101806165871, 4867.61059115277, 4977.676451030671, 5004.899902002013, 5086.694798312114, 5101.489851014869, 4709.693869898446, 4739.0, 4764.976175119103, 4799.904001919872, 4805.423349198119, 4938.061768264019, 4947.183714687037, 4948.05986862495, 4953.207486802238, 4986.526280003394, 4882.218844984785, 5017.0, 5018.723970181675, 5027.622928280321, 5064.468230835857, 4899.559039686445, 4905.632077594266, 4929.211326187793, 4938.037082768826, 4980.526849949249, 4929.728864912464, 4931.580815630711, 4936.9259461107395, 4938.75306234694, 4982.676126051795, 4673.509281525391, 4795.976020119877, 4801.927971080367, 4828.903421931612, 4907.97546012282, 4915.729634870117, 4936.3829521309835, 4945.950540494549, 4962.404511458648, 4986.675866068694, 4843.4430040545785, 4845.854624361275, 4848.660593758545, 4850.442199147002, 4902.362692849907], "value": 4567.958534580645, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [543.9020976224281, 599.4724642314762, 600.4775845014835, 601.1373678770964, 608.3490664988464, 30160.396792064173, 39453.408198877005, 40183.799081004625, 40549.0, 43939.56060439395, 42201.788991055, 42540.0, 42774.0, 42831.357529637084, 42903.141937161236, 7607.61961901904, 7746.535207887517, 7759.650815713307, 7760.650770715331, 7760.961195194016, 7654.349380302681, 7749.070111586618, 7777.611119444005, 7788.844223115534, 7796.883046754303, 7686.192949740281, 7754.418418618598, 7777.8055548611455, 7816.062072551302, 7827.412944029192, 7744.457887947846, 7769.6115194240065, 7792.41556883236, 7798.376129909594, 7807.258310460497, 7562.432817538706, 7602.809929751746, 7629.618519074024, 7646.350060244886, 7659.655315510815, 38942.22115557701, 39334.80332598319, 39367.803160984295, 39473.605263947284, 39487.8025609873, 3164.984175079133, 3222.822744749038, 3252.8861489847977, 3330.5170750241077, 3422.4866270059442, 29412.852935735184, 29796.255093622833, 30185.698143018508, 30687.079387618185, 30729.692703072906, 3428.5200071989943, 3440.1055725511546, 3452.205992621686, 3460.5501284833063, 3479.2171761353748, 251258.0, 251639.0, 252367.0, 253251.0, 253359.0, 29145.56281655777, 29498.115056548337, 29727.0, 53484.73257633765, 53754.731226344404, 34023.31953360919, 34035.65964340374, 34157.316853662785, 34188.0, 34195.31609367799, 12745.808812867814, 12806.03954703401, 12872.420741066488, 12873.549425770054, 12878.613641590768, 11298.54805807775, 11310.60412885545, 11386.373749443861, 11393.658190254306, 11394.65816025504, 7884.526928384315, 7932.484388514728, 8004.359651227888, 8009.839803203903, 8019.318357939641, 3136.8274744888795, 3145.937081258408, 3176.0630613968933, 3187.0, 3215.389076075538, 883.8188171424842, 919.7838507950627, 947.4552132523827, 986.2750878104588, 995.0745806400117, 27994.86002569974, 28265.434691306058, 28539.85730071378, 28840.423191536473, 28840.711592883803, 994.8457989011715, 996.9252306076928, 1071.0788721699332, 1086.9021788039115, 1087.3258579680648, 14812.0, 15120.924395378173, 15180.165090919885, 15382.230888455533, 15431.459898903484, 363366.0, 363605.0, 369035.0, 369307.0, 369409.0, 50024.0, 50050.0, 50300.245496317584, 50361.74819125881, 50427.495725043016, 1192.5408717643595, 1196.475693853835, 1215.6960759810047, 1234.2964510229083, 1240.665020444493, 26533.469330613665, 27522.17433476999, 27557.0, 27912.441751164457, 28040.43919121647, 42614.36078458764, 42701.35947960845, 43045.35431968586, 43068.35397468978, 43275.35086973635, 318793.0, 318804.0, 319175.0, 319655.0, 320014.0, 18775.0, 18778.718319225496, 18783.6243275131, 18879.43361699151, 18934.147963341406, 42370.15259694727, 42703.57296426996, 42748.572514274456, 46215.537844621125, 46378.768106160605, 35461.46807797834, 37398.0, 37914.43128353132, 38134.0, 38776.612233878426, 35627.64372356243, 36101.81949090238, 36245.63754362422, 36590.451143233404, 37218.44172337363, 31297.687023129478, 36080.63919360773, 36211.637883620824, 36736.0, 36816.44775328426, 31346.0, 32606.51090233696, 32765.0, 33351.83324083364, 33356.332873342886, 25071.498570028863, 25629.743702562737, 25845.48309033771, 26123.346916327242, 26143.346416339744], "value": 16410.298448425587, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [361.3387500873402, 369.0883517711253, 379.5464420018078, 383.77165586476036, 387.146342315195, 15537.0, 15727.84272157278, 16923.407680731176, 16954.915225423887, 16968.575785605368, 16037.919810400961, 16542.090185039848, 17177.742333865, 17182.054986975712, 17187.570310742238, 4976.178930476467, 5118.181091025437, 5130.794768209267, 5136.871578210537, 5145.81989630363, 4960.553550180483, 5035.471275516073, 5039.370078740158, 5087.414947281054, 5129.461406552315, 5011.749412529359, 5047.974760126194, 5090.720010399426, 5100.33695619569, 5105.668131571455, 4988.87527811804, 5017.147084995541, 5022.096022715909, 5030.723310217936, 5065.544101030925, 5223.3209682741, 5250.684958902478, 5273.657212281228, 5287.550558202557, 5301.469853014706, 12327.445264963098, 16278.77909156818, 19824.306149284705, 20405.183792648277, 20420.591588168154, 1719.6990526657785, 1774.7870255569414, 1795.2549691877855, 1837.127364501851, 1940.398476472284, 9549.761255968657, 9557.713268601952, 10183.643572475003, 10933.671989840317, 12864.935675321563, 1758.3669878843607, 1760.2958816473385, 1787.0350010994048, 1787.258287810557, 1834.9266029358944, 67643.3235667642, 69420.0, 71288.64355678241, 71357.28642713558, 71668.64165679138, 9838.704838854846, 10027.448490333101, 10109.494525273707, 10242.692719218436, 10350.275480716278, 14321.212333321768, 14393.064450810663, 14400.207988560729, 14455.78316325256, 14463.78304325436, 7168.892466613005, 7330.157031941395, 7459.440541959375, 7568.772936811904, 7579.772606821804, 6953.269906659829, 7012.0, 7072.752453664097, 7115.644217789089, 7196.748113815991, 4350.934735978963, 4404.7357158570585, 4451.532589078165, 4473.217186992263, 4477.910441791211, 1850.1766713812224, 1882.8870267783977, 1903.381401044666, 1905.4664693885734, 1927.4121392974996, 842.7808769719794, 868.5961028121953, 934.63082082577, 944.8629948657406, 945.5603144537823, 16509.83490165107, 16660.75008874868, 16881.49355519312, 16997.575060623585, 17189.484315470556, 836.690424542923, 844.7930257087053, 855.2174760094443, 890.7105190813012, 902.7743064233941, 9164.725058248263, 9403.247740180768, 9488.193503552275, 9515.524223788922, 9589.376690515233, 399099.0, 406897.0, 412220.0, 412603.0, 412772.0, 75684.0, 77534.0, 77791.0, 77871.2212877864, 78835.21164788393, 886.609891647673, 899.6086702284528, 922.2529750901657, 924.653255029364, 982.5431174503747, 14998.850011499746, 15541.766873497132, 15789.0, 15904.681906362039, 16092.678146436772, 35440.822795885855, 36418.63581364152, 37162.0, 37302.8134859324, 37619.435708464945, 49159.50840491692, 50082.74958625183, 50717.0, 50762.0, 51571.0, 7152.892706609301, 7261.164966028974, 7408.555486670817, 7458.440616953641, 7541.057367829021, 9295.581698823704, 9810.117089461983, 10251.333663311862, 10527.315724477885, 10624.628138015132, 8596.957015214884, 8921.732348029569, 9192.31057670664, 9198.67804626835, 9417.670381536887, 9275.118863707938, 9396.624135034795, 9473.810523789623, 9542.761430964003, 9602.375845570015, 9036.412633178823, 9340.579673914826, 9375.343725939392, 9395.201407880406, 9481.810363792823, 7401.888971665322, 7409.333160015624, 7448.702051917862, 7497.175310715926, 7626.54240745557, 7396.630168491662, 8631.654733810577, 9158.771030724285, 9203.677871274473, 9392.530373481162], "value": 8054.398896811187, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1402.0746307437093, 1411.3648858013894, 1541.1831729183536, 1738.1222482646263, 1746.1443892492682, 6832.897506537406, 7486.251374862511, 7509.699612015526, 7999.400044996627, 8013.15861834507, 7657.310842024217, 7737.187595302496, 7798.4151188660935, 7866.095399029114, 7868.645910934008, 2189.879556624385, 2215.125025614881, 2227.3318004598555, 2230.4423894026495, 2232.9665055024107, 2187.9781202188015, 2199.7580266170708, 2234.530748542808, 2239.261043855524, 2250.0662225176616, 2221.1559607349186, 2225.877576733279, 2227.543353612514, 2237.4853783629774, 2247.314569056437, 2176.064292354287, 2180.607490651682, 2185.2897808212315, 2186.606410846047, 2191.9780802191935, 2126.542793299448, 2135.0392323454507, 2137.6045431595203, 2141.635921893282, 2142.7964343387353, 7802.258785415376, 7866.567338796364, 7882.211778822129, 7885.8028549286155, 7912.4065695073095, 4576.702514336557, 4687.7656117194, 4692.0381321828945, 4700.318453824177, 4703.741294228816, 2957.364166704169, 2990.1029691092804, 2991.5781219757837, 3078.415101130778, 3136.8588413521447, 917.2341095185528, 950.3110245072336, 960.2270172511126, 962.0331566775416, 970.8203982263304, 10462.476876156237, 10577.84133238002, 10655.200859935458, 10690.0, 10690.251682382237, 4232.661387089087, 4308.202982448257, 4382.912341753147, 4402.141582391467, 4407.2507673695545, 9021.188093071654, 9023.548822558845, 9099.317551183687, 9154.130357616015, 9291.76770580741, 4658.836940707059, 4664.207084795593, 4666.090112428112, 4673.649476289292, 4674.158651442705, 3672.192117734094, 4121.752694838319, 4140.834366625361, 4280.122574872144, 4292.077203401283, 3681.0981309579324, 3695.981520092382, 3774.0753515388906, 3805.0487378155462, 3889.397143442771, 1206.6500714792787, 1217.7381862899342, 1233.173773571709, 1236.0, 1237.7029512916836, 705.7847356556197, 871.4640496094856, 874.6501399440275, 876.4565969099199, 884.969026084084, 4976.377952755905, 5166.560842328369, 5173.63784535079, 5258.2638430619745, 5287.259783630295, 417.1344460245004, 430.74801241274207, 433.02137169996035, 435.29264944465245, 441.271901362754, 3644.489771432002, 3665.083729067733, 3724.2923844469465, 3736.308782875177, 3777.301199278142, 9371.718848434422, 9483.099105584959, 9490.90509094914, 9597.9040209597, 9609.279304052225, 9212.953935230282, 9470.337076404585, 9500.857487137699, 9513.66702165421, 9560.76098097553, 7264.200937896721, 7289.0, 7323.487355885037, 7358.742444014434, 7418.962905185547, 5080.923786143137, 5157.303763991813, 5259.0, 5260.605454590997, 5294.761735721825, 8780.868286975829, 8821.60302786389, 8826.338024648305, 8828.64685412602, 8842.425242359226, 8729.563521824011, 8948.463092214228, 8974.86537701948, 9135.223506002065, 9136.132067453582, 5997.970010149921, 6549.181352330958, 6758.053872457762, 6849.554778939353, 6872.656367181721, 7538.547687138789, 7548.509346892434, 7557.05536807899, 7569.432292578189, 7592.392608591189, 6709.664516774239, 6943.826404339932, 6949.930500694928, 6984.7206111757, 7049.400800931979, 6503.187101612299, 6511.0, 6514.51141164424, 6829.282925292971, 6909.378155965786, 6007.609505382136, 6301.306856245901, 6380.042993550819, 6406.263279722705, 6415.486761059011, 4559.521250268674, 4602.930956035595, 4703.788329525111, 4708.81164753406, 4775.617950564016, 4670.789814458425, 4682.2508398656055, 4794.832180873653, 4812.133815913169, 4821.180399332052], "value": 4100.230636827585, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [306.3566510328311, 308.1863879358494, 309.91322429719673, 310.2290807343752, 312.97652676049296, 5035.532589031372, 5039.773210205541, 5079.780852595378, 5080.415752188499, 5097.082525145482, 4988.875278118049, 4994.475580064095, 5043.067032598962, 5054.924176137351, 5069.822556210534, 3725.236326553057, 3805.2009078093633, 3897.473841031467, 3912.8630497932577, 3927.6465118139363, 3867.9226415471676, 3899.922001559967, 3909.198614284079, 3911.061345277127, 3931.7247792654525, 3906.2187562487616, 3939.7833119178435, 3947.6841852651864, 3948.072203032285, 3956.4460975463458, 3831.59768224338, 3887.2031233597045, 3909.960900390988, 3929.5677475477673, 3939.763614183158, 3441.8795342162903, 3463.8787642432394, 3479.6346383629607, 3484.0767196692896, 3493.528373669573, 4757.5718185363485, 4777.856664300077, 4778.665493415462, 4788.904221915577, 4797.40032495938, 4429.6522842893, 4490.3040028795585, 4499.707519011254, 4501.909961800779, 4533.38799262102, 5242.737863106868, 5256.237845512417, 5266.4733526647415, 5266.631335806495, 5289.947100528984, 3749.850005999757, 3788.1287303919976, 3796.772193668361, 3797.411401232813, 3799.734018618698, 5407.567394608422, 5539.6150962259435, 5541.778328866841, 5542.889142217133, 5551.833444996657, 3889.358255887747, 3890.6109389060866, 3903.707221958308, 3912.374020156818, 3912.56961734209, 3924.3328634132267, 3936.9331101172115, 3941.9014524637114, 3942.448057271984, 3966.147278335172, 4481.843135490242, 4493.483249426293, 4497.145542346943, 4505.256632655575, 4511.8646440606835, 5106.617003724736, 5167.974160129175, 5274.129768588216, 5277.313949186581, 5300.946990530122, 1361.360160724458, 1380.151207007703, 1380.544420341305, 1380.6686395265065, 1384.7992041154178, 857.4812238595684, 872.7556284240296, 897.3673560140217, 899.7255836969787, 907.1699395053585, 4521.570450807234, 4585.312203169551, 4633.606143477842, 4644.2801365788355, 4661.254199328091, 5376.4085950545405, 5405.648632838932, 5414.536385944386, 5423.207048370093, 5448.874938773882, 4553.362529245908, 4572.35986961819, 4614.861554153381, 4630.513796051433, 4651.116287905287, 2883.2935930697113, 2895.0880472651047, 2900.303927057491, 2900.3461832423095, 2927.0, 5106.570160355107, 5107.923381149286, 5115.7442127893455, 5129.589632829365, 5132.0, 5478.700591456296, 5509.713468910358, 5565.081761509306, 5573.498385145356, 5632.324121105494, 5050.141475949097, 5107.336046313955, 5117.769700363493, 5183.50756678115, 5189.169732842727, 5403.5136837684795, 5406.675599464044, 5419.593530485151, 5490.450954904478, 5513.255710479034, 5105.2597373381395, 5209.0, 5309.893802124013, 5326.999999999845, 5330.333708286465, 5083.1358669027095, 5088.49115088503, 5090.872728181825, 5102.974485127551, 5136.203888397305, 3932.4691166692132, 3937.8424863005157, 3938.7636741795586, 3946.506686664167, 3956.8812935611977, 5339.225812257123, 5462.508374246337, 5464.480874316933, 5505.862353441196, 5528.419515950928, 5251.632385732962, 5268.841934741964, 5294.470552944675, 5318.627696061239, 5331.893362132813, 5178.71517066565, 5203.27154198405, 5257.868553286198, 5268.420473747808, 5303.117393325469, 4997.600191984705, 5152.355955505562, 5179.715115668674, 5184.611154163377, 5196.298499702491, 5021.221710634857, 5109.846704598868, 5280.867978300574, 5305.2307415423775, 5338.519533242027, 5070.366204224472, 5105.668131571436, 5133.281340612392, 5158.3552055993005, 5204.375474943031], "value": 3977.7055875983983, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [577.5639392258844, 593.1281016905148, 643.4659232836746, 647.1328419917313, 682.5938566552902, 10236.539355728992, 11380.658580242596, 12074.0, 12077.15459917805, 12452.190607610522, 13386.799198012037, 13471.595852124452, 13503.797443038362, 13549.525766598172, 13555.25446100464, 797.9002624671931, 802.3500964218972, 807.4912804932884, 808.0343988933228, 808.6724876425058, 788.9763307100797, 795.7930937956115, 796.4623878881731, 799.8240387114826, 800.5676934455387, 818.893543839303, 824.0605709491185, 824.1799409587469, 825.475822852487, 825.8141918068446, 819.0376307838296, 819.8278361544083, 820.2945466898462, 821.9095899451056, 822.0546371672565, 585.6515373352848, 608.0514397539852, 610.1183789424284, 610.8320211941707, 613.4356392119261, 11010.449477526092, 11247.60633377836, 11247.887521124847, 11253.099752019818, 11282.605108821233, 10493.108085812715, 10636.30863993838, 10641.414722190277, 11211.495482703298, 11271.774564508745, 10511.316764410365, 10689.30519516229, 10895.237333386665, 10920.890791092066, 11021.173411994132, 3989.16227592206, 4058.939115913264, 4092.263392589333, 4136.648384887289, 4163.708540402173, 46622.76688616569, 47411.76294118542, 48392.27411588829, 48539.02921941577, 48931.0, 9090.318226133066, 9182.86225706615, 9282.767930801649, 9524.476153811469, 10041.146502547219, 16904.0, 17037.0, 17048.744268835977, 17066.0, 17125.48623541296, 6317.557770955989, 6354.3010268870385, 6508.414242718178, 6591.736330546821, 6620.040094186413, 3487.877924272689, 3505.964940350615, 3574.303010912847, 3644.599094099647, 3693.686036686912, 2757.2968892932577, 2836.7446929776006, 2845.0, 2845.1037923054173, 2850.1164638961986, 530.9628326017219, 537.7472587883689, 541.4720647368863, 544.9918251226235, 551.0494397164939, 561.3936948096047, 608.8964875971095, 620.4354037825557, 632.0645444741716, 639.2744235292884, 7792.532448053022, 7887.132415434297, 8105.31104856082, 8121.0, 8176.831976683286, 514.5266354953452, 577.9682117483579, 638.8179368879847, 645.1000853808911, 650.8047585724264, 3709.1839795245005, 3803.372443546784, 3841.7310788244554, 3864.768113913174, 3897.8635747748694, 55675.1541088188, 56829.0, 57470.7126464365, 57493.425065749645, 57503.71248143816, 45331.0, 49982.75008624933, 50240.24639630409, 51280.23079653808, 51318.0, 47099.29351059737, 47440.0, 47625.28562071572, 47788.7610561945, 47924.52075479201, 8088.352931765562, 8120.025596928406, 8234.0, 8237.217464340878, 8541.487510749375, 30329.393412131194, 30732.385352293277, 31227.84386078055, 31595.21011974719, 32864.67135328616, 41644.0, 41683.166336673705, 42111.7894410526, 42570.361444577735, 42687.14625707406, 10171.389716617026, 10268.178545716175, 10287.177025838064, 10338.948305258726, 10626.309289896131, 10992.450377481255, 11014.669559913216, 11404.600838970597, 11631.185816992729, 12030.0, 10001.699949001542, 10086.596536138471, 10295.742606434898, 10411.323263987817, 10637.574497020032, 10526.473676316, 10547.419891905713, 10863.945680271549, 10927.56289748433, 11285.492152852978, 10449.0, 10559.313644613076, 10714.14286857034, 10760.946195268974, 11033.117350611772, 8958.328125390492, 8988.505632190292, 9115.407498512575, 9129.908700912905, 9379.202767764544, 9100.22648074921, 9367.250619950524, 9399.671011514838, 9481.383710058824, 9490.0], "value": 5951.484632881368, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1587.4999999999998, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [113.0, 108.0, 113.0, 113.0, 115.0, 113.0, 113.0, 113.0, 114.0, 115.0], "value": 113.0, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [154.0, 130.0, 162.0, 191.0, 130.0, 170.0, 163.0, 135.0, 183.0, 130.0], "value": 154.8, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 163.0, 164.0, 171.0, 162.0, 163.0, 161.0, 161.0, 160.0, 161.0], "value": 162.9, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 75.0, 78.0, 150.0, 79.0, 77.0, 76.0, 76.0, 173.0, 78.0], "value": 93.8, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 85.0, 147.0, 89.0, 86.0, 84.0, 138.0, 84.0, 85.0, 138.0], "value": 102.1, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 118.0, 117.0, 119.0, 118.0, 120.0, 121.0, 118.0, 118.0, 117.0], "value": 118.4, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [148.0, 149.0, 148.0, 150.0, 147.0, 149.0, 148.0, 149.0, 148.0, 149.0], "value": 148.5, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 96.0, 95.0, 96.0, 95.0, 96.0, 103.0, 96.0, 95.0, 96.0], "value": 96.3, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [64.0, 65.0, 67.0, 65.0, 65.0, 66.0, 66.0, 66.0, 67.0, 65.0], "value": 65.6, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [66.0, 67.0, 65.0, 66.0, 66.0, 66.0, 66.0, 66.0, 66.0, 66.0], "value": 66.0, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 91.0, 85.0, 84.0, 86.0, 90.0, 88.0, 87.0, 112.0, 94.0], "value": 90.1, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [132.0, 143.0, 145.0, 134.0, 135.0, 131.0, 141.0, 136.0, 152.0, 155.0], "value": 140.4, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [171.0, 169.0, 167.0, 167.0, 175.0, 169.0, 165.0, 171.0, 168.0, 169.0], "value": 169.1, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [67.0, 66.0, 68.0, 67.0, 71.0, 65.0, 65.0, 65.0, 66.0, 65.0], "value": 66.5, "unit": "score"}]}]} 04:31:34 INFO - Return code: 0 04:31:34 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 04:31:34 ERROR - # TBPL SUCCESS # 04:31:34 INFO - Running post-action listener: _resource_record_post_action 04:31:34 INFO - ##### 04:31:34 INFO - ##### Finished run-tests step (success) 04:31:34 INFO - ##### 04:31:34 INFO - Running post-run listener: _resource_record_post_run 04:31:34 INFO - Total resource usage - Wall time: 1201s; CPU: 13.0%; Read bytes: 462848; Write bytes: 304623616; Read time: 92; Write time: 588756 04:31:34 INFO - TinderboxPrint: CPU usage
13.5% 04:31:34 INFO - TinderboxPrint: I/O read bytes / time
462,848 / 92 04:31:34 INFO - TinderboxPrint: I/O write bytes / time
304,623,616 / 588,756 04:31:34 INFO - TinderboxPrint: CPU idle
8,289.2 (86.5%) 04:31:34 INFO - TinderboxPrint: CPU user
1,228.3 (12.8%) 04:31:34 INFO - TinderboxPrint: Swap in / out
0 / 0 04:31:34 INFO - install - Wall time: 16s; CPU: 13.0%; Read bytes: 0; Write bytes: 17502208; Read time: 0; Write time: 15228 04:31:34 INFO - run-tests - Wall time: 1185s; CPU: 13.0%; Read bytes: 462848; Write bytes: 287121408; Read time: 92; Write time: 573528 04:31:34 INFO - Running post-run listener: _upload_blobber_files 04:31:34 INFO - Blob upload gear active. 04:31:34 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 04:31:34 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 04:31:34 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Firefox-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 04:31:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Firefox-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 04:31:35 INFO - (blobuploader) - INFO - Open directory for files ... 04:31:35 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 04:31:35 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:31:35 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:31:36 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 04:31:36 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:31:36 INFO - (blobuploader) - INFO - Done attempting. 04:31:36 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 04:31:36 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:31:36 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:31:36 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 04:31:36 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:31:36 INFO - (blobuploader) - INFO - Done attempting. 04:31:36 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 04:31:36 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:31:36 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:31:40 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 04:31:40 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:31:40 INFO - (blobuploader) - INFO - Done attempting. 04:31:40 INFO - (blobuploader) - INFO - Iteration through files over. 04:31:40 INFO - Return code: 0 04:31:40 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 04:31:40 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 04:31:40 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/f63d99d4fd6b492dd3613fd87b40f5c04afed1ee6febcc127101fa2126316a0cd921203669193f1d203fb812474970773f631ba89806a54deb134cfc57fcc0ac", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/005f411ea1733d325cfcbb199dda885e856df80b7ffe1e14e1b61df1626ec6b719e2c80d41ba4ccb91b96f94ebafdda8dbb5bf77b8cc164f943b1958b0d87eb3", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/c15ea4b398a6cb94075876a0b21b40452e1c658467848edb2edd8bd9270677e86324c32ede83851936ed4f2e43011de86de6371a780236ed54720e74e4730fb4"} 04:31:40 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 04:31:40 INFO - Writing to file /builds/slave/test/properties/blobber_files 04:31:40 INFO - Contents: 04:31:40 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/f63d99d4fd6b492dd3613fd87b40f5c04afed1ee6febcc127101fa2126316a0cd921203669193f1d203fb812474970773f631ba89806a54deb134cfc57fcc0ac", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/005f411ea1733d325cfcbb199dda885e856df80b7ffe1e14e1b61df1626ec6b719e2c80d41ba4ccb91b96f94ebafdda8dbb5bf77b8cc164f943b1958b0d87eb3", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/c15ea4b398a6cb94075876a0b21b40452e1c658467848edb2edd8bd9270677e86324c32ede83851936ed4f2e43011de86de6371a780236ed54720e74e4730fb4"} 04:31:40 INFO - Running post-run listener: copy_logs_to_upload_dir 04:31:40 INFO - Copying logs to upload dir... 04:31:40 INFO - mkdir: /builds/slave/test/build/upload/logs 04:31:40 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1268.444661 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 8 secs) (at 2016-06-02 04:31:40.859631) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-02 04:31:40.863193) ========= 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=5cf47e208febbcd81da23b2e0000026f-1464864800.711397-173241730 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/Firefox-Non-PGO/sha512/f63d99d4fd6b492dd3613fd87b40f5c04afed1ee6febcc127101fa2126316a0cd921203669193f1d203fb812474970773f631ba89806a54deb134cfc57fcc0ac", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/005f411ea1733d325cfcbb199dda885e856df80b7ffe1e14e1b61df1626ec6b719e2c80d41ba4ccb91b96f94ebafdda8dbb5bf77b8cc164f943b1958b0d87eb3", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/c15ea4b398a6cb94075876a0b21b40452e1c658467848edb2edd8bd9270677e86324c32ede83851936ed4f2e43011de86de6371a780236ed54720e74e4730fb4"} build_url:https://queue.taskcluster.net/v1/task/LDIbvV_2TDyhmXd1cbv8Tg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011240 build_url: 'https://queue.taskcluster.net/v1/task/LDIbvV_2TDyhmXd1cbv8Tg/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/Firefox-Non-PGO/sha512/f63d99d4fd6b492dd3613fd87b40f5c04afed1ee6febcc127101fa2126316a0cd921203669193f1d203fb812474970773f631ba89806a54deb134cfc57fcc0ac", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/005f411ea1733d325cfcbb199dda885e856df80b7ffe1e14e1b61df1626ec6b719e2c80d41ba4ccb91b96f94ebafdda8dbb5bf77b8cc164f943b1958b0d87eb3", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/c15ea4b398a6cb94075876a0b21b40452e1c658467848edb2edd8bd9270677e86324c32ede83851936ed4f2e43011de86de6371a780236ed54720e74e4730fb4"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-02 04:31:40.891005) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-02 04:31:40.891391) ========= 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=5cf47e208febbcd81da23b2e0000026f-1464864800.711397-173241730 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004422 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-02 04:31:40.974654) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-02 04:31:40.974973) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-02 04:31:40.975296) ========= ========= Total master_lag: 0.17 =========