builder: fx-team_ubuntu64_hw_test-dromaeojs slave: talos-linux64-ix-069 starttime: 1457370283.93 results: success (0) buildid: 20160307084327 builduid: f61b4763a7264b18a7afe3d2383d76f0 revision: 9a42fa7fb4ab6da62b1df606e122642d73fb6556 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-03-07 09:04:43.931159) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-03-07 09:04:43.931521) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-07 09:04:43.933846) ========= bash -c pwd in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'pwd'] 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=1861a34ebfea852630dec091000001fa-1457370210.916850-397263336 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test program finished with exit code 0 elapsedTime=0.005806 basedir: '/builds/slave/test' ========= master_lag: 0.43 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-07 09:04:44.366244) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-03-07 09:04:44.366550) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-03-07 09:04:44.392786) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-07 09:04:44.393060) ========= rm -rf properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', '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=1861a34ebfea852630dec091000001fa-1457370210.916850-397263336 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004594 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-07 09:04:44.441437) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-07 09:04:44.441718) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-07 09:04:44.442085) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-07 09:04:44.442357) ========= 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=1861a34ebfea852630dec091000001fa-1457370210.916850-397263336 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-03-07 09:04:46-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 220M=0s 2016-03-07 09:04:47 (220 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.152793 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-07 09:04:44.612824) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-07 09:04:44.613126) ========= rm -rf scripts in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts'] 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=1861a34ebfea852630dec091000001fa-1457370210.916850-397263336 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.021884 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-07 09:04:44.664170) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-07 09:04:44.664484) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 9a42fa7fb4ab6da62b1df606e122642d73fb6556 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/fx-team --rev 9a42fa7fb4ab6da62b1df606e122642d73fb6556 --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=1861a34ebfea852630dec091000001fa-1457370210.916850-397263336 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-03-07 09:04:47,130 truncating revision to first 12 chars 2016-03-07 09:04:47,130 Setting DEBUG logging. 2016-03-07 09:04:47,130 attempt 1/10 2016-03-07 09:04:47,130 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/9a42fa7fb4ab?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-03-07 09:04:47,489 unpacking tar archive at: fx-team-9a42fa7fb4ab/testing/mozharness/ program finished with exit code 0 elapsedTime=0.664624 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-07 09:04:45.341330) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-07 09:04:45.341647) ========= echo 9a42fa7fb4ab6da62b1df606e122642d73fb6556 in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'9a42fa7fb4ab6da62b1df606e122642d73fb6556'] 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=1861a34ebfea852630dec091000001fa-1457370210.916850-397263336 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 9a42fa7fb4ab6da62b1df606e122642d73fb6556 program finished with exit code 0 elapsedTime=0.003385 script_repo_revision: '9a42fa7fb4ab6da62b1df606e122642d73fb6556' ========= master_lag: 0.04 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-07 09:04:45.388855) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-07 09:04:45.389128) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-07 09:04:45.399019) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 33 secs) (at 2016-03-07 09:04:45.399643) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-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', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team-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=1861a34ebfea852630dec091000001fa-1457370210.916850-397263336 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 09:04:47 INFO - MultiFileLogger online at 20160307 09:04:47 in /builds/slave/test 09:04:47 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO 09:04:47 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 09:04:47 INFO - {'append_to_log': False, 09:04:47 INFO - 'base_work_dir': '/builds/slave/test', 09:04:47 INFO - 'blob_upload_branch': 'Fx-Team-Non-PGO', 09:04:47 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 09:04:47 INFO - 'branch': 'Fx-Team-Non-PGO', 09:04:47 INFO - 'buildbot_json_path': 'buildprops.json', 09:04:47 INFO - 'config_files': ('talos/linux_config.py',), 09:04:47 INFO - 'default_actions': ('clobber', 09:04:47 INFO - 'read-buildbot-config', 09:04:47 INFO - 'download-and-extract', 09:04:47 INFO - 'populate-webroot', 09:04:47 INFO - 'create-virtualenv', 09:04:47 INFO - 'install', 09:04:47 INFO - 'run-tests'), 09:04:47 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 09:04:47 INFO - 'download_minidump_stackwalk': True, 09:04:47 INFO - 'download_symbols': 'ondemand', 09:04:47 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 09:04:47 INFO - 'tooltool.py': '/tools/tooltool.py', 09:04:47 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 09:04:47 INFO - '/tools/misc-python/virtualenv.py')}, 09:04:47 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 09:04:47 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 09:04:47 INFO - 'installer_path': 'installer.exe', 09:04:47 INFO - 'log_level': 'info', 09:04:47 INFO - 'log_name': 'talos', 09:04:47 INFO - 'log_to_console': True, 09:04:47 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 09:04:47 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 09:04:47 INFO - 'opt_config_files': (), 09:04:47 INFO - 'pip_index': False, 09:04:47 INFO - 'sps_profile': False, 09:04:47 INFO - 'sps_profile_interval': 0, 09:04:47 INFO - 'suite': 'dromaeojs', 09:04:47 INFO - 'system_bits': '32', 09:04:47 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 09:04:47 INFO - 'title': 'talos-linux64-ix-069', 09:04:47 INFO - 'tooltool_cache': '/builds/tooltool_cache', 09:04:47 INFO - 'use_talos_json': True, 09:04:47 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 09:04:47 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 09:04:47 INFO - 'work_dir': 'build'} 09:04:47 INFO - ##### 09:04:47 INFO - ##### Running clobber step. 09:04:47 INFO - ##### 09:04:47 INFO - Running pre-action listener: _resource_record_pre_action 09:04:47 INFO - Running main action method: clobber 09:04:47 INFO - rmtree: /builds/slave/test/build 09:04:47 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 09:04:48 INFO - Running post-action listener: _resource_record_post_action 09:04:48 INFO - ##### 09:04:48 INFO - ##### Running read-buildbot-config step. 09:04:48 INFO - ##### 09:04:48 INFO - Running pre-action listener: _resource_record_pre_action 09:04:48 INFO - Running main action method: read_buildbot_config 09:04:48 INFO - Using buildbot properties: 09:04:48 INFO - { 09:04:48 INFO - "project": "", 09:04:48 INFO - "product": "firefox", 09:04:48 INFO - "script_repo_revision": "production", 09:04:48 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs", 09:04:48 INFO - "repository": "", 09:04:48 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team talos dromaeojs", 09:04:48 INFO - "buildid": "20160307084327", 09:04:48 INFO - "pgo_build": "False", 09:04:48 INFO - "basedir": "/builds/slave/test", 09:04:48 INFO - "buildnumber": 2609, 09:04:48 INFO - "slavename": "talos-linux64-ix-069", 09:04:48 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 09:04:48 INFO - "platform": "ubuntu64_hw", 09:04:48 INFO - "scheduler": "tests-fx-team-linux64-talos", 09:04:48 INFO - "branch": "fx-team", 09:04:48 INFO - "repo_path": "integration/fx-team", 09:04:48 INFO - "revision": "9a42fa7fb4ab6da62b1df606e122642d73fb6556", 09:04:48 INFO - "stage_platform": "linux64", 09:04:48 INFO - "builduid": "f61b4763a7264b18a7afe3d2383d76f0", 09:04:48 INFO - "slavebuilddir": "test" 09:04:48 INFO - } 09:04:48 INFO - Found installer url https://queue.taskcluster.net/v1/task/CaF8lg2sSMWTIJP7hX9rwg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2. 09:04:48 INFO - Running post-action listener: _resource_record_post_action 09:04:48 INFO - ##### 09:04:48 INFO - ##### Running download-and-extract step. 09:04:48 INFO - ##### 09:04:48 INFO - Running pre-action listener: _resource_record_pre_action 09:04:48 INFO - Running main action method: download_and_extract 09:04:48 INFO - mkdir: /builds/slave/test/build/tests 09:04: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')]} 09:04:48 INFO - https://queue.taskcluster.net/v1/task/CaF8lg2sSMWTIJP7hX9rwg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 09:04:48 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CaF8lg2sSMWTIJP7hX9rwg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.test_packages.json 09:04:48 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CaF8lg2sSMWTIJP7hX9rwg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.test_packages.json 09:04:48 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CaF8lg2sSMWTIJP7hX9rwg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-47.0a1.en-US.linux-x86_64.test_packages.json 09:04:48 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CaF8lg2sSMWTIJP7hX9rwg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-47.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 09:04:49 INFO - Downloaded 1448 bytes. 09:04:49 INFO - Reading from file /builds/slave/test/build/firefox-47.0a1.en-US.linux-x86_64.test_packages.json 09:04:49 INFO - Using the following test package requirements: 09:04:49 INFO - {u'common': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 09:04:49 INFO - u'cppunittest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 09:04:49 INFO - u'firefox-47.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 09:04:49 INFO - u'gtest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 09:04:49 INFO - u'firefox-47.0a1.en-US.linux-x86_64.gtest.tests.zip'], 09:04:49 INFO - u'jittest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 09:04:49 INFO - u'jsshell-linux-x86_64.zip'], 09:04:49 INFO - u'mochitest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 09:04:49 INFO - u'firefox-47.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 09:04:49 INFO - u'mozbase': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 09:04:49 INFO - u'reftest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 09:04:49 INFO - u'firefox-47.0a1.en-US.linux-x86_64.reftest.tests.zip'], 09:04:49 INFO - u'talos': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 09:04:49 INFO - u'firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'], 09:04:49 INFO - u'web-platform': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 09:04:49 INFO - u'firefox-47.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 09:04:49 INFO - u'webapprt': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 09:04:49 INFO - u'xpcshell': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 09:04:49 INFO - u'firefox-47.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 09:04:49 INFO - Downloading packages: [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 09:04: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')]} 09:04:49 INFO - https://queue.taskcluster.net/v1/task/CaF8lg2sSMWTIJP7hX9rwg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 09:04:49 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CaF8lg2sSMWTIJP7hX9rwg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 09:04:49 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CaF8lg2sSMWTIJP7hX9rwg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 09:04:49 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CaF8lg2sSMWTIJP7hX9rwg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 09:04:49 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CaF8lg2sSMWTIJP7hX9rwg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 09:04:50 INFO - Downloaded 22092570 bytes. 09:04:50 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 09:04:50 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 09:04:51 INFO - Return code: 0 09:04:51 INFO - Downloading packages: [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 09:04:51 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')]} 09:04:51 INFO - https://queue.taskcluster.net/v1/task/CaF8lg2sSMWTIJP7hX9rwg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 09:04:51 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CaF8lg2sSMWTIJP7hX9rwg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 09:04:51 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CaF8lg2sSMWTIJP7hX9rwg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 09:04:51 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CaF8lg2sSMWTIJP7hX9rwg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 09:04:51 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CaF8lg2sSMWTIJP7hX9rwg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 09:04:52 INFO - Downloaded 22092570 bytes. 09:04:52 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 09:04:52 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 09:04:53 INFO - Return code: 0 09:04:53 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')]} 09:04:53 INFO - https://queue.taskcluster.net/v1/task/CaF8lg2sSMWTIJP7hX9rwg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 09:04:53 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CaF8lg2sSMWTIJP7hX9rwg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 09:04:53 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CaF8lg2sSMWTIJP7hX9rwg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 09:04:53 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CaF8lg2sSMWTIJP7hX9rwg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 09:04:53 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CaF8lg2sSMWTIJP7hX9rwg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 09:04:54 INFO - Downloaded 10845161 bytes. 09:04:54 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 09:04:54 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 09:04:54 INFO - Return code: 0 09:04:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:04:54 INFO - https://queue.taskcluster.net/v1/task/CaF8lg2sSMWTIJP7hX9rwg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 09:04:54 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CaF8lg2sSMWTIJP7hX9rwg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 09:04:54 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CaF8lg2sSMWTIJP7hX9rwg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 09:04:54 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CaF8lg2sSMWTIJP7hX9rwg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 09:04:54 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CaF8lg2sSMWTIJP7hX9rwg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 09:04:55 INFO - Downloaded 54409444 bytes. 09:04:55 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/CaF8lg2sSMWTIJP7hX9rwg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 09:04:55 INFO - mkdir: /builds/slave/test/properties 09:04:55 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 09:04:55 INFO - Writing to file /builds/slave/test/properties/build_url 09:04:55 INFO - Contents: 09:04:55 INFO - build_url:https://queue.taskcluster.net/v1/task/CaF8lg2sSMWTIJP7hX9rwg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 09:04:56 INFO - Running post-action listener: _resource_record_post_action 09:04:56 INFO - Running post-action listener: set_extra_try_arguments 09:04:56 INFO - ##### 09:04:56 INFO - ##### Running populate-webroot step. 09:04:56 INFO - ##### 09:04:56 INFO - Running pre-action listener: _resource_record_pre_action 09:04:56 INFO - Running main action method: populate_webroot 09:04:56 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 09:04:56 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 09:04:56 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 09:04:56 INFO - '--tppagecycles', 09:04:56 INFO - '7'], 09:04:56 INFO - 'tests': ['tsvgm']}}, 09:04:56 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 09:04:56 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 09:04:56 INFO - 'tests': ['tresize', 'tcanvasmark']}, 09:04:56 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 09:04:56 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 09:04:56 INFO - 'tests': ['dromaeo_css', 'kraken']}, 09:04:56 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:04:56 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 09:04:56 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:04:56 INFO - 'talos_options': ['--e10s'], 09:04:56 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 09:04:56 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:04:56 INFO - 'tests': ['damp', 'tps']}, 09:04:56 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:04:56 INFO - 'talos_options': ['--e10s'], 09:04:56 INFO - 'tests': ['damp', 'tps']}, 09:04:56 INFO - 'g3': {'tests': ['dromaeo_dom']}, 09:04:56 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 09:04:56 INFO - 'other': {'tests': ['a11yr', 09:04:56 INFO - 'ts_paint', 09:04:56 INFO - 'tpaint', 09:04:56 INFO - 'sessionrestore', 09:04:56 INFO - 'sessionrestore_no_auto_restore', 09:04:56 INFO - 'tabpaint']}, 09:04:56 INFO - 'other-e10s': {'talos_options': ['--e10s'], 09:04:56 INFO - 'tests': ['a11yr', 09:04:56 INFO - 'ts_paint', 09:04:56 INFO - 'tpaint', 09:04:56 INFO - 'sessionrestore', 09:04:56 INFO - 'sessionrestore_no_auto_restore', 09:04:56 INFO - 'tabpaint']}, 09:04:56 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 09:04:56 INFO - 'tests': ['a11yr', 09:04:56 INFO - 'ts_paint', 09:04:56 INFO - 'tpaint', 09:04:56 INFO - 'sessionrestore', 09:04:56 INFO - 'sessionrestore_no_auto_restore', 09:04:56 INFO - 'tabpaint']}, 09:04:56 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 09:04:56 INFO - 'tests': ['a11yr', 09:04:56 INFO - 'ts_paint', 09:04:56 INFO - 'tpaint', 09:04:56 INFO - 'sessionrestore', 09:04:56 INFO - 'sessionrestore_no_auto_restore', 09:04:56 INFO - 'tabpaint']}, 09:04:56 INFO - 'other_l64': {'tests': ['a11yr', 09:04:56 INFO - 'ts_paint', 09:04:56 INFO - 'tpaint', 09:04:56 INFO - 'sessionrestore', 09:04:56 INFO - 'sessionrestore_no_auto_restore', 09:04:56 INFO - 'tabpaint']}, 09:04:56 INFO - 'other_nol64': {'tests': ['a11yr', 09:04:56 INFO - 'ts_paint', 09:04:56 INFO - 'tpaint', 09:04:56 INFO - 'sessionrestore', 09:04:56 INFO - 'sessionrestore_no_auto_restore', 09:04:56 INFO - 'tabpaint']}, 09:04:56 INFO - 'svgr': {'tests': ['tsvgx', 09:04:56 INFO - 'tsvgr_opacity', 09:04:56 INFO - 'tart', 09:04:56 INFO - 'tscrollx', 09:04:56 INFO - 'cart']}, 09:04:56 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 09:04:56 INFO - 'tests': ['tsvgx', 09:04:56 INFO - 'tsvgr_opacity', 09:04:56 INFO - 'tart', 09:04:56 INFO - 'tscrollx', 09:04:56 INFO - 'cart']}, 09:04:56 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:04:56 INFO - 'tests': ['tp5o']}, 09:04:56 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:04:56 INFO - 'talos_options': ['--e10s'], 09:04:56 INFO - 'tests': ['tp5o']}, 09:04:56 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:04:56 INFO - 'talos_options': ['--xperf_path', 09:04:56 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 09:04:56 INFO - 'tests': ['tp5n']}, 09:04:56 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:04:56 INFO - 'talos_options': ['--e10s', 09:04:56 INFO - '--xperf_path', 09:04:56 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 09:04:56 INFO - 'tests': ['tp5n']}}, 09:04:56 INFO - 'talos.zip': {'path': '', 09:04:56 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 09:04:56 INFO - Running post-action listener: _resource_record_post_action 09:04:56 INFO - ##### 09:04:56 INFO - ##### Running create-virtualenv step. 09:04:56 INFO - ##### 09:04:56 INFO - Running pre-action listener: _resource_record_pre_action 09:04:56 INFO - Running main action method: create_virtualenv 09:04:56 INFO - Creating virtualenv /builds/slave/test/build/venv 09:04:56 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 09:04:56 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 09:04:56 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 09:04:56 INFO - Using real prefix '/usr' 09:04:56 INFO - New python executable in /builds/slave/test/build/venv/bin/python 09:04:57 INFO - Installing distribute.............................................................................................................................................................................................done. 09:04:59 INFO - Installing pip.................done. 09:04:59 INFO - Return code: 0 09:04:59 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 09:04:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:04:59 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:04:59 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:04:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:04:59 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:04:59 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:04:59 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 0x7f5f26cf1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22f38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23c0410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x244f160>, '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 0x2450060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24504f0>, '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': '1861a34ebfea852630dec091000001fa-1457370210.916850-397263336', '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 09:04:59 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 09:04:59 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 09:04:59 INFO - Using env: {'DISPLAY': ':0', 09:04:59 INFO - 'HOME': '/home/cltbld', 09:04:59 INFO - 'LANG': 'en_US.UTF-8', 09:04:59 INFO - 'LANGUAGE': 'en_US:en', 09:04:59 INFO - 'LOGNAME': 'cltbld', 09:04:59 INFO - 'MAIL': '/var/mail/cltbld', 09:04:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:04:59 INFO - 'MOZ_NO_REMOTE': '1', 09:04:59 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:04:59 INFO - 'NO_EM_RESTART': '1', 09:04:59 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:04:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:04:59 INFO - 'PWD': '/builds/slave/test', 09:04:59 INFO - 'SHELL': '/bin/bash', 09:04:59 INFO - 'SHLVL': '1', 09:04:59 INFO - 'TERM': 'linux', 09:04:59 INFO - 'TMOUT': '86400', 09:04:59 INFO - 'USER': 'cltbld', 09:04:59 INFO - 'XDG_SESSION_COOKIE': '1861a34ebfea852630dec091000001fa-1457370210.916850-397263336', 09:04:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:04:59 INFO - '_': '/tools/buildbot/bin/python'} 09:04:59 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:04:59 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 09:04:59 INFO - Cleaning up... 09:04:59 INFO - Return code: 0 09:04:59 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 09:04:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:04:59 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:04:59 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:04:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:04:59 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:04:59 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:04:59 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f5f26cf1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22f38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23c0410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x244f160>, '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 0x2450060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24504f0>, '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': '1861a34ebfea852630dec091000001fa-1457370210.916850-397263336', '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 09:04:59 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test/build 09:04:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 09:04:59 INFO - Using env: {'DISPLAY': ':0', 09:04:59 INFO - 'HOME': '/home/cltbld', 09:04:59 INFO - 'LANG': 'en_US.UTF-8', 09:04:59 INFO - 'LANGUAGE': 'en_US:en', 09:04:59 INFO - 'LOGNAME': 'cltbld', 09:04:59 INFO - 'MAIL': '/var/mail/cltbld', 09:04:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:04:59 INFO - 'MOZ_NO_REMOTE': '1', 09:04:59 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:04:59 INFO - 'NO_EM_RESTART': '1', 09:04:59 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:04:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:04:59 INFO - 'PWD': '/builds/slave/test', 09:04:59 INFO - 'SHELL': '/bin/bash', 09:04:59 INFO - 'SHLVL': '1', 09:04:59 INFO - 'TERM': 'linux', 09:04:59 INFO - 'TMOUT': '86400', 09:04:59 INFO - 'USER': 'cltbld', 09:04:59 INFO - 'XDG_SESSION_COOKIE': '1861a34ebfea852630dec091000001fa-1457370210.916850-397263336', 09:04:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:04:59 INFO - '_': '/tools/buildbot/bin/python'} 09:04:59 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:04:59 INFO - Downloading/unpacking psutil>=0.7.1 09:04:59 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 09:04:59 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 09:04:59 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 09:04:59 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 09:04:59 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 09:04:59 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 09:05:01 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 09:05:01 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 09:05:01 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 09:05:01 INFO - Installing collected packages: psutil 09:05:01 INFO - Running setup.py install for psutil 09:05:01 INFO - building 'psutil._psutil_linux' extension 09:05:01 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 09:05:01 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 09:05:01 INFO - building 'psutil._psutil_posix' extension 09:05:01 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 09:05:02 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 09:05:02 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 09:05:02 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 09:05:02 INFO - Successfully installed psutil 09:05:02 INFO - Cleaning up... 09:05:02 INFO - Return code: 0 09:05:02 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 09:05: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')]} 09:05:02 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:05:02 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:05: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')]} 09:05:02 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:05:02 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:05:02 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f5f26cf1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22f38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23c0410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x244f160>, '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 0x2450060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24504f0>, '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': '1861a34ebfea852630dec091000001fa-1457370210.916850-397263336', '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 09:05:02 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test/build 09:05:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 09:05:02 INFO - Using env: {'DISPLAY': ':0', 09:05:02 INFO - 'HOME': '/home/cltbld', 09:05:02 INFO - 'LANG': 'en_US.UTF-8', 09:05:02 INFO - 'LANGUAGE': 'en_US:en', 09:05:02 INFO - 'LOGNAME': 'cltbld', 09:05:02 INFO - 'MAIL': '/var/mail/cltbld', 09:05:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:05:02 INFO - 'MOZ_NO_REMOTE': '1', 09:05:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:05:02 INFO - 'NO_EM_RESTART': '1', 09:05:02 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:05:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:05:02 INFO - 'PWD': '/builds/slave/test', 09:05:02 INFO - 'SHELL': '/bin/bash', 09:05:02 INFO - 'SHLVL': '1', 09:05:02 INFO - 'TERM': 'linux', 09:05:02 INFO - 'TMOUT': '86400', 09:05:02 INFO - 'USER': 'cltbld', 09:05:02 INFO - 'XDG_SESSION_COOKIE': '1861a34ebfea852630dec091000001fa-1457370210.916850-397263336', 09:05:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:05:02 INFO - '_': '/tools/buildbot/bin/python'} 09:05:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:05:02 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 09:05:02 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:05:02 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:05:02 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:05:02 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:05:02 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:05:02 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:05:04 INFO - Downloading mozsystemmonitor-0.0.tar.gz 09:05:04 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 09:05:04 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 09:05:04 INFO - Installing collected packages: mozsystemmonitor 09:05:04 INFO - Running setup.py install for mozsystemmonitor 09:05:04 INFO - Successfully installed mozsystemmonitor 09:05:04 INFO - Cleaning up... 09:05:04 INFO - Return code: 0 09:05:04 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 09:05:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:05:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:05:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:05:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:05:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:05:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:05:04 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 0x7f5f26cf1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22f38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23c0410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x244f160>, '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 0x2450060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24504f0>, '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': '1861a34ebfea852630dec091000001fa-1457370210.916850-397263336', '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 09:05:04 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 09:05:04 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 09:05:04 INFO - Using env: {'DISPLAY': ':0', 09:05:04 INFO - 'HOME': '/home/cltbld', 09:05:04 INFO - 'LANG': 'en_US.UTF-8', 09:05:04 INFO - 'LANGUAGE': 'en_US:en', 09:05:04 INFO - 'LOGNAME': 'cltbld', 09:05:04 INFO - 'MAIL': '/var/mail/cltbld', 09:05:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:05:04 INFO - 'MOZ_NO_REMOTE': '1', 09:05:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:05:04 INFO - 'NO_EM_RESTART': '1', 09:05:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:05:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:05:04 INFO - 'PWD': '/builds/slave/test', 09:05:04 INFO - 'SHELL': '/bin/bash', 09:05:04 INFO - 'SHLVL': '1', 09:05:04 INFO - 'TERM': 'linux', 09:05:04 INFO - 'TMOUT': '86400', 09:05:04 INFO - 'USER': 'cltbld', 09:05:04 INFO - 'XDG_SESSION_COOKIE': '1861a34ebfea852630dec091000001fa-1457370210.916850-397263336', 09:05:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:05:04 INFO - '_': '/tools/buildbot/bin/python'} 09:05:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:05:04 INFO - Downloading/unpacking blobuploader==1.2.4 09:05:04 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 09:05:04 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 09:05:04 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 09:05:04 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 09:05:04 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 09:05:04 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 09:05:06 INFO - Downloading blobuploader-1.2.4.tar.gz 09:05:06 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 09:05:06 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 09:05:06 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 09:05:06 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 09:05:06 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 09:05:06 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 09:05:06 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 09:05:06 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 09:05:06 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 09:05:06 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 09:05:06 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 09:05:06 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 09:05:06 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 09:05:06 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 09:05:06 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 09:05:06 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 09:05:07 INFO - Downloading docopt-0.6.1.tar.gz 09:05:07 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 09:05:07 INFO - Installing collected packages: blobuploader, requests, docopt 09:05:07 INFO - Running setup.py install for blobuploader 09:05:07 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 09:05:07 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 09:05:07 INFO - Running setup.py install for requests 09:05:07 INFO - Running setup.py install for docopt 09:05:07 INFO - Successfully installed blobuploader requests docopt 09:05:07 INFO - Cleaning up... 09:05:07 INFO - Return code: 0 09:05:07 INFO - Installing None into virtualenv /builds/slave/test/build/venv 09:05:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:05:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:05:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:05:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:05:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:05:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:05:07 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 0x7f5f26cf1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22f38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23c0410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x244f160>, '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 0x2450060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24504f0>, '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': '1861a34ebfea852630dec091000001fa-1457370210.916850-397263336', '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 09:05:07 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 09:05:07 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 09:05:07 INFO - Using env: {'DISPLAY': ':0', 09:05:07 INFO - 'HOME': '/home/cltbld', 09:05:07 INFO - 'LANG': 'en_US.UTF-8', 09:05:07 INFO - 'LANGUAGE': 'en_US:en', 09:05:07 INFO - 'LOGNAME': 'cltbld', 09:05:07 INFO - 'MAIL': '/var/mail/cltbld', 09:05:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:05:07 INFO - 'MOZ_NO_REMOTE': '1', 09:05:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:05:07 INFO - 'NO_EM_RESTART': '1', 09:05:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:05:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:05:07 INFO - 'PWD': '/builds/slave/test', 09:05:07 INFO - 'SHELL': '/bin/bash', 09:05:07 INFO - 'SHLVL': '1', 09:05:07 INFO - 'TERM': 'linux', 09:05:07 INFO - 'TMOUT': '86400', 09:05:07 INFO - 'USER': 'cltbld', 09:05:07 INFO - 'XDG_SESSION_COOKIE': '1861a34ebfea852630dec091000001fa-1457370210.916850-397263336', 09:05:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:05:07 INFO - '_': '/tools/buildbot/bin/python'} 09:05:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:05:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 09:05:08 INFO - Running setup.py (path:/tmp/pip-rShhjT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 09:05:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 09:05:08 INFO - Running setup.py (path:/tmp/pip-W_08eD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 09:05:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 09:05:08 INFO - Running setup.py (path:/tmp/pip-FGo4hL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 09:05:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 09:05:08 INFO - Running setup.py (path:/tmp/pip-HL6os3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 09:05:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 09:05:08 INFO - Running setup.py (path:/tmp/pip-pkrBse-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 09:05:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 09:05:08 INFO - Running setup.py (path:/tmp/pip-Urz8_u-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 09:05:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 09:05:08 INFO - Running setup.py (path:/tmp/pip-sqny4t-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 09:05:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 09:05:08 INFO - Running setup.py (path:/tmp/pip-nObw90-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 09:05:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 09:05:08 INFO - Running setup.py (path:/tmp/pip-OmzHAZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 09:05:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 09:05:08 INFO - Running setup.py (path:/tmp/pip-649e_G-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 09:05:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 09:05:08 INFO - Running setup.py (path:/tmp/pip-bI7sqU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 09:05:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 09:05:08 INFO - Running setup.py (path:/tmp/pip-bwtXaC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 09:05:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 09:05:08 INFO - Running setup.py (path:/tmp/pip-yibvmr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 09:05:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 09:05:08 INFO - Running setup.py (path:/tmp/pip-68s2Eb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 09:05:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 09:05:09 INFO - Running setup.py (path:/tmp/pip-5NYgJ5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 09:05:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 09:05:09 INFO - Running setup.py (path:/tmp/pip-STf66N-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 09:05:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 09:05:09 INFO - Running setup.py (path:/tmp/pip-76vp1J-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 09:05:09 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 09:05:09 INFO - Running setup.py install for manifestparser 09:05:09 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 09:05:09 INFO - Running setup.py install for mozcrash 09:05:09 INFO - Running setup.py install for mozdebug 09:05:09 INFO - Running setup.py install for mozdevice 09:05:09 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 09:05:09 INFO - Installing dm script to /builds/slave/test/build/venv/bin 09:05:09 INFO - Running setup.py install for mozfile 09:05:09 INFO - Running setup.py install for mozhttpd 09:05:09 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 09:05:09 INFO - Running setup.py install for mozinfo 09:05:09 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 09:05:09 INFO - Running setup.py install for mozInstall 09:05:10 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 09:05:10 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 09:05:10 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 09:05:10 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 09:05:10 INFO - Running setup.py install for mozleak 09:05:10 INFO - Running setup.py install for mozlog 09:05:10 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 09:05:10 INFO - Running setup.py install for moznetwork 09:05:10 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 09:05:10 INFO - Running setup.py install for mozprocess 09:05:10 INFO - Running setup.py install for mozprofile 09:05:10 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 09:05:10 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 09:05:10 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 09:05:10 INFO - Running setup.py install for mozrunner 09:05:10 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 09:05:10 INFO - Running setup.py install for mozscreenshot 09:05:10 INFO - Running setup.py install for moztest 09:05:10 INFO - Running setup.py install for mozversion 09:05:10 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 09:05:11 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 09:05:11 INFO - Cleaning up... 09:05:11 INFO - Return code: 0 09:05:11 INFO - Installing None into virtualenv /builds/slave/test/build/venv 09:05:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:05:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:05:11 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:05:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:05:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:05:11 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:05:11 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 0x7f5f26cf1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22f38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23c0410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x244f160>, '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 0x2450060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24504f0>, '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': '1861a34ebfea852630dec091000001fa-1457370210.916850-397263336', '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 09:05:11 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 09:05:11 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 09:05:11 INFO - Using env: {'DISPLAY': ':0', 09:05:11 INFO - 'HOME': '/home/cltbld', 09:05:11 INFO - 'LANG': 'en_US.UTF-8', 09:05:11 INFO - 'LANGUAGE': 'en_US:en', 09:05:11 INFO - 'LOGNAME': 'cltbld', 09:05:11 INFO - 'MAIL': '/var/mail/cltbld', 09:05:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:05:11 INFO - 'MOZ_NO_REMOTE': '1', 09:05:11 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:05:11 INFO - 'NO_EM_RESTART': '1', 09:05:11 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:05:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:05:11 INFO - 'PWD': '/builds/slave/test', 09:05:11 INFO - 'SHELL': '/bin/bash', 09:05:11 INFO - 'SHLVL': '1', 09:05:11 INFO - 'TERM': 'linux', 09:05:11 INFO - 'TMOUT': '86400', 09:05:11 INFO - 'USER': 'cltbld', 09:05:11 INFO - 'XDG_SESSION_COOKIE': '1861a34ebfea852630dec091000001fa-1457370210.916850-397263336', 09:05:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:05:11 INFO - '_': '/tools/buildbot/bin/python'} 09:05:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:05:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 09:05:11 INFO - Running setup.py (path:/tmp/pip-urapFy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 09:05:11 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)) 09:05:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 09:05:11 INFO - Running setup.py (path:/tmp/pip-UgiunT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 09:05:11 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)) 09:05:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 09:05:11 INFO - Running setup.py (path:/tmp/pip-24mfl1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 09:05:11 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)) 09:05:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 09:05:11 INFO - Running setup.py (path:/tmp/pip-0HnDRT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 09:05:11 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)) 09:05:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 09:05:11 INFO - Running setup.py (path:/tmp/pip-cttrjz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 09:05:11 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)) 09:05:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 09:05:11 INFO - Running setup.py (path:/tmp/pip-UEvAsq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 09:05:11 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)) 09:05:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 09:05:11 INFO - Running setup.py (path:/tmp/pip-jD80ic-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 09:05:11 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)) 09:05:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 09:05:11 INFO - Running setup.py (path:/tmp/pip-glkXeL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 09:05:11 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)) 09:05:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 09:05:11 INFO - Running setup.py (path:/tmp/pip-on9F4Q-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 09:05:11 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)) 09:05:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 09:05:11 INFO - Running setup.py (path:/tmp/pip-3n9Xbh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 09:05:11 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.1 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 09:05:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 09:05:11 INFO - Running setup.py (path:/tmp/pip-9H1zpf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 09:05:12 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)) 09:05:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 09:05:12 INFO - Running setup.py (path:/tmp/pip-2zGyCL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 09:05:12 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)) 09:05:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 09:05:12 INFO - Running setup.py (path:/tmp/pip-qw5i8S-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 09:05:12 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)) 09:05:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 09:05:12 INFO - Running setup.py (path:/tmp/pip-XrjsSL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 09:05:12 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)) 09:05:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 09:05:12 INFO - Running setup.py (path:/tmp/pip-sNcWey-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 09:05:12 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)) 09:05:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 09:05:12 INFO - Running setup.py (path:/tmp/pip-0hsnMD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 09:05:12 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)) 09:05:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 09:05:12 INFO - Running setup.py (path:/tmp/pip-YXg7O0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 09:05:12 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)) 09:05:12 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)) 09:05:12 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)) 09:05:12 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)) 09:05:12 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)) 09:05:12 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)) 09:05:12 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 09:05:12 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 09:05:12 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 09:05:12 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 09:05:12 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 09:05:12 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 09:05:12 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 09:05:14 INFO - Downloading blessings-1.6.tar.gz 09:05:14 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 09:05:14 INFO - Installing collected packages: blessings 09:05:14 INFO - Running setup.py install for blessings 09:05:14 INFO - Successfully installed blessings 09:05:14 INFO - Cleaning up... 09:05:14 INFO - Return code: 0 09:05:14 INFO - Done creating virtualenv /builds/slave/test/build/venv. 09:05:14 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 09:05:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 09:05:14 INFO - Reading from file tmpfile_stdout 09:05:14 INFO - Current package versions: 09:05:14 INFO - argparse == 1.2.1 09:05:14 INFO - blessings == 1.6 09:05:14 INFO - blobuploader == 1.2.4 09:05:14 INFO - docopt == 0.6.1 09:05:14 INFO - manifestparser == 1.1 09:05:14 INFO - mozInstall == 1.12 09:05:14 INFO - mozcrash == 0.17 09:05:14 INFO - mozdebug == 0.1 09:05:14 INFO - mozdevice == 0.48 09:05:14 INFO - mozfile == 1.2 09:05:14 INFO - mozhttpd == 0.7 09:05:14 INFO - mozinfo == 0.9 09:05:14 INFO - mozleak == 0.1 09:05:14 INFO - mozlog == 3.1 09:05:14 INFO - moznetwork == 0.27 09:05:14 INFO - mozprocess == 0.22 09:05:14 INFO - mozprofile == 0.28 09:05:14 INFO - mozrunner == 6.11 09:05:14 INFO - mozscreenshot == 0.1 09:05:14 INFO - mozsystemmonitor == 0.0 09:05:14 INFO - moztest == 0.7 09:05:14 INFO - mozversion == 1.4 09:05:14 INFO - psutil == 3.1.1 09:05:14 INFO - requests == 1.2.3 09:05:14 INFO - wsgiref == 0.1.2 09:05:14 INFO - Installing None into virtualenv /builds/slave/test/build/venv 09:05: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')]} 09:05:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:05:14 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:05: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')]} 09:05:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:05:14 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:05:14 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 0x7f5f26cf1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22f38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23c0410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x244f160>, '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 0x2450060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24504f0>, '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': '1861a34ebfea852630dec091000001fa-1457370210.916850-397263336', '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 09:05:14 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 09:05:14 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 09:05:14 INFO - Using env: {'DISPLAY': ':0', 09:05:14 INFO - 'HOME': '/home/cltbld', 09:05:14 INFO - 'LANG': 'en_US.UTF-8', 09:05:14 INFO - 'LANGUAGE': 'en_US:en', 09:05:14 INFO - 'LOGNAME': 'cltbld', 09:05:14 INFO - 'MAIL': '/var/mail/cltbld', 09:05:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:05:14 INFO - 'MOZ_NO_REMOTE': '1', 09:05:14 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:05:14 INFO - 'NO_EM_RESTART': '1', 09:05:14 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:05:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:05:14 INFO - 'PWD': '/builds/slave/test', 09:05:14 INFO - 'SHELL': '/bin/bash', 09:05:14 INFO - 'SHLVL': '1', 09:05:14 INFO - 'TERM': 'linux', 09:05:14 INFO - 'TMOUT': '86400', 09:05:14 INFO - 'USER': 'cltbld', 09:05:14 INFO - 'XDG_SESSION_COOKIE': '1861a34ebfea852630dec091000001fa-1457370210.916850-397263336', 09:05:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:05:14 INFO - '_': '/tools/buildbot/bin/python'} 09:05:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:05:14 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)) 09:05:14 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)) 09:05:14 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)) 09:05:14 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)) 09:05:14 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)) 09:05:14 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)) 09:05:14 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)) 09:05:14 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)) 09:05:14 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)) 09:05:14 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)) 09:05:14 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)) 09:05:14 INFO - Cleaning up... 09:05:14 INFO - Return code: 0 09:05:14 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 09:05: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')]} 09:05:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:05:14 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:05: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')]} 09:05:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:05:14 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:05: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', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f5f26cf1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22f38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23c0410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x244f160>, '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 0x2450060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24504f0>, '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': '1861a34ebfea852630dec091000001fa-1457370210.916850-397263336', '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 09:05: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', 'jsonschema'] in /builds/slave/test/build 09:05: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 jsonschema 09:05:14 INFO - Using env: {'DISPLAY': ':0', 09:05:14 INFO - 'HOME': '/home/cltbld', 09:05:14 INFO - 'LANG': 'en_US.UTF-8', 09:05:14 INFO - 'LANGUAGE': 'en_US:en', 09:05:14 INFO - 'LOGNAME': 'cltbld', 09:05:14 INFO - 'MAIL': '/var/mail/cltbld', 09:05:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:05:14 INFO - 'MOZ_NO_REMOTE': '1', 09:05:14 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:05:14 INFO - 'NO_EM_RESTART': '1', 09:05:14 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:05:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:05:14 INFO - 'PWD': '/builds/slave/test', 09:05:14 INFO - 'SHELL': '/bin/bash', 09:05:14 INFO - 'SHLVL': '1', 09:05:14 INFO - 'TERM': 'linux', 09:05:14 INFO - 'TMOUT': '86400', 09:05:14 INFO - 'USER': 'cltbld', 09:05:14 INFO - 'XDG_SESSION_COOKIE': '1861a34ebfea852630dec091000001fa-1457370210.916850-397263336', 09:05:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:05:14 INFO - '_': '/tools/buildbot/bin/python'} 09:05:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:05:15 INFO - Downloading/unpacking jsonschema 09:05:15 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 09:05:15 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 09:05:15 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 09:05:15 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 09:05:15 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 09:05:15 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 09:05:17 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 09:05:17 INFO - Downloading/unpacking functools32 (from jsonschema) 09:05:17 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 09:05:17 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 09:05:17 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 09:05:17 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 09:05:17 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 09:05:17 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 09:05:17 INFO - Downloading functools32-3.2.3-2.tar.gz 09:05:17 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 09:05:17 INFO - warning: no files found matching '*.txt' 09:05:17 INFO - no previously-included directories found matching 'build' 09:05:17 INFO - no previously-included directories found matching 'dist' 09:05:17 INFO - no previously-included directories found matching '.git*' 09:05:17 INFO - Installing collected packages: jsonschema, functools32 09:05:17 INFO - Running setup.py install for functools32 09:05:17 INFO - warning: no files found matching '*.txt' 09:05:17 INFO - no previously-included directories found matching 'build' 09:05:17 INFO - no previously-included directories found matching 'dist' 09:05:17 INFO - no previously-included directories found matching '.git*' 09:05:17 INFO - Successfully installed jsonschema functools32 09:05:17 INFO - Cleaning up... 09:05:17 INFO - Return code: 0 09:05:17 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 09:05:17 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')]} 09:05:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:05:17 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:05:17 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')]} 09:05:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:05:17 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:05:17 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 0x7f5f26cf1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22f38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23c0410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x244f160>, '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 0x2450060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24504f0>, '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': '1861a34ebfea852630dec091000001fa-1457370210.916850-397263336', '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 09:05:17 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 09:05:17 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 09:05:17 INFO - Using env: {'DISPLAY': ':0', 09:05:17 INFO - 'HOME': '/home/cltbld', 09:05:17 INFO - 'LANG': 'en_US.UTF-8', 09:05:17 INFO - 'LANGUAGE': 'en_US:en', 09:05:17 INFO - 'LOGNAME': 'cltbld', 09:05:17 INFO - 'MAIL': '/var/mail/cltbld', 09:05:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:05:17 INFO - 'MOZ_NO_REMOTE': '1', 09:05:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:05:17 INFO - 'NO_EM_RESTART': '1', 09:05:17 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:05:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:05:17 INFO - 'PWD': '/builds/slave/test', 09:05:17 INFO - 'SHELL': '/bin/bash', 09:05:17 INFO - 'SHLVL': '1', 09:05:17 INFO - 'TERM': 'linux', 09:05:17 INFO - 'TMOUT': '86400', 09:05:17 INFO - 'USER': 'cltbld', 09:05:17 INFO - 'XDG_SESSION_COOKIE': '1861a34ebfea852630dec091000001fa-1457370210.916850-397263336', 09:05:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:05:17 INFO - '_': '/tools/buildbot/bin/python'} 09:05:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:05:17 INFO - Downloading/unpacking flake8 09:05:17 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 09:05:17 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 09:05:17 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 09:05:17 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 09:05:17 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 09:05:17 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 09:05:19 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 09:05:19 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 09:05: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 09:05: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 09:05: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 09:05: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 09:05: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 09:05: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 09:05:19 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 09:05:19 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 09:05: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 09:05: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 09:05: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 09:05: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 09:05: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 09:05: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 09:05:19 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 09:05: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 09:05: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 09:05: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 09:05: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 09:05: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 09:05: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 09:05:20 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 09:05:20 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 09:05:20 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 09:05:20 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 09:05:20 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 09:05:20 INFO - no previously-included directories found matching 'docs/_build' 09:05:20 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 09:05:20 INFO - Running setup.py install for pep8 09:05:20 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 09:05:20 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 09:05:20 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 09:05:20 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 09:05:20 INFO - no previously-included directories found matching 'docs/_build' 09:05:20 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 09:05:20 INFO - Successfully installed flake8 mccabe pyflakes pep8 09:05:20 INFO - Cleaning up... 09:05:20 INFO - Return code: 0 09:05:20 INFO - Running post-action listener: _resource_record_post_action 09:05:20 INFO - Running post-action listener: _start_resource_monitoring 09:05:20 INFO - Starting resource monitoring. 09:05:20 INFO - ##### 09:05:20 INFO - ##### Running install step. 09:05:20 INFO - ##### 09:05:20 INFO - Running pre-action listener: _resource_record_pre_action 09:05:20 INFO - Running main action method: install 09:05:20 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 09:05:20 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 09:05:20 INFO - Reading from file tmpfile_stdout 09:05:20 INFO - Detecting whether we're running mozinstall >=1.0... 09:05:20 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 09:05:20 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 09:05:20 INFO - Reading from file tmpfile_stdout 09:05:20 INFO - Output received: 09:05:20 INFO - Usage: mozinstall [options] installer 09:05:20 INFO - Options: 09:05:20 INFO - -h, --help show this help message and exit 09:05:20 INFO - -d DEST, --destination=DEST 09:05:20 INFO - Directory to install application into. [default: 09:05:20 INFO - "/builds/slave/test"] 09:05:20 INFO - --app=APP Application being installed. [default: firefox] 09:05:20 INFO - mkdir: /builds/slave/test/build/application 09:05:20 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 09:05:20 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 09:05:36 INFO - Reading from file tmpfile_stdout 09:05:36 INFO - Output received: 09:05:36 INFO - /builds/slave/test/build/application/firefox/firefox 09:05:36 INFO - Running post-action listener: _resource_record_post_action 09:05:36 INFO - ##### 09:05:36 INFO - ##### Running run-tests step. 09:05:36 INFO - ##### 09:05:36 INFO - Running pre-action listener: _resource_record_pre_action 09:05:36 INFO - Running main action method: run_tests 09:05:36 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 09:05:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 09:05:36 INFO - Python 2.7.3 09:05:36 INFO - Return code: 0 09:05:36 INFO - grabbing minidump binary from tooltool 09:05:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:05:36 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x244f160>, '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 0x2450060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24504f0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 09:05:36 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 09:05:36 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 09:05:36 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 09:05:36 INFO - Return code: 0 09:05:36 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 09:05:36 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 09:05:36 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 09:05:36 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 09:05:36 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 09:05:36 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 09:05:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 09:05:37 INFO - Return code: 0 09:05:37 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/CaF8lg2sSMWTIJP7hX9rwg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-069', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 09:05:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team-Non-PGO --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/CaF8lg2sSMWTIJP7hX9rwg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-069 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 09:05:37 INFO - Using env: {'DISPLAY': ':0', 09:05:37 INFO - 'HOME': '/home/cltbld', 09:05:37 INFO - 'LANG': 'en_US.UTF-8', 09:05:37 INFO - 'LANGUAGE': 'en_US:en', 09:05:37 INFO - 'LOGNAME': 'cltbld', 09:05:37 INFO - 'MAIL': '/var/mail/cltbld', 09:05:37 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 09:05:37 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 09:05:37 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:05:37 INFO - 'MOZ_NO_REMOTE': '1', 09:05:37 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 09:05:37 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:05:37 INFO - 'NO_EM_RESTART': '1', 09:05:37 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:05:37 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:05:37 INFO - 'PWD': '/builds/slave/test', 09:05:37 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 09:05:37 INFO - 'SHELL': '/bin/bash', 09:05:37 INFO - 'SHLVL': '1', 09:05:37 INFO - 'TERM': 'linux', 09:05:37 INFO - 'TMOUT': '86400', 09:05:37 INFO - 'USER': 'cltbld', 09:05:37 INFO - 'XDG_SESSION_COOKIE': '1861a34ebfea852630dec091000001fa-1457370210.916850-397263336', 09:05:37 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:05:37 INFO - '_': '/tools/buildbot/bin/python'} 09:05:37 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/CaF8lg2sSMWTIJP7hX9rwg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-069', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 09:05:37 INFO - mozversion application_buildid: 20160307084327 09:05:37 INFO - mozversion application_changeset: 9a42fa7fb4ab6da62b1df606e122642d73fb6556 09:05:37 INFO - mozversion application_display_name: Nightly 09:05:37 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 09:05:37 INFO - mozversion application_name: Firefox 09:05:37 INFO - mozversion application_remotingname: firefox 09:05:37 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 09:05:37 INFO - mozversion application_vendor: Mozilla 09:05:37 INFO - mozversion application_version: 47.0a1 09:05:37 INFO - mozversion platform_buildid: 20160307084327 09:05:37 INFO - mozversion platform_changeset: 9a42fa7fb4ab6da62b1df606e122642d73fb6556 09:05:37 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 09:05:37 INFO - mozversion platform_version: 47.0a1 09:05:37 INFO - using testdate: 1457370337 09:05:37 INFO - actual date: 1457370337 09:05:37 INFO - starting webserver on 'localhost:43343' 09:05:37 INFO - SUITE-START | Running 2 tests 09:05:37 INFO - TEST-START | dromaeo_css 09:05:37 INFO - operating with platform_type : linux_ 09:05:37 INFO - Initialising browser for dromaeo_css test... 09:05:37 INFO - TEST-INFO | started process 22672 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp5DINzr/profile http://localhost:43343/getInfo.html) 09:05:42 INFO - PROCESS | 22672 | __metrics Screen width/height:1600/1200 09:05:42 INFO - PROCESS | 22672 | colorDepth:24 09:05:42 INFO - PROCESS | 22672 | Browser inner width/height: 1024/697 09:05:42 INFO - PROCESS | 22672 | __metrics 09:05:43 INFO - PROCESS | 22672 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 09:05:43 INFO - PROCESS | 22672 | JavaScript error: resource://gre/modules/IndexedDBHelper.jsm, line 138: UnknownError: The operation failed for reasons unrelated to the database itself and not covered by any other error code. 09:05:44 INFO - TEST-INFO | 22672: exit 0 09:05:44 INFO - Browser initialized. 09:05:44 INFO - Running cycle 1/1 for dromaeo_css test... 09:05:44 INFO - TEST-INFO | started process 22769 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp5DINzr/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 09:05:56 INFO - PROCESS | 22769 | RSS: Main: 157065216 09:05:56 INFO - PROCESS | 22769 | 09:06:48 INFO - PROCESS | 22769 | 1457370408071 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] 09:08:59 INFO - PROCESS | 22769 | Cycle 1(1): loaded http://localhost:43343/tests/dromaeo/cssquery-dojo.html (next: http://localhost:43343/tests/dromaeo/cssquery-ext.html) 09:09:00 INFO - PROCESS | 22769 | RSS: Main: 243748864 09:09:00 INFO - PROCESS | 22769 | 09:12:02 INFO - PROCESS | 22769 | Cycle 1(1): loaded http://localhost:43343/tests/dromaeo/cssquery-ext.html (next: http://localhost:43343/tests/dromaeo/cssquery-jquery.html) 09:12:03 INFO - PROCESS | 22769 | RSS: Main: 235560960 09:12:03 INFO - PROCESS | 22769 | 09:15:05 INFO - PROCESS | 22769 | Cycle 1(1): loaded http://localhost:43343/tests/dromaeo/cssquery-jquery.html (next: http://localhost:43343/tests/dromaeo/cssquery-mootools.html) 09:15:05 INFO - PROCESS | 22769 | RSS: Main: 233705472 09:15:05 INFO - PROCESS | 22769 | 09:18:07 INFO - PROCESS | 22769 | Cycle 1(1): loaded http://localhost:43343/tests/dromaeo/cssquery-mootools.html (next: http://localhost:43343/tests/dromaeo/cssquery-prototype.html) 09:18:08 INFO - PROCESS | 22769 | RSS: Main: 216113152 09:18:08 INFO - PROCESS | 22769 | 09:21:11 INFO - PROCESS | 22769 | Cycle 1(1): loaded http://localhost:43343/tests/dromaeo/cssquery-prototype.html (next: http://localhost:43343/tests/dromaeo/cssquery-yui.html) 09:21:11 INFO - PROCESS | 22769 | RSS: Main: 200212480 09:21:11 INFO - PROCESS | 22769 | 09:24:14 INFO - PROCESS | 22769 | Cycle 1(1): loaded http://localhost:43343/tests/dromaeo/cssquery-yui.html (next: http://localhost:43343/tests/dromaeo/cssquery-dojo.html) 09:24:14 INFO - PROCESS | 22769 | RSS: Main: 320049152 09:24:14 INFO - PROCESS | 22769 | 09:24:14 INFO - PROCESS | 22769 | __start_tp_report 09:24:14 INFO - PROCESS | 22769 | _x_x_mozilla_page_load 09:24:14 INFO - PROCESS | 22769 | _x_x_mozilla_page_load_details 09:24:14 INFO - PROCESS | 22769 | |i|pagename|runs| 09:24:14 INFO - PROCESS | 22769 | |0;dojo.html;2557.2414480404614;2630.4213073123906;2639.181853625375;2649.3773963118665;2670.6261123442714;4400.97799511002;4466.6426685865135;4469.821207151714;4483.34991426243;4493.842715504954;4513.119941611387;4520.186366454037;4559.88600284993;4561.635069194456;4617.930731039037;4093.5292441369324;4150.771707556083;4171.332586786115;4200.306949353353;4209;4144.6684265258855;4216.620504154625;4226.239276930151;4235.258829704805;4274.7862606869685;4025.617566331179;4127.195196936598;4177.49870015597;4195.55946625603;4198.265303571863;4091.5499295077516;4094.447249621293;4101.323281658522;4126.319157339036;4136.21411931732;3955.7033222508426;4028.3353246714255;4057.756534607933;4059.776712280823;4096.1193343431305;4343.609075183249;4407.559244075599;4451.866444006685;4464.531224221442;4496.100779844044;4834.903301933941;4842.709437433765;4844.467108618049;4846.079244943449;4864.902701945941;4657.60410365116;4849.709017458964;4866.732329721864;4868.537488938545;4904.705717656916;4508.07584445188;4510.0979804039325;4514.7291162530355;4539.500654927955;4544.15933052383;4929.137400954819;4949.554540091337;4949.925751113664;4950.3069570260195;4994.101061808837;4601.493835678073;4745.549172828576;4768.9523104769205;4785.3300537924715;4847.5394837491085;4826.276058591239;4839.7096174229655;4846.61227101831;4869.63477739171;4890.731009794425;4786.521347865255;4786.856394308176;4790.712557246577;4792.137415265216;4841.95158048422;4600.148972440109;4729.125111854318;4758.547937945889;4812.687175333592;4813.205821039559;4016.578259282792;4021.3364794809113;4022.215667944781;4022.8390864365097;4041.515018197835;3554.9466757998653;3556.5020897074432;3578.874739384109;3591.6049234584175;3607.3506768781344;4094.3449048152747;4155.148194620096;4176.352665336878;4221.261279276115;4229.154169166179;4754.9286760698615;4793.041391721669;4796.352492413549;4797.472278049412;4837.201861692852;4134.524529679125;4135.731177473454;4137.2552940471005;4177.081042170717;4188.141431006637;4176.9582304176565;4239.851605193803;4289.1207302503535;4290.034742182984;4330.025744207591;4608.147492713859;4616.192166370939;4630.259158534618;4630.4443466784205;4677.695949763254;4652.511486293891;4837.733924634038;4838.250071238964;4842.104210721028;4867.902641947212;4606.124836281096;4650;4651.5813576778255;4671.346011558317;4697.506761789963;4758.4765675776325;4770;4770.642201834946;4777.761111944458;4791.257355109963;4714.858554243378;4831;4832.637552183671;4844.563989240985;4876.683015603974;4692.436907571113;4713.410823647044;4714.104320179292;4714.646401519831;4754.500777418321;4712.905741885074;4713.0338280651695;4714.976425117852;4754.667173297836;4758.976205118952;4453.955460445354;4604.539546045368;4638.6752927294765;4643.907121857612;4678.929816052694;4704.482506924304;4728.787204575733;4736.8578942631775;4763.642726795573;4782.402199725035;4633.119707255611;4633.582977531903;4641.303804429228;4677.76611169447;4685.625149988061 09:24:14 INFO - PROCESS | 22769 | |1;ext.html;508.3290057124595;543.0821910970457;545.858076900006;551.162233405224;558.3049103865687;32781;33363;33378.8331058345;33379.83310083452;33423;35181.2963740725;35463.645363546355;35813.64186358135;35814.8209258954;35846;7745.922540774576;7899.447038707292;7939.166387529284;7945.245201705829;7961.562114083723;7830.138684744674;7985.441019128663;7987.640556174986;7992.560409177493;7992.920070799276;7959.442839001273;8025.6789728410795;8027.43807933442;8030.156833532483;8040.517568945853;7901.762947111567;7957;7968.402369822286;7971.720989765359;7973.362131029504;7965.084015338252;8097.149799271051;8097.554634495101;8097.595120244023;8104.270615644561;35518;35939.640603594155;35981.100472488135;35987;36016.27967440663;2696.5146273670925;2736.698963114056;2758.0622588319866;2790.330320723032;2872.0809341010886;26929.865350673317;28165.85917070422;28409.57385639217;28438.715612844022;28674.139775806758;3385.5768028996376;3403.4384326586082;3409.6931276185014;3485.4375214666634;3506.789592624425;165239;165913;166160;167541.16229418898;167913;54754;55460.72269638626;55503.72248138733;55561.99942005239;55775;60191.39808601946;61154;61209.69395152996;61219.6939015311;61259.69370153121;11966.940165299118;12148.939255303667;12164.81752773709;12183.086268529896;12187.695307617381;9447.527623618791;9550.235981121632;9567.760805979768;9574.47340396271;9580.95209523948;18577.699561030597;18613.162407691685;18733.90633046826;18766.53083672919;19611.548556430447;7553;7727.227277272228;7781.182975787574;7806;7806.68773249075;807.7657479330928;835.277484975504;842.6503001254533;869.4261787220404;933.0624763498028;25731;26210.344741381617;26872.731272687022;27013.1896043119;27145;920.9493477858648;928.4197376639601;949.7483166960761;1053.8261186904228;1055.488088277185;13581.388837502336;13801.930990344985;14077.85922140786;14119.576412707429;14161.150330980174;257419;259141;260467;262232;262254;44762;45428.77285613551;45507.544924550995;45549.54450455453;45557;1046.942418167008;1127.2053202492223;1135.3074624479061;1179.8260730573136;1181.2381014245934;23481.765182347957;23869.164579239645;25526.744732552437;25761.484770304865;25910.222693319232;34854.82572587121;35871.64128358683;36273.81863090667;36276.45585316275;36286.45570316395;171512;171575;171720;171746;171856;23251.651225231297;27690;28646;28663.140105796858;28930.855345723136;33053.17367065843;40643.390349145375;40967.795161024005;42334.7883260594;42399.788001059795;33726.83136584301;35056.298874021864;35256.64743352636;35564.28871422609;35984.460233097045;31592.526112108797;32986;33076.83461582677;33145.83427082849;33453;32379.676203237665;32883;32974.34051318912;33103.172420689676;33211.16972075718;29306.413871722874;29458.26354341073;29921;29972.550411744276;30046.24884377908;23266.418339541648;23367.298981030595;23570.764292357544;23636.763632363458;23651 09:24:14 INFO - PROCESS | 22769 | |2;jquery.html;339.2536419876274;339.56535634387984;340.0817791961703;345.20774821784005;351.32720839592184;14455;15181.39274429023;15723.52829415118;16348;16370.099644519547;14810.851891481081;15028.098314101162;15252.923735381335;15661;15718.528444146665;4904.803807847691;5096.235564665311;5100.84697459075;5112.872178195556;5119.795208191668;4965.453800081988;4984.501549845023;5093.363329583802;5098.694078355311;5099.770510327045;5077.517635824609;5087.5421212090905;5090.77091530882;5092.363454568179;5094.083065048289;4911.189653707134;4995.175795993657;5061.063703214917;5063.645544811846;5079.034983353151;4523.321501774727;4536.228841096989;4538.500764915857;4539.160255352737;4549.795259213343;18274.17766200511;18649.813501864945;19041.429407030013;19052.333168339042;19061.714074288895;1716.1419290354822;1975.3086419753115;2086.7078608994752;2495.538325409805;2499.262717498324;11863.288202707865;11866.363442682257;11969.700757481045;12399;12522.37030223654;1737.5569229846435;1742.1376418672837;1757.3585641240984;1770.8583313334902;1811.0763510609552;39494.80252598747;40141.79929100336;41203;52754.73622631901;54341.72829135868;9023.864642030374;9046;9161.862572061424;9282.257419406431;9312.580933857993;10701.892981070245;11709.531618735155;11715.824262636068;11725.35510546911;11730.824037639442;6271.529635277372;6419.711112999927;6529.836754081091;6538.836529086716;6541;5959.7914073008105;5972.731227094791;6063.605865618721;6074.301455332693;6099.024156135086;5612.579056570774;5758.856028599319;5779.162021506858;5794.710264486759;5887.175795388649;1661.900285982845;1699.269314194908;1702.0383483331877;1711.945665201763;1718.218210714147;735.3969744809312;828.8300898315831;832.9875051874227;864.3776480933718;969.7187815533557;15338.386464541516;15629.3748250071;15804;16036.11801350937;16232.431864884673;823.567626995832;831.2518733140101;843.1442086282428;844.8901642786399;901.5402144906145;8888.288936885163;8980.326475514232;9284.303677224236;9287.674931377369;9445.763855903657;234451;376842;384066;384681;386161;66420;66995.3300466989;68760.6561967187;69722.65138674376;70228.29771702217;848.87266909964;919.7332773495746;938.3572253006712;971.1842052675786;973.8247115519133;13185.142965707199;13407.731845362843;13580.86419135796;13747.450101995808;13763.724725505233;30426.543601845548;30659.2335191622;30960.845195773876;31602.683973160892;32206;42860;44305.778471107435;44351;44422.77788611165;44857.55142448664;6663.400293973372;6827.590344579341;6904.102466679299;6907.171139463297;6963.40811031068;9822.607095716092;10848.620298289521;11074.778504430027;11432.828507572227;11440.256383335056;9370.250379969722;9518.381305215138;9674.467904265333;9797.85303220438;9959.850602241117;9513.143817056498;9533.47565883883;9588.089131532493;9615.51922403891;9765.365251258645;9553.61785528571;9663.420194788336;9715.9028409715;9859.950700246452;9944.651937182163;6884.4148247399535;7021.438284937295;7049.083619129686;7050.506464547432;7258.491905566771;9341.626334946526;10038.799224015333;10068.496575171359;10162.593496260066;10376 09:24:14 INFO - PROCESS | 22769 | |3;mootools.html;1221.3587866370149;1319.2150670351143;1331.6138319887234;1430.9785353219704;1726.2059452651788;7007.859842803141;7150;7151.427885769139;7169.462290328227;7170.426365890729;7009.369156775889;7144.7499337523195;7176.174739904913;7181.353678168964;7190.101237345332;1796.4969808453654;2093.9895300523476;2124.872507649542;2152.569486102778;2154.138344662132;2168.609650262952;2183.552371763785;2185.4099393163838;2186.256672731271;2187.3765976696645;2071.8964051797425;2109.6308146074452;2114.9154033838627;2115.0059472048115;2115.8730476171404;2069.7102405663218;2097.92657256996;2108.68369744538;2111.820495257905;2115.95768084639;2110.9788902110936;2135.7010018597252;2144.07804644003;2144.7426308842882;2145.560160167162;7047.8590428191665;7059.682314295869;7074.752383666547;7091.964540177318;7098.7515436959975;4362.650987920959;4479.686421950465;4507.842225522091;4508.030773383738;4510.481294651125;2705.526532856762;2732.699403065661;2783.067672329772;2791.092894809195;2830.660320761501;864.394923553515;868.8001759595328;881.5283823154582;915.1031988651159;920.9263258939269;10028.64899728506;10123.392596444237;10138.746531336701;10139.08748212657;10140.03669651382;3909.667678247381;3935.252302062599;4019.2363450944813;4023.637872591481;4055.634992850599;8682.348823838238;8694.652213911499;8701.17338852808;8724.825503490021;8733.995590507046;3783.1109689223013;4279.144171165779;4282.743035417822;4296.656267498593;4297.72064815786;3802.9429558556644;3844.0774214188395;3908.609139086069;3916.921661566753;3925.3130702127582;3372.8144952027383;3450.8274586270586;3481.112316359363;3500.68493835556;3507.964920350764;1115.2973626615342;1148.2995372822572;1148.5463242019355;1161.5586077290745;1162.041315914374;909.3270979475272;919.5723988345452;927.1238679447857;942.6559305853314;1204.2232759869835;6732.360425759545;6787.083743694637;6846.657667116724;6861.965690171517;6868.965655171693;448.9416375871181;452.11160070461045;452.1386758225585;455.4989511537282;462.142725244673;5314.7608357624;5316.149416093406;5368.194770784336;5391.919121213185;5399.487048730364;8235.588220588947;8591.09793471689;8649.264812490883;8679.739607811776;8692.869606955901;8445.239928406472;8471.491710497266;8496.107908669625;8498.02272738643;8510.48937063778;6583.242927063353;6695.531312808057;6774.593524388552;6782.525223234326;6842.6578671066245;6832.180138383425;6874.2782007890455;6887.5178737487895;6932.133483314586;6956.40870526011;7677.692892284246;7858.174891636524;7869.055713314439;7974.84050319002;7975.082865470313;7872.685092596232;8117.350611950912;8127.3091787198755;8144.633491492778;8278.668853246043;5499.560035197254;5589.301337332833;6109.84725381869;6342.143810585512;6483.837904052436;6870.072540207208;6882.8623427530165;6913.274106218774;6929.930700692928;6931.549449285781;6067.302260240129;6106.755729770937;6168.784092556739;6177.042558403455;6222.782202622887;5968.522518198621;6000.669963152069;6053;6151;6177.660228687465;6415.615063096229;6648.301928297459;6650.3682150195655;6655.168103987002;6659.966700166468;5930.169776231417;5985.162077309267;5986.850328741642;5993.130996005468;5997.55018373615;5882.382349853204;5965.582409231312;5976.820695379146;5987.880242395215;5989.921814073508 09:24:14 INFO - PROCESS | 22769 | |4;prototype.html;301.90188188838636;306.1489060412054;310.1873092497658;313.11388769781513;316.14009893090787;5252.31719876416;5311.68129912205;5312.4687531246855;5351.866203344918;5396.91904621431;5280.762365693543;5284.2866213061225;5292.629515933877;5306.097963346231;5314.282571852798;3909.335412979786;4023.1752490739473;4112.835486580548;4129.628333449997;4151.83392664293;4116.9794151029355;4128.69034822388;4140.23405669952;4140.441040459529;4151.667866570682;4089.141280331134;4107.363358679395;4110.794460276989;4113.321301985184;4120.546739858628;3865.246276975991;3985.581513941038;4046.5346485153996;4102.200070986159;4111.671066314688;3588.1747198144312;3599.7300202484657;3600;3603.5675718913635;3603.7117030637487;5070.011347787183;5099.898002039976;5105.897882042338;5109.1059064663905;5114;4776.283557466373;4782.187028205179;4782.426108866924;4786.7845946932475;4789.2097803862325;5575.665460072409;5588.133839254922;5601.29983752031;5607.635503692247;5609.326880774333;3997.600239976008;4002.8198731057173;4003.559608443069;4006.8196931137877;4009.679225661969;5666.1784041314195;5859.7656093756195;5899.882002359972;5904.704764761745;5917.585768996172;3922.431247469101;3973.443717879499;3977.184677141237;3977.443157957888;3979.9204015919518;4038.4548086008012;4041.373587094005;4042.3734321180264;4042.959570404317;4045;4642.51253618372;4649.139909116824;4650.813967441332;4652.55800698933;4654.930176047362;5566.944330556643;5569.443055694398;5573.470520300646;5582.8325150245555;5585.748641311151;1407.6480879780056;1431.0984080029514;1431.8568143185598;1432.4055516960552;1433.5770947570493;882.8455020371409;913.2830727878717;942.2085448223526;968.912797848183;974.541965276319;4736.621070314367;4786.042791441726;4810.855674329776;4870.14772414826;4960.503949605083;5888.823335299948;5906.084556893602;5929.288485381781;5934.8813023739285;5962.314333851576;4945.2087665973995;4948.812285051562;4949.975250123798;4951.405831300267;4959.256111583291;3120.5163199704084;3136.702013308732;3162.2410621450686;3164.8892288769784;3164.984175079156;5570.6657600544095;5578.609497335147;5581.134924086773;5581.162825576115;5586.497215250566;5978.55160862937;6039.396060393926;6047.818565443044;6048.274207095177;6051.515878729691;5524.14375771756;5563.443655634485;5595.04884169684;5598.384177740527;5600.887982240332;5883.235179426647;5890.175375447355;5893.5874488785375;5896.941030589639;5903.26209223847;5692.829215123553;5713.771449141987;5725.370209277059;5726.312842458931;5736.942630573641;5415.5938304626525;5567.4432556744005;5585.832425027255;5595.524380427709;5595.832125036255;4007.6593489553716;4014.6186112319283;4015.598440155961;4016.4376987222395;4019.537753158424;5836.562257830595;5873.853153671193;5876.794312199224;5882.941170588239;5886.117082437669;5624.606277560531;5647.124695672177;5648.689322087324;5663.150527420919;5669.461401166883;5647.0964645656495;5649.745761440828;5650.265465489624;5652.039153343859;5658.094704847204;5408.918866217088;5519.917201241904;5536.058869992031;5544.695041772741;5566.944330556643;5697.487226149667;5713.914291285717;5721.685307308138;5727.8854422912145;5731.111677689964;5545.889082218252;5554.305711786027;5569.331680198402;5569.412717375529;5571.052921003358 09:24:14 INFO - PROCESS | 22769 | |5;yui.html;589.9144624029514;632.3518393646511;662.9701663425145;666.1805978646265;699.5592776550773;11222;11341.829872551918;11356.943215283913;11359.432028398589;11373.772524549504;11303.491342889569;11370.204085714004;11471.082313414927;11480.540778368855;11489.482973266202;772.0735117858565;786.6224212378062;787.6455594982252;787.8936343593599;788.0425283280813;780.6135962698472;783.4633276205789;785.1049803224329;785.721069020498;787.2127872127872;806.6007326373453;818.6848063495538;819.8647223208163;820.5856042698459;822.042320696388;817.750586071248;818.8034871630825;819.3486178488116;824.2087595907935;827.4828232354778;614.6281499692711;615.1756646094256;615.796787060269;616.2666426951913;616.3866952382408;11289.491972861159;11318.377489238088;11340;11346.489407976578;11368.488418021208;11780.293182409083;11955.103367247404;12269.93865030678;12365.134440589163;12443.688907777287;9190.54047297639;9301.767455813591;9357.064293570656;9385.249180065579;9413.294002949806;3201.535777312277;3231.8222497762613;3251.0896948854124;3272.280098378353;3310.3213841162506;39394.409083863764;39476.60523394787;39831.8008409959;39859.20281594352;39988.800055999825;9217.170454659114;9252.814943701089;9465.716028519155;9470.526473676426;9562.521873906277;16862.072586007886;16915.577110572332;17130.743038854427;17137.314507419815;17213.7417938731;6412.61524308543;6535.803925882231;6590.044443555754;6608.537402381787;6742.325767423316;3484.77348972316;3585.2829434113282;3599.3161299353037;3634.200475895299;3641.10792855752;2554.310336209213;2577.76800087993;2591.183777110204;2598.7920966323027;2605.9087931922672;466.2958932012618;479.91601469742653;485.7231378114511;488.9071076495454;496.5183771741405;566.7732906837216;568.815135081092;573.9913901291484;580.2282963658324;581.7934633205151;7475.738349157753;7499.737509187262;7643.7324693635455;7728.536287822749;7758.107817600935;546.4562760053692;568.1307599372966;578.482258378757;585.2508788750406;596.6151832068379;3387.5765529308837;3486.89539313821;3582.3372676055014;3591.892243232707;3611.1513794258326;45363;46548.301775473396;46651;46846.76576617095;46931.29603055957;38376;42349.78825105855;43361.56638433639;43464.78267608642;48294.75852620785;39570.406443902786;39578.40632390516;39642.60357396389;39897.60102398997;39973;7198.136223653195;7589.43079269046;7674.8081297968;7899.565523896241;7945.8410831781885;29274.414511710074;29288;29743.10770676883;29986.400271994873;30503.847480762455;34717.652823472454;35194.120146995505;37901;37974;38305.6169438302;10647.148228141576;10687.625933092304;10736.51685674131;10828.971247731453;10834.295770774874;10753.677389678322;11004;11401.429928503707;11436.714082148013;11476.540938362707;10370.481475926324;10451.477426128815;10742.51658675377;10837.566497340018;11117.777644447227;9754.317197796086;9850.014998500093;10192.439415832201;10265.281430299807;10550.788984220118;10294.845577316497;10660.466976650981;10953.288036277616;10992.945035274772;11011.559537618727;8112.02655681322;8150.2664760171865;8162.632681529227;8581.65673373058;8606.225439710455;8245.628946697292;8445.788855278668;8487.915120848713;8899.866502002606;8900.510471924106 09:24:14 INFO - PROCESS | 22769 | __end_tp_report 09:24:14 INFO - PROCESS | 22769 | __start_cc_report 09:24:14 INFO - PROCESS | 22769 | _x_x_mozilla_cycle_collect,894 09:24:14 INFO - PROCESS | 22769 | __end_cc_report 09:24:14 INFO - PROCESS | 22769 | __startTimestamp1457371454421__endTimestamp 09:24:14 INFO - PROCESS | 22769 | 09:24:14 INFO - PROCESS | 22769 | ------- Summary: start ------- 09:24:14 INFO - PROCESS | 22769 | Number of tests: 6 09:24:14 INFO - PROCESS | 22769 | 09:24:14 INFO - PROCESS | 22769 | [#0] dojo.html Cycles:165 Average:4460.37 Median:4630.26 stddev:459.55 (9.9%) stddev-sans-first:436.04 09:24:14 INFO - PROCESS | 22769 | Values: 2557.2 2630.4 2639.2 2649.4 2670.6 4401.0 4466.6 4469.8 4483.3 4493.8 4513.1 4520.2 4559.9 4561.6 4617.9 4093.5 4150.8 4171.3 4200.3 4209.0 4144.7 4216.6 4226.2 4235.3 4274.8 4025.6 4127.2 4177.5 4195.6 4198.3 4091.5 4094.4 4101.3 4126.3 4136.2 3955.7 4028.3 4057.8 4059.8 4096.1 4343.6 4407.6 4451.9 4464.5 4496.1 4834.9 4842.7 4844.5 4846.1 4864.9 4657.6 4849.7 4866.7 4868.5 4904.7 4508.1 4510.1 4514.7 4539.5 4544.2 4929.1 4949.6 4949.9 4950.3 4994.1 4601.5 4745.5 4769.0 4785.3 4847.5 4826.3 4839.7 4846.6 4869.6 4890.7 4786.5 4786.9 4790.7 4792.1 4842.0 4600.1 4729.1 4758.5 4812.7 4813.2 4016.6 4021.3 4022.2 4022.8 4041.5 3554.9 3556.5 3578.9 3591.6 3607.4 4094.3 4155.1 4176.4 4221.3 4229.2 4754.9 4793.0 4796.4 4797.5 4837.2 4134.5 4135.7 4137.3 4177.1 4188.1 4177.0 4239.9 4289.1 4290.0 4330.0 4608.1 4616.2 4630.3 4630.4 4677.7 4652.5 4837.7 4838.3 4842.1 4867.9 4606.1 4650.0 4651.6 4671.3 4697.5 4758.5 4770.0 4770.6 4777.8 4791.3 4714.9 4831.0 4832.6 4844.6 4876.7 4692.4 4713.4 4714.1 4714.6 4754.5 4712.9 4713.0 4715.0 4754.7 4759.0 4454.0 4604.5 4638.7 4643.9 4678.9 4704.5 4728.8 4736.9 4763.6 4782.4 4633.1 4633.6 4641.3 4677.8 4685.6 09:24:14 INFO - PROCESS | 22769 | 09:24:14 INFO - PROCESS | 22769 | [#1] ext.html Cycles:180 Average:36497.51 Median:3406.57 stddev:53201.83 (1561.7%) stddev-sans-first:53282.45 09:24:14 INFO - PROCESS | 22769 | Values: 508.3 543.1 545.9 551.2 558.3 32781.0 33363.0 33378.8 33379.8 33423.0 35181.3 35463.6 35813.6 35814.8 35846.0 7745.9 7899.4 7939.2 7945.2 7961.6 7830.1 7985.4 7987.6 7992.6 7992.9 7959.4 8025.7 8027.4 8030.2 8040.5 7901.8 7957.0 7968.4 7971.7 7973.4 7965.1 8097.1 8097.6 8097.6 8104.3 35518.0 35939.6 35981.1 35987.0 36016.3 2696.5 2736.7 2758.1 2790.3 2872.1 26929.9 28165.9 28409.6 28438.7 28674.1 3385.6 3403.4 3409.7 3485.4 3506.8 165239.0 165913.0 166160.0 167541.2 167913.0 54754.0 55460.7 55503.7 55562.0 55775.0 60191.4 61154.0 61209.7 61219.7 61259.7 11966.9 12148.9 12164.8 12183.1 12187.7 9447.5 9550.2 9567.8 9574.5 9581.0 18577.7 18613.2 18733.9 18766.5 19611.5 7553.0 7727.2 7781.2 7806.0 7806.7 807.8 835.3 842.7 869.4 933.1 25731.0 26210.3 26872.7 27013.2 27145.0 920.9 928.4 949.7 1053.8 1055.5 13581.4 13801.9 14077.9 14119.6 14161.2 257419.0 259141.0 260467.0 262232.0 262254.0 44762.0 45428.8 45507.5 45549.5 45557.0 1046.9 1127.2 1135.3 1179.8 1181.2 23481.8 23869.2 25526.7 25761.5 25910.2 34854.8 35871.6 36273.8 36276.5 36286.5 171512.0 171575.0 171720.0 171746.0 171856.0 23251.7 27690.0 28646.0 28663.1 28930.9 33053.2 40643.4 40967.8 42334.8 42399.8 33726.8 35056.3 35256.6 35564.3 35984.5 31592.5 32986.0 33076.8 33145.8 33453.0 32379.7 32883.0 32974.3 33103.2 33211.2 29306.4 29458.3 29921.0 29972.6 30046.2 23266.4 23367.3 23570.8 23636.8 23651.0 09:24:14 INFO - PROCESS | 22769 | 09:24:14 INFO - PROCESS | 22769 | [#2] jquery.html Cycles:180 Average:21641.36 Median:5028.12 stddev:58791.99 (1169.3%) stddev-sans-first:58935.16 09:24:14 INFO - PROCESS | 22769 | Values: 339.3 339.6 340.1 345.2 351.3 14455.0 15181.4 15723.5 16348.0 16370.1 14810.9 15028.1 15252.9 15661.0 15718.5 4904.8 5096.2 5100.8 5112.9 5119.8 4965.5 4984.5 5093.4 5098.7 5099.8 5077.5 5087.5 5090.8 5092.4 5094.1 4911.2 4995.2 5061.1 5063.6 5079.0 4523.3 4536.2 4538.5 4539.2 4549.8 18274.2 18649.8 19041.4 19052.3 19061.7 1716.1 1975.3 2086.7 2495.5 2499.3 11863.3 11866.4 11969.7 12399.0 12522.4 1737.6 1742.1 1757.4 1770.9 1811.1 39494.8 40141.8 41203.0 52754.7 54341.7 9023.9 9046.0 9161.9 9282.3 9312.6 10701.9 11709.5 11715.8 11725.4 11730.8 6271.5 6419.7 6529.8 6538.8 6541.0 5959.8 5972.7 6063.6 6074.3 6099.0 5612.6 5758.9 5779.2 5794.7 5887.2 1661.9 1699.3 1702.0 1711.9 1718.2 735.4 828.8 833.0 864.4 969.7 15338.4 15629.4 15804.0 16036.1 16232.4 823.6 831.3 843.1 844.9 901.5 8888.3 8980.3 9284.3 9287.7 9445.8 234451.0 376842.0 384066.0 384681.0 386161.0 66420.0 66995.3 68760.7 69722.7 70228.3 848.9 919.7 938.4 971.2 973.8 13185.1 13407.7 13580.9 13747.5 13763.7 30426.5 30659.2 30960.8 31602.7 32206.0 42860.0 44305.8 44351.0 44422.8 44857.6 6663.4 6827.6 6904.1 6907.2 6963.4 9822.6 10848.6 11074.8 11432.8 11440.3 9370.3 9518.4 9674.5 9797.9 9959.9 9513.1 9533.5 9588.1 9615.5 9765.4 9553.6 9663.4 9715.9 9860.0 9944.7 6884.4 7021.4 7049.1 7050.5 7258.5 9341.6 10038.8 10068.5 10162.6 10376.0 09:24:14 INFO - PROCESS | 22769 | 09:24:14 INFO - PROCESS | 22769 | [#3] mootools.html Cycles:180 Average:5025.32 Median:5988.90 stddev:2651.26 (44.3%) stddev-sans-first:2643.28 09:24:14 INFO - PROCESS | 22769 | Values: 1221.4 1319.2 1331.6 1431.0 1726.2 7007.9 7150.0 7151.4 7169.5 7170.4 7009.4 7144.7 7176.2 7181.4 7190.1 1796.5 2094.0 2124.9 2152.6 2154.1 2168.6 2183.6 2185.4 2186.3 2187.4 2071.9 2109.6 2114.9 2115.0 2115.9 2069.7 2097.9 2108.7 2111.8 2116.0 2111.0 2135.7 2144.1 2144.7 2145.6 7047.9 7059.7 7074.8 7092.0 7098.8 4362.7 4479.7 4507.8 4508.0 4510.5 2705.5 2732.7 2783.1 2791.1 2830.7 864.4 868.8 881.5 915.1 920.9 10028.6 10123.4 10138.7 10139.1 10140.0 3909.7 3935.3 4019.2 4023.6 4055.6 8682.3 8694.7 8701.2 8724.8 8734.0 3783.1 4279.1 4282.7 4296.7 4297.7 3802.9 3844.1 3908.6 3916.9 3925.3 3372.8 3450.8 3481.1 3500.7 3508.0 1115.3 1148.3 1148.5 1161.6 1162.0 909.3 919.6 927.1 942.7 1204.2 6732.4 6787.1 6846.7 6862.0 6869.0 448.9 452.1 452.1 455.5 462.1 5314.8 5316.1 5368.2 5391.9 5399.5 8235.6 8591.1 8649.3 8679.7 8692.9 8445.2 8471.5 8496.1 8498.0 8510.5 6583.2 6695.5 6774.6 6782.5 6842.7 6832.2 6874.3 6887.5 6932.1 6956.4 7677.7 7858.2 7869.1 7974.8 7975.1 7872.7 8117.4 8127.3 8144.6 8278.7 5499.6 5589.3 6109.8 6342.1 6483.8 6870.1 6882.9 6913.3 6929.9 6931.5 6067.3 6106.8 6168.8 6177.0 6222.8 5968.5 6000.7 6053.0 6151.0 6177.7 6415.6 6648.3 6650.4 6655.2 6660.0 5930.2 5985.2 5986.9 5993.1 5997.6 5882.4 5965.6 5976.8 5987.9 5989.9 09:24:14 INFO - PROCESS | 22769 | 09:24:14 INFO - PROCESS | 22769 | [#4] prototype.html Cycles:180 Average:4666.30 Median:5312.08 stddev:1385.78 (26.1%) stddev-sans-first:1350.39 09:24:14 INFO - PROCESS | 22769 | Values: 301.9 306.1 310.2 313.1 316.1 5252.3 5311.7 5312.5 5351.9 5396.9 5280.8 5284.3 5292.6 5306.1 5314.3 3909.3 4023.2 4112.8 4129.6 4151.8 4117.0 4128.7 4140.2 4140.4 4151.7 4089.1 4107.4 4110.8 4113.3 4120.5 3865.2 3985.6 4046.5 4102.2 4111.7 3588.2 3599.7 3600.0 3603.6 3603.7 5070.0 5099.9 5105.9 5109.1 5114.0 4776.3 4782.2 4782.4 4786.8 4789.2 5575.7 5588.1 5601.3 5607.6 5609.3 3997.6 4002.8 4003.6 4006.8 4009.7 5666.2 5859.8 5899.9 5904.7 5917.6 3922.4 3973.4 3977.2 3977.4 3979.9 4038.5 4041.4 4042.4 4043.0 4045.0 4642.5 4649.1 4650.8 4652.6 4654.9 5566.9 5569.4 5573.5 5582.8 5585.7 1407.6 1431.1 1431.9 1432.4 1433.6 882.8 913.3 942.2 968.9 974.5 4736.6 4786.0 4810.9 4870.1 4960.5 5888.8 5906.1 5929.3 5934.9 5962.3 4945.2 4948.8 4950.0 4951.4 4959.3 3120.5 3136.7 3162.2 3164.9 3165.0 5570.7 5578.6 5581.1 5581.2 5586.5 5978.6 6039.4 6047.8 6048.3 6051.5 5524.1 5563.4 5595.0 5598.4 5600.9 5883.2 5890.2 5893.6 5896.9 5903.3 5692.8 5713.8 5725.4 5726.3 5736.9 5415.6 5567.4 5585.8 5595.5 5595.8 4007.7 4014.6 4015.6 4016.4 4019.5 5836.6 5873.9 5876.8 5882.9 5886.1 5624.6 5647.1 5648.7 5663.2 5669.5 5647.1 5649.7 5650.3 5652.0 5658.1 5408.9 5519.9 5536.1 5544.7 5566.9 5697.5 5713.9 5721.7 5727.9 5731.1 5545.9 5554.3 5569.3 5569.4 5571.1 09:24:14 INFO - PROCESS | 22769 | 09:24:14 INFO - PROCESS | 22769 | [#5] yui.html Cycles:180 Average:11919.39 Median:43413.17 stddev:13207.26 (30.4%) stddev-sans-first:13216.90 09:24:14 INFO - PROCESS | 22769 | Values: 589.9 632.4 663.0 666.2 699.6 11222.0 11341.8 11356.9 11359.4 11373.8 11303.5 11370.2 11471.1 11480.5 11489.5 772.1 786.6 787.6 787.9 788.0 780.6 783.5 785.1 785.7 787.2 806.6 818.7 819.9 820.6 822.0 817.8 818.8 819.3 824.2 827.5 614.6 615.2 615.8 616.3 616.4 11289.5 11318.4 11340.0 11346.5 11368.5 11780.3 11955.1 12269.9 12365.1 12443.7 9190.5 9301.8 9357.1 9385.2 9413.3 3201.5 3231.8 3251.1 3272.3 3310.3 39394.4 39476.6 39831.8 39859.2 39988.8 9217.2 9252.8 9465.7 9470.5 9562.5 16862.1 16915.6 17130.7 17137.3 17213.7 6412.6 6535.8 6590.0 6608.5 6742.3 3484.8 3585.3 3599.3 3634.2 3641.1 2554.3 2577.8 2591.2 2598.8 2605.9 466.3 479.9 485.7 488.9 496.5 566.8 568.8 574.0 580.2 581.8 7475.7 7499.7 7643.7 7728.5 7758.1 546.5 568.1 578.5 585.3 596.6 3387.6 3486.9 3582.3 3591.9 3611.2 45363.0 46548.3 46651.0 46846.8 46931.3 38376.0 42349.8 43361.6 43464.8 48294.8 39570.4 39578.4 39642.6 39897.6 39973.0 7198.1 7589.4 7674.8 7899.6 7945.8 29274.4 29288.0 29743.1 29986.4 30503.8 34717.7 35194.1 37901.0 37974.0 38305.6 10647.1 10687.6 10736.5 10829.0 10834.3 10753.7 11004.0 11401.4 11436.7 11476.5 10370.5 10451.5 10742.5 10837.6 11117.8 9754.3 9850.0 10192.4 10265.3 10550.8 10294.8 10660.5 10953.3 10992.9 11011.6 8112.0 8150.3 8162.6 8581.7 8606.2 8245.6 8445.8 8487.9 8899.9 8900.5 09:24:14 INFO - PROCESS | 22769 | -------- Summary: end -------- 09:24:14 INFO - PROCESS | 22769 | 09:24:15 INFO - TEST-INFO | 22769: exit 0 09:24:15 INFO - TEST-OK | dromaeo_css | took 1117483ms 09:24:15 INFO - TEST-START | kraken 09:24:15 INFO - operating with platform_type : linux_ 09:24:15 INFO - Initialising browser for kraken test... 09:24:15 INFO - TEST-INFO | started process 22952 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp4il4TD/profile http://localhost:43343/getInfo.html) 09:24:20 INFO - PROCESS | 22952 | __metrics Screen width/height:1600/1200 09:24:20 INFO - PROCESS | 22952 | colorDepth:24 09:24:20 INFO - PROCESS | 22952 | Browser inner width/height: 1024/697 09:24:20 INFO - PROCESS | 22952 | __metrics 09:24:21 INFO - PROCESS | 22952 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 09:24:21 INFO - PROCESS | 22952 | JavaScript error: resource://gre/modules/IndexedDBHelper.jsm, line 138: UnknownError: The operation failed for reasons unrelated to the database itself and not covered by any other error code. 09:24:22 INFO - TEST-INFO | 22952: exit 0 09:24:22 INFO - Browser initialized. 09:24:22 INFO - Running cycle 1/1 for kraken test... 09:24:22 INFO - TEST-INFO | started process 23035 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp4il4TD/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 09:24:33 INFO - PROCESS | 23035 | RSS: Main: 156020736 09:24:33 INFO - PROCESS | 23035 | 09:24:36 INFO - PROCESS | 23035 | Cycle 1(1): loaded http://localhost:43343/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:43343/tests/kraken/driver.html?testName=audio-beat-detection) 09:24:37 INFO - PROCESS | 23035 | RSS: Main: 200536064 09:24:37 INFO - PROCESS | 23035 | 09:24:39 INFO - PROCESS | 23035 | Cycle 1(1): loaded http://localhost:43343/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:43343/tests/kraken/driver.html?testName=audio-dft) 09:24:40 INFO - PROCESS | 23035 | RSS: Main: 188739584 09:24:40 INFO - PROCESS | 23035 | 09:24:43 INFO - PROCESS | 23035 | Cycle 1(1): loaded http://localhost:43343/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:43343/tests/kraken/driver.html?testName=audio-fft) 09:24:44 INFO - PROCESS | 23035 | RSS: Main: 171986944 09:24:44 INFO - PROCESS | 23035 | 09:24:46 INFO - PROCESS | 23035 | Cycle 1(1): loaded http://localhost:43343/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:43343/tests/kraken/driver.html?testName=audio-oscillator) 09:24:46 INFO - PROCESS | 23035 | RSS: Main: 173756416 09:24:46 INFO - PROCESS | 23035 | 09:24:49 INFO - PROCESS | 23035 | Cycle 1(1): loaded http://localhost:43343/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:43343/tests/kraken/driver.html?testName=imaging-gaussian-blur) 09:24:49 INFO - PROCESS | 23035 | RSS: Main: 176455680 09:24:49 INFO - PROCESS | 23035 | 09:24:52 INFO - PROCESS | 23035 | Cycle 1(1): loaded http://localhost:43343/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:43343/tests/kraken/driver.html?testName=imaging-darkroom) 09:24:53 INFO - PROCESS | 23035 | RSS: Main: 177020928 09:24:53 INFO - PROCESS | 23035 | 09:24:56 INFO - PROCESS | 23035 | Cycle 1(1): loaded http://localhost:43343/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:43343/tests/kraken/driver.html?testName=imaging-desaturate) 09:24:57 INFO - PROCESS | 23035 | RSS: Main: 178036736 09:24:57 INFO - PROCESS | 23035 | 09:25:00 INFO - PROCESS | 23035 | Cycle 1(1): loaded http://localhost:43343/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:43343/tests/kraken/driver.html?testName=json-parse-financial) 09:25:00 INFO - PROCESS | 23035 | RSS: Main: 178245632 09:25:00 INFO - PROCESS | 23035 | 09:25:02 INFO - PROCESS | 23035 | Cycle 1(1): loaded http://localhost:43343/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:43343/tests/kraken/driver.html?testName=json-stringify-tinderbox) 09:25:03 INFO - PROCESS | 23035 | RSS: Main: 188973056 09:25:03 INFO - PROCESS | 23035 | 09:25:05 INFO - PROCESS | 23035 | Cycle 1(1): loaded http://localhost:43343/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:43343/tests/kraken/driver.html?testName=stanford-crypto-aes) 09:25:05 INFO - PROCESS | 23035 | RSS: Main: 184930304 09:25:05 INFO - PROCESS | 23035 | 09:25:07 INFO - PROCESS | 23035 | Cycle 1(1): loaded http://localhost:43343/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:43343/tests/kraken/driver.html?testName=stanford-crypto-ccm) 09:25:08 INFO - PROCESS | 23035 | RSS: Main: 195891200 09:25:08 INFO - PROCESS | 23035 | 09:25:10 INFO - PROCESS | 23035 | Cycle 1(1): loaded http://localhost:43343/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:43343/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 09:25:11 INFO - PROCESS | 23035 | RSS: Main: 203919360 09:25:11 INFO - PROCESS | 23035 | 09:25:14 INFO - PROCESS | 23035 | Cycle 1(1): loaded http://localhost:43343/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:43343/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 09:25:14 INFO - PROCESS | 23035 | RSS: Main: 202522624 09:25:14 INFO - PROCESS | 23035 | 09:25:16 INFO - PROCESS | 23035 | Cycle 1(1): loaded http://localhost:43343/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:43343/tests/kraken/driver.html?testName=ai-astar) 09:25:16 INFO - PROCESS | 23035 | RSS: Main: 264151040 09:25:16 INFO - PROCESS | 23035 | 09:25:16 INFO - PROCESS | 23035 | __start_tp_report 09:25:16 INFO - PROCESS | 23035 | _x_x_mozilla_page_load 09:25:16 INFO - PROCESS | 23035 | _x_x_mozilla_page_load_details 09:25:16 INFO - PROCESS | 23035 | |i|pagename|runs| 09:25:16 INFO - PROCESS | 23035 | |0;ai-astar;111;115;110;115;113;114;103;113;113;113 09:25:16 INFO - PROCESS | 23035 | |1;audio-beat-detection;162;133;158;178;133;165;160;142;172;134 09:25:16 INFO - PROCESS | 23035 | |2;audio-dft;162;160;162;164;161;160;163;163;161;164 09:25:16 INFO - PROCESS | 23035 | |3;audio-fft;75;74;98;97;74;73;74;112;92;73 09:25:16 INFO - PROCESS | 23035 | |4;audio-oscillator;94;95;140;94;95;95;156;94;95;132 09:25:16 INFO - PROCESS | 23035 | |5;imaging-gaussian-blur;117;116;117;116;118;117;117;117;117;118 09:25:16 INFO - PROCESS | 23035 | |6;imaging-darkroom;146;147;147;147;146;147;147;146;146;146 09:25:16 INFO - PROCESS | 23035 | |7;imaging-desaturate;96;95;96;96;96;95;96;96;96;95 09:25:16 INFO - PROCESS | 23035 | |8;json-parse-financial;69;67;70;68;68;68;68;78;66;67 09:25:16 INFO - PROCESS | 23035 | |9;json-stringify-tinderbox;70;71;72;70;71;71;70;71;71;71 09:25:16 INFO - PROCESS | 23035 | |10;stanford-crypto-aes;85;82;90;91;85;84;84;84;93;85 09:25:16 INFO - PROCESS | 23035 | |11;stanford-crypto-ccm;124;123;123;123;120;134;124;122;132;121 09:25:16 INFO - PROCESS | 23035 | |12;stanford-crypto-pbkdf2;151;143;140;149;152;141;156;152;154;153 09:25:16 INFO - PROCESS | 23035 | |13;stanford-crypto-sha256-iterative;74;72;74;73;73;72;71;72;70;71 09:25:16 INFO - PROCESS | 23035 | __end_tp_report 09:25:16 INFO - PROCESS | 23035 | __start_cc_report 09:25:16 INFO - PROCESS | 23035 | _x_x_mozilla_cycle_collect,1154 09:25:16 INFO - PROCESS | 23035 | __end_cc_report 09:25:16 INFO - PROCESS | 23035 | __startTimestamp1457371516876__endTimestamp 09:25:16 INFO - PROCESS | 23035 | 09:25:16 INFO - PROCESS | 23035 | ------- Summary: start ------- 09:25:16 INFO - PROCESS | 23035 | Number of tests: 14 09:25:16 INFO - PROCESS | 23035 | 09:25:16 INFO - PROCESS | 23035 | [#0] ai-astar Cycles:10 Average:112.00 Median:113.00 stddev:3.53 (3.1%) stddev-sans-first:3.72 09:25:16 INFO - PROCESS | 23035 | Values: 111.0 115.0 110.0 115.0 113.0 114.0 103.0 113.0 113.0 113.0 09:25:16 INFO - PROCESS | 23035 | 09:25:16 INFO - PROCESS | 23035 | [#1] audio-beat-detection Cycles:10 Average:153.70 Median:161.00 stddev:16.87 (10.5%) stddev-sans-first:17.63 09:25:16 INFO - PROCESS | 23035 | Values: 162.0 133.0 158.0 178.0 133.0 165.0 160.0 142.0 172.0 134.0 09:25:16 INFO - PROCESS | 23035 | 09:25:16 INFO - PROCESS | 23035 | [#2] audio-dft Cycles:10 Average:162.00 Median:162.50 stddev:1.49 (0.9%) stddev-sans-first:1.58 09:25:16 INFO - PROCESS | 23035 | Values: 162.0 160.0 162.0 164.0 161.0 160.0 163.0 163.0 161.0 164.0 09:25:16 INFO - PROCESS | 23035 | 09:25:16 INFO - PROCESS | 23035 | [#3] audio-fft Cycles:10 Average:84.20 Median:74.50 stddev:14.28 (19.2%) stddev-sans-first:14.75 09:25:16 INFO - PROCESS | 23035 | Values: 75.0 74.0 98.0 97.0 74.0 73.0 74.0 112.0 92.0 73.0 09:25:16 INFO - PROCESS | 23035 | 09:25:16 INFO - PROCESS | 23035 | [#4] audio-oscillator Cycles:10 Average:109.00 Median:94.50 stddev:23.94 (25.3%) stddev-sans-first:24.77 09:25:16 INFO - PROCESS | 23035 | Values: 94.0 95.0 140.0 94.0 95.0 95.0 156.0 94.0 95.0 132.0 09:25:16 INFO - PROCESS | 23035 | 09:25:16 INFO - PROCESS | 23035 | [#5] imaging-gaussian-blur Cycles:10 Average:117.00 Median:117.00 stddev:0.67 (0.6%) stddev-sans-first:0.71 09:25:16 INFO - PROCESS | 23035 | Values: 117.0 116.0 117.0 116.0 118.0 117.0 117.0 117.0 117.0 118.0 09:25:16 INFO - PROCESS | 23035 | 09:25:16 INFO - PROCESS | 23035 | [#6] imaging-darkroom Cycles:10 Average:146.50 Median:147.00 stddev:0.53 (0.4%) stddev-sans-first:0.53 09:25:16 INFO - PROCESS | 23035 | Values: 146.0 147.0 147.0 147.0 146.0 147.0 147.0 146.0 146.0 146.0 09:25:16 INFO - PROCESS | 23035 | 09:25:16 INFO - PROCESS | 23035 | [#7] imaging-desaturate Cycles:10 Average:95.70 Median:96.00 stddev:0.48 (0.5%) stddev-sans-first:0.50 09:25:16 INFO - PROCESS | 23035 | Values: 96.0 95.0 96.0 96.0 96.0 95.0 96.0 96.0 96.0 95.0 09:25:16 INFO - PROCESS | 23035 | 09:25:16 INFO - PROCESS | 23035 | [#8] json-parse-financial Cycles:10 Average:68.90 Median:68.00 stddev:3.38 (5.0%) stddev-sans-first:3.59 09:25:16 INFO - PROCESS | 23035 | Values: 69.0 67.0 70.0 68.0 68.0 68.0 68.0 78.0 66.0 67.0 09:25:16 INFO - PROCESS | 23035 | 09:25:16 INFO - PROCESS | 23035 | [#9] json-stringify-tinderbox Cycles:10 Average:70.80 Median:71.00 stddev:0.63 (0.9%) stddev-sans-first:0.60 09:25:16 INFO - PROCESS | 23035 | Values: 70.0 71.0 72.0 70.0 71.0 71.0 70.0 71.0 71.0 71.0 09:25:16 INFO - PROCESS | 23035 | 09:25:16 INFO - PROCESS | 23035 | [#10] stanford-crypto-aes Cycles:10 Average:86.30 Median:85.00 stddev:3.65 (4.3%) stddev-sans-first:3.84 09:25:16 INFO - PROCESS | 23035 | Values: 85.0 82.0 90.0 91.0 85.0 84.0 84.0 84.0 93.0 85.0 09:25:16 INFO - PROCESS | 23035 | 09:25:16 INFO - PROCESS | 23035 | [#11] stanford-crypto-ccm Cycles:10 Average:124.60 Median:123.50 stddev:4.62 (3.7%) stddev-sans-first:4.90 09:25:16 INFO - PROCESS | 23035 | Values: 124.0 123.0 123.0 123.0 120.0 134.0 124.0 122.0 132.0 121.0 09:25:16 INFO - PROCESS | 23035 | 09:25:16 INFO - PROCESS | 23035 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:149.10 Median:152.00 stddev:5.70 (3.8%) stddev-sans-first:6.01 09:25:16 INFO - PROCESS | 23035 | Values: 151.0 143.0 140.0 149.0 152.0 141.0 156.0 152.0 154.0 153.0 09:25:16 INFO - PROCESS | 23035 | 09:25:16 INFO - PROCESS | 23035 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:72.20 Median:72.50 stddev:1.32 (1.8%) stddev-sans-first:1.22 09:25:16 INFO - PROCESS | 23035 | Values: 74.0 72.0 74.0 73.0 73.0 72.0 71.0 72.0 70.0 71.0 09:25:16 INFO - PROCESS | 23035 | -------- Summary: end -------- 09:25:16 INFO - PROCESS | 23035 | 09:25:17 INFO - TEST-INFO | 23035: exit 0 09:25:17 INFO - TEST-OK | kraken | took 62709ms 09:25:17 INFO - SUITE-END | took 1180s 09:25:18 INFO - Completed test suite (00:19:40) 09:25:18 INFO - javascript benchmark 09:25:18 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [2557.2414480404614, 2630.4213073123906, 2639.181853625375, 2649.3773963118665, 2670.6261123442714, 4400.97799511002, 4466.6426685865135, 4469.821207151714, 4483.34991426243, 4493.842715504954, 4513.119941611387, 4520.186366454037, 4559.88600284993, 4561.635069194456, 4617.930731039037, 4093.5292441369324, 4150.771707556083, 4171.332586786115, 4200.306949353353, 4209.0, 4144.6684265258855, 4216.620504154625, 4226.239276930151, 4235.258829704805, 4274.7862606869685, 4025.617566331179, 4127.195196936598, 4177.49870015597, 4195.55946625603, 4198.265303571863, 4091.5499295077516, 4094.447249621293, 4101.323281658522, 4126.319157339036, 4136.21411931732, 3955.7033222508426, 4028.3353246714255, 4057.756534607933, 4059.776712280823, 4096.1193343431305, 4343.609075183249, 4407.559244075599, 4451.866444006685, 4464.531224221442, 4496.100779844044, 4834.903301933941, 4842.709437433765, 4844.467108618049, 4846.079244943449, 4864.902701945941, 4657.60410365116, 4849.709017458964, 4866.732329721864, 4868.537488938545, 4904.705717656916, 4508.07584445188, 4510.0979804039325, 4514.7291162530355, 4539.500654927955, 4544.15933052383, 4929.137400954819, 4949.554540091337, 4949.925751113664, 4950.3069570260195, 4994.101061808837, 4601.493835678073, 4745.549172828576, 4768.9523104769205, 4785.3300537924715, 4847.5394837491085, 4826.276058591239, 4839.7096174229655, 4846.61227101831, 4869.63477739171, 4890.731009794425, 4786.521347865255, 4786.856394308176, 4790.712557246577, 4792.137415265216, 4841.95158048422, 4600.148972440109, 4729.125111854318, 4758.547937945889, 4812.687175333592, 4813.205821039559, 4016.578259282792, 4021.3364794809113, 4022.215667944781, 4022.8390864365097, 4041.515018197835, 3554.9466757998653, 3556.5020897074432, 3578.874739384109, 3591.6049234584175, 3607.3506768781344, 4094.3449048152747, 4155.148194620096, 4176.352665336878, 4221.261279276115, 4229.154169166179, 4754.9286760698615, 4793.041391721669, 4796.352492413549, 4797.472278049412, 4837.201861692852, 4134.524529679125, 4135.731177473454, 4137.2552940471005, 4177.081042170717, 4188.141431006637, 4176.9582304176565, 4239.851605193803, 4289.1207302503535, 4290.034742182984, 4330.025744207591, 4608.147492713859, 4616.192166370939, 4630.259158534618, 4630.4443466784205, 4677.695949763254, 4652.511486293891, 4837.733924634038, 4838.250071238964, 4842.104210721028, 4867.902641947212, 4606.124836281096, 4650.0, 4651.5813576778255, 4671.346011558317, 4697.506761789963, 4758.4765675776325, 4770.0, 4770.642201834946, 4777.761111944458, 4791.257355109963, 4714.858554243378, 4831.0, 4832.637552183671, 4844.563989240985, 4876.683015603974, 4692.436907571113, 4713.410823647044, 4714.104320179292, 4714.646401519831, 4754.500777418321, 4712.905741885074, 4713.0338280651695, 4714.976425117852, 4754.667173297836, 4758.976205118952, 4453.955460445354, 4604.539546045368, 4638.6752927294765, 4643.907121857612, 4678.929816052694, 4704.482506924304, 4728.787204575733, 4736.8578942631775, 4763.642726795573, 4782.402199725035, 4633.119707255611, 4633.582977531903, 4641.303804429228, 4677.76611169447, 4685.625149988061], "unit": "score", "name": "dojo.html", "value": 4432.300323763688}, {"lowerIsBetter": false, "replicates": [508.3290057124595, 543.0821910970457, 545.858076900006, 551.162233405224, 558.3049103865687, 32781.0, 33363.0, 33378.8331058345, 33379.83310083452, 33423.0, 35181.2963740725, 35463.645363546355, 35813.64186358135, 35814.8209258954, 35846.0, 7745.922540774576, 7899.447038707292, 7939.166387529284, 7945.245201705829, 7961.562114083723, 7830.138684744674, 7985.441019128663, 7987.640556174986, 7992.560409177493, 7992.920070799276, 7959.442839001273, 8025.6789728410795, 8027.43807933442, 8030.156833532483, 8040.517568945853, 7901.762947111567, 7957.0, 7968.402369822286, 7971.720989765359, 7973.362131029504, 7965.084015338252, 8097.149799271051, 8097.554634495101, 8097.595120244023, 8104.270615644561, 35518.0, 35939.640603594155, 35981.100472488135, 35987.0, 36016.27967440663, 2696.5146273670925, 2736.698963114056, 2758.0622588319866, 2790.330320723032, 2872.0809341010886, 26929.865350673317, 28165.85917070422, 28409.57385639217, 28438.715612844022, 28674.139775806758, 3385.5768028996376, 3403.4384326586082, 3409.6931276185014, 3485.4375214666634, 3506.789592624425, 165239.0, 165913.0, 166160.0, 167541.16229418898, 167913.0, 54754.0, 55460.72269638626, 55503.72248138733, 55561.99942005239, 55775.0, 60191.39808601946, 61154.0, 61209.69395152996, 61219.6939015311, 61259.69370153121, 11966.940165299118, 12148.939255303667, 12164.81752773709, 12183.086268529896, 12187.695307617381, 9447.527623618791, 9550.235981121632, 9567.760805979768, 9574.47340396271, 9580.95209523948, 18577.699561030597, 18613.162407691685, 18733.90633046826, 18766.53083672919, 19611.548556430447, 7553.0, 7727.227277272228, 7781.182975787574, 7806.0, 7806.68773249075, 807.7657479330928, 835.277484975504, 842.6503001254533, 869.4261787220404, 933.0624763498028, 25731.0, 26210.344741381617, 26872.731272687022, 27013.1896043119, 27145.0, 920.9493477858648, 928.4197376639601, 949.7483166960761, 1053.8261186904228, 1055.488088277185, 13581.388837502336, 13801.930990344985, 14077.85922140786, 14119.576412707429, 14161.150330980174, 257419.0, 259141.0, 260467.0, 262232.0, 262254.0, 44762.0, 45428.77285613551, 45507.544924550995, 45549.54450455453, 45557.0, 1046.942418167008, 1127.2053202492223, 1135.3074624479061, 1179.8260730573136, 1181.2381014245934, 23481.765182347957, 23869.164579239645, 25526.744732552437, 25761.484770304865, 25910.222693319232, 34854.82572587121, 35871.64128358683, 36273.81863090667, 36276.45585316275, 36286.45570316395, 171512.0, 171575.0, 171720.0, 171746.0, 171856.0, 23251.651225231297, 27690.0, 28646.0, 28663.140105796858, 28930.855345723136, 33053.17367065843, 40643.390349145375, 40967.795161024005, 42334.7883260594, 42399.788001059795, 33726.83136584301, 35056.298874021864, 35256.64743352636, 35564.28871422609, 35984.460233097045, 31592.526112108797, 32986.0, 33076.83461582677, 33145.83427082849, 33453.0, 32379.676203237665, 32883.0, 32974.34051318912, 33103.172420689676, 33211.16972075718, 29306.413871722874, 29458.26354341073, 29921.0, 29972.550411744276, 30046.24884377908, 23266.418339541648, 23367.298981030595, 23570.764292357544, 23636.763632363458, 23651.0], "unit": "score", "name": "ext.html", "value": 16208.759092624592}, {"lowerIsBetter": false, "replicates": [339.2536419876274, 339.56535634387984, 340.0817791961703, 345.20774821784005, 351.32720839592184, 14455.0, 15181.39274429023, 15723.52829415118, 16348.0, 16370.099644519547, 14810.851891481081, 15028.098314101162, 15252.923735381335, 15661.0, 15718.528444146665, 4904.803807847691, 5096.235564665311, 5100.84697459075, 5112.872178195556, 5119.795208191668, 4965.453800081988, 4984.501549845023, 5093.363329583802, 5098.694078355311, 5099.770510327045, 5077.517635824609, 5087.5421212090905, 5090.77091530882, 5092.363454568179, 5094.083065048289, 4911.189653707134, 4995.175795993657, 5061.063703214917, 5063.645544811846, 5079.034983353151, 4523.321501774727, 4536.228841096989, 4538.500764915857, 4539.160255352737, 4549.795259213343, 18274.17766200511, 18649.813501864945, 19041.429407030013, 19052.333168339042, 19061.714074288895, 1716.1419290354822, 1975.3086419753115, 2086.7078608994752, 2495.538325409805, 2499.262717498324, 11863.288202707865, 11866.363442682257, 11969.700757481045, 12399.0, 12522.37030223654, 1737.5569229846435, 1742.1376418672837, 1757.3585641240984, 1770.8583313334902, 1811.0763510609552, 39494.80252598747, 40141.79929100336, 41203.0, 52754.73622631901, 54341.72829135868, 9023.864642030374, 9046.0, 9161.862572061424, 9282.257419406431, 9312.580933857993, 10701.892981070245, 11709.531618735155, 11715.824262636068, 11725.35510546911, 11730.824037639442, 6271.529635277372, 6419.711112999927, 6529.836754081091, 6538.836529086716, 6541.0, 5959.7914073008105, 5972.731227094791, 6063.605865618721, 6074.301455332693, 6099.024156135086, 5612.579056570774, 5758.856028599319, 5779.162021506858, 5794.710264486759, 5887.175795388649, 1661.900285982845, 1699.269314194908, 1702.0383483331877, 1711.945665201763, 1718.218210714147, 735.3969744809312, 828.8300898315831, 832.9875051874227, 864.3776480933718, 969.7187815533557, 15338.386464541516, 15629.3748250071, 15804.0, 16036.11801350937, 16232.431864884673, 823.567626995832, 831.2518733140101, 843.1442086282428, 844.8901642786399, 901.5402144906145, 8888.288936885163, 8980.326475514232, 9284.303677224236, 9287.674931377369, 9445.763855903657, 234451.0, 376842.0, 384066.0, 384681.0, 386161.0, 66420.0, 66995.3300466989, 68760.6561967187, 69722.65138674376, 70228.29771702217, 848.87266909964, 919.7332773495746, 938.3572253006712, 971.1842052675786, 973.8247115519133, 13185.142965707199, 13407.731845362843, 13580.86419135796, 13747.450101995808, 13763.724725505233, 30426.543601845548, 30659.2335191622, 30960.845195773876, 31602.683973160892, 32206.0, 42860.0, 44305.778471107435, 44351.0, 44422.77788611165, 44857.55142448664, 6663.400293973372, 6827.590344579341, 6904.102466679299, 6907.171139463297, 6963.40811031068, 9822.607095716092, 10848.620298289521, 11074.778504430027, 11432.828507572227, 11440.256383335056, 9370.250379969722, 9518.381305215138, 9674.467904265333, 9797.85303220438, 9959.850602241117, 9513.143817056498, 9533.47565883883, 9588.089131532493, 9615.51922403891, 9765.365251258645, 9553.61785528571, 9663.420194788336, 9715.9028409715, 9859.950700246452, 9944.651937182163, 6884.4148247399535, 7021.438284937295, 7049.083619129686, 7050.506464547432, 7258.491905566771, 9341.626334946526, 10038.799224015333, 10068.496575171359, 10162.593496260066, 10376.0], "unit": "score", "name": "jquery.html", "value": 7698.08698638251}, {"lowerIsBetter": false, "replicates": [1221.3587866370149, 1319.2150670351143, 1331.6138319887234, 1430.9785353219704, 1726.2059452651788, 7007.859842803141, 7150.0, 7151.427885769139, 7169.462290328227, 7170.426365890729, 7009.369156775889, 7144.7499337523195, 7176.174739904913, 7181.353678168964, 7190.101237345332, 1796.4969808453654, 2093.9895300523476, 2124.872507649542, 2152.569486102778, 2154.138344662132, 2168.609650262952, 2183.552371763785, 2185.4099393163838, 2186.256672731271, 2187.3765976696645, 2071.8964051797425, 2109.6308146074452, 2114.9154033838627, 2115.0059472048115, 2115.8730476171404, 2069.7102405663218, 2097.92657256996, 2108.68369744538, 2111.820495257905, 2115.95768084639, 2110.9788902110936, 2135.7010018597252, 2144.07804644003, 2144.7426308842882, 2145.560160167162, 7047.8590428191665, 7059.682314295869, 7074.752383666547, 7091.964540177318, 7098.7515436959975, 4362.650987920959, 4479.686421950465, 4507.842225522091, 4508.030773383738, 4510.481294651125, 2705.526532856762, 2732.699403065661, 2783.067672329772, 2791.092894809195, 2830.660320761501, 864.394923553515, 868.8001759595328, 881.5283823154582, 915.1031988651159, 920.9263258939269, 10028.64899728506, 10123.392596444237, 10138.746531336701, 10139.08748212657, 10140.03669651382, 3909.667678247381, 3935.252302062599, 4019.2363450944813, 4023.637872591481, 4055.634992850599, 8682.348823838238, 8694.652213911499, 8701.17338852808, 8724.825503490021, 8733.995590507046, 3783.1109689223013, 4279.144171165779, 4282.743035417822, 4296.656267498593, 4297.72064815786, 3802.9429558556644, 3844.0774214188395, 3908.609139086069, 3916.921661566753, 3925.3130702127582, 3372.8144952027383, 3450.8274586270586, 3481.112316359363, 3500.68493835556, 3507.964920350764, 1115.2973626615342, 1148.2995372822572, 1148.5463242019355, 1161.5586077290745, 1162.041315914374, 909.3270979475272, 919.5723988345452, 927.1238679447857, 942.6559305853314, 1204.2232759869835, 6732.360425759545, 6787.083743694637, 6846.657667116724, 6861.965690171517, 6868.965655171693, 448.9416375871181, 452.11160070461045, 452.1386758225585, 455.4989511537282, 462.142725244673, 5314.7608357624, 5316.149416093406, 5368.194770784336, 5391.919121213185, 5399.487048730364, 8235.588220588947, 8591.09793471689, 8649.264812490883, 8679.739607811776, 8692.869606955901, 8445.239928406472, 8471.491710497266, 8496.107908669625, 8498.02272738643, 8510.48937063778, 6583.242927063353, 6695.531312808057, 6774.593524388552, 6782.525223234326, 6842.6578671066245, 6832.180138383425, 6874.2782007890455, 6887.5178737487895, 6932.133483314586, 6956.40870526011, 7677.692892284246, 7858.174891636524, 7869.055713314439, 7974.84050319002, 7975.082865470313, 7872.685092596232, 8117.350611950912, 8127.3091787198755, 8144.633491492778, 8278.668853246043, 5499.560035197254, 5589.301337332833, 6109.84725381869, 6342.143810585512, 6483.837904052436, 6870.072540207208, 6882.8623427530165, 6913.274106218774, 6929.930700692928, 6931.549449285781, 6067.302260240129, 6106.755729770937, 6168.784092556739, 6177.042558403455, 6222.782202622887, 5968.522518198621, 6000.669963152069, 6053.0, 6151.0, 6177.660228687465, 6415.615063096229, 6648.301928297459, 6650.3682150195655, 6655.168103987002, 6659.966700166468, 5930.169776231417, 5985.162077309267, 5986.850328741642, 5993.130996005468, 5997.55018373615, 5882.382349853204, 5965.582409231312, 5976.820695379146, 5987.880242395215, 5989.921814073508], "unit": "score", "name": "mootools.html", "value": 4042.537270086082}, {"lowerIsBetter": false, "replicates": [301.90188188838636, 306.1489060412054, 310.1873092497658, 313.11388769781513, 316.14009893090787, 5252.31719876416, 5311.68129912205, 5312.4687531246855, 5351.866203344918, 5396.91904621431, 5280.762365693543, 5284.2866213061225, 5292.629515933877, 5306.097963346231, 5314.282571852798, 3909.335412979786, 4023.1752490739473, 4112.835486580548, 4129.628333449997, 4151.83392664293, 4116.9794151029355, 4128.69034822388, 4140.23405669952, 4140.441040459529, 4151.667866570682, 4089.141280331134, 4107.363358679395, 4110.794460276989, 4113.321301985184, 4120.546739858628, 3865.246276975991, 3985.581513941038, 4046.5346485153996, 4102.200070986159, 4111.671066314688, 3588.1747198144312, 3599.7300202484657, 3600.0, 3603.5675718913635, 3603.7117030637487, 5070.011347787183, 5099.898002039976, 5105.897882042338, 5109.1059064663905, 5114.0, 4776.283557466373, 4782.187028205179, 4782.426108866924, 4786.7845946932475, 4789.2097803862325, 5575.665460072409, 5588.133839254922, 5601.29983752031, 5607.635503692247, 5609.326880774333, 3997.600239976008, 4002.8198731057173, 4003.559608443069, 4006.8196931137877, 4009.679225661969, 5666.1784041314195, 5859.7656093756195, 5899.882002359972, 5904.704764761745, 5917.585768996172, 3922.431247469101, 3973.443717879499, 3977.184677141237, 3977.443157957888, 3979.9204015919518, 4038.4548086008012, 4041.373587094005, 4042.3734321180264, 4042.959570404317, 4045.0, 4642.51253618372, 4649.139909116824, 4650.813967441332, 4652.55800698933, 4654.930176047362, 5566.944330556643, 5569.443055694398, 5573.470520300646, 5582.8325150245555, 5585.748641311151, 1407.6480879780056, 1431.0984080029514, 1431.8568143185598, 1432.4055516960552, 1433.5770947570493, 882.8455020371409, 913.2830727878717, 942.2085448223526, 968.912797848183, 974.541965276319, 4736.621070314367, 4786.042791441726, 4810.855674329776, 4870.14772414826, 4960.503949605083, 5888.823335299948, 5906.084556893602, 5929.288485381781, 5934.8813023739285, 5962.314333851576, 4945.2087665973995, 4948.812285051562, 4949.975250123798, 4951.405831300267, 4959.256111583291, 3120.5163199704084, 3136.702013308732, 3162.2410621450686, 3164.8892288769784, 3164.984175079156, 5570.6657600544095, 5578.609497335147, 5581.134924086773, 5581.162825576115, 5586.497215250566, 5978.55160862937, 6039.396060393926, 6047.818565443044, 6048.274207095177, 6051.515878729691, 5524.14375771756, 5563.443655634485, 5595.04884169684, 5598.384177740527, 5600.887982240332, 5883.235179426647, 5890.175375447355, 5893.5874488785375, 5896.941030589639, 5903.26209223847, 5692.829215123553, 5713.771449141987, 5725.370209277059, 5726.312842458931, 5736.942630573641, 5415.5938304626525, 5567.4432556744005, 5585.832425027255, 5595.524380427709, 5595.832125036255, 4007.6593489553716, 4014.6186112319283, 4015.598440155961, 4016.4376987222395, 4019.537753158424, 5836.562257830595, 5873.853153671193, 5876.794312199224, 5882.941170588239, 5886.117082437669, 5624.606277560531, 5647.124695672177, 5648.689322087324, 5663.150527420919, 5669.461401166883, 5647.0964645656495, 5649.745761440828, 5650.265465489624, 5652.039153343859, 5658.094704847204, 5408.918866217088, 5519.917201241904, 5536.058869992031, 5544.695041772741, 5566.944330556643, 5697.487226149667, 5713.914291285717, 5721.685307308138, 5727.8854422912145, 5731.111677689964, 5545.889082218252, 5554.305711786027, 5569.331680198402, 5569.412717375529, 5571.052921003358], "unit": "score", "name": "prototype.html", "value": 4219.1078709134545}, {"lowerIsBetter": false, "replicates": [589.9144624029514, 632.3518393646511, 662.9701663425145, 666.1805978646265, 699.5592776550773, 11222.0, 11341.829872551918, 11356.943215283913, 11359.432028398589, 11373.772524549504, 11303.491342889569, 11370.204085714004, 11471.082313414927, 11480.540778368855, 11489.482973266202, 772.0735117858565, 786.6224212378062, 787.6455594982252, 787.8936343593599, 788.0425283280813, 780.6135962698472, 783.4633276205789, 785.1049803224329, 785.721069020498, 787.2127872127872, 806.6007326373453, 818.6848063495538, 819.8647223208163, 820.5856042698459, 822.042320696388, 817.750586071248, 818.8034871630825, 819.3486178488116, 824.2087595907935, 827.4828232354778, 614.6281499692711, 615.1756646094256, 615.796787060269, 616.2666426951913, 616.3866952382408, 11289.491972861159, 11318.377489238088, 11340.0, 11346.489407976578, 11368.488418021208, 11780.293182409083, 11955.103367247404, 12269.93865030678, 12365.134440589163, 12443.688907777287, 9190.54047297639, 9301.767455813591, 9357.064293570656, 9385.249180065579, 9413.294002949806, 3201.535777312277, 3231.8222497762613, 3251.0896948854124, 3272.280098378353, 3310.3213841162506, 39394.409083863764, 39476.60523394787, 39831.8008409959, 39859.20281594352, 39988.800055999825, 9217.170454659114, 9252.814943701089, 9465.716028519155, 9470.526473676426, 9562.521873906277, 16862.072586007886, 16915.577110572332, 17130.743038854427, 17137.314507419815, 17213.7417938731, 6412.61524308543, 6535.803925882231, 6590.044443555754, 6608.537402381787, 6742.325767423316, 3484.77348972316, 3585.2829434113282, 3599.3161299353037, 3634.200475895299, 3641.10792855752, 2554.310336209213, 2577.76800087993, 2591.183777110204, 2598.7920966323027, 2605.9087931922672, 466.2958932012618, 479.91601469742653, 485.7231378114511, 488.9071076495454, 496.5183771741405, 566.7732906837216, 568.815135081092, 573.9913901291484, 580.2282963658324, 581.7934633205151, 7475.738349157753, 7499.737509187262, 7643.7324693635455, 7728.536287822749, 7758.107817600935, 546.4562760053692, 568.1307599372966, 578.482258378757, 585.2508788750406, 596.6151832068379, 3387.5765529308837, 3486.89539313821, 3582.3372676055014, 3591.892243232707, 3611.1513794258326, 45363.0, 46548.301775473396, 46651.0, 46846.76576617095, 46931.29603055957, 38376.0, 42349.78825105855, 43361.56638433639, 43464.78267608642, 48294.75852620785, 39570.406443902786, 39578.40632390516, 39642.60357396389, 39897.60102398997, 39973.0, 7198.136223653195, 7589.43079269046, 7674.8081297968, 7899.565523896241, 7945.8410831781885, 29274.414511710074, 29288.0, 29743.10770676883, 29986.400271994873, 30503.847480762455, 34717.652823472454, 35194.120146995505, 37901.0, 37974.0, 38305.6169438302, 10647.148228141576, 10687.625933092304, 10736.51685674131, 10828.971247731453, 10834.295770774874, 10753.677389678322, 11004.0, 11401.429928503707, 11436.714082148013, 11476.540938362707, 10370.481475926324, 10451.477426128815, 10742.51658675377, 10837.566497340018, 11117.777644447227, 9754.317197796086, 9850.014998500093, 10192.439415832201, 10265.281430299807, 10550.788984220118, 10294.845577316497, 10660.466976650981, 10953.288036277616, 10992.945035274772, 11011.559537618727, 8112.02655681322, 8150.2664760171865, 8162.632681529227, 8581.65673373058, 8606.225439710455, 8245.628946697292, 8445.788855278668, 8487.915120848713, 8899.866502002606, 8900.510471924106], "unit": "score", "name": "yui.html", "value": 5626.207456594695}], "name": "dromaeo_css", "value": 6130.312871766032}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [111.0, 115.0, 110.0, 115.0, 113.0, 114.0, 103.0, 113.0, 113.0, 113.0], "unit": "score", "name": "ai-astar", "value": 112.0}, {"lowerIsBetter": true, "replicates": [162.0, 133.0, 158.0, 178.0, 133.0, 165.0, 160.0, 142.0, 172.0, 134.0], "unit": "score", "name": "audio-beat-detection", "value": 153.7}, {"lowerIsBetter": true, "replicates": [162.0, 160.0, 162.0, 164.0, 161.0, 160.0, 163.0, 163.0, 161.0, 164.0], "unit": "score", "name": "audio-dft", "value": 162.0}, {"lowerIsBetter": true, "replicates": [75.0, 74.0, 98.0, 97.0, 74.0, 73.0, 74.0, 112.0, 92.0, 73.0], "unit": "score", "name": "audio-fft", "value": 84.2}, {"lowerIsBetter": true, "replicates": [94.0, 95.0, 140.0, 94.0, 95.0, 95.0, 156.0, 94.0, 95.0, 132.0], "unit": "score", "name": "audio-oscillator", "value": 109.0}, {"lowerIsBetter": true, "replicates": [117.0, 116.0, 117.0, 116.0, 118.0, 117.0, 117.0, 117.0, 117.0, 118.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 117.0}, {"lowerIsBetter": true, "replicates": [146.0, 147.0, 147.0, 147.0, 146.0, 147.0, 147.0, 146.0, 146.0, 146.0], "unit": "score", "name": "imaging-darkroom", "value": 146.5}, {"lowerIsBetter": true, "replicates": [96.0, 95.0, 96.0, 96.0, 96.0, 95.0, 96.0, 96.0, 96.0, 95.0], "unit": "score", "name": "imaging-desaturate", "value": 95.7}, {"lowerIsBetter": true, "replicates": [69.0, 67.0, 70.0, 68.0, 68.0, 68.0, 68.0, 78.0, 66.0, 67.0], "unit": "score", "name": "json-parse-financial", "value": 68.9}, {"lowerIsBetter": true, "replicates": [70.0, 71.0, 72.0, 70.0, 71.0, 71.0, 70.0, 71.0, 71.0, 71.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 70.8}, {"lowerIsBetter": true, "replicates": [85.0, 82.0, 90.0, 91.0, 85.0, 84.0, 84.0, 84.0, 93.0, 85.0], "unit": "score", "name": "stanford-crypto-aes", "value": 86.3}, {"lowerIsBetter": true, "replicates": [124.0, 123.0, 123.0, 123.0, 120.0, 134.0, 124.0, 122.0, 132.0, 121.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 124.6}, {"lowerIsBetter": true, "replicates": [151.0, 143.0, 140.0, 149.0, 152.0, 141.0, 156.0, 152.0, 154.0, 153.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 149.1}, {"lowerIsBetter": true, "replicates": [74.0, 72.0, 74.0, 73.0, 73.0, 72.0, 71.0, 72.0, 70.0, 71.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 72.2}], "name": "kraken", "value": 1551.9999999999998}]} 09:25:18 INFO - Return code: 0 09:25:18 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 09:25:18 INFO - # TBPL SUCCESS # 09:25:18 INFO - Running post-action listener: _resource_record_post_action 09:25:18 INFO - Running post-run listener: _resource_record_post_run 09:25:19 INFO - Total resource usage - Wall time: 1197s; CPU: 13.0%; Read bytes: 4096; Write bytes: 539377664; Read time: 8; Write time: 714976 09:25:19 INFO - install - Wall time: 16s; CPU: 15.0%; Read bytes: 0; Write bytes: 249905152; Read time: 0; Write time: 449368 09:25:19 INFO - run-tests - Wall time: 1182s; CPU: 13.0%; Read bytes: 4096; Write bytes: 289472512; Read time: 8; Write time: 265608 09:25:19 INFO - Running post-run listener: _upload_blobber_files 09:25:19 INFO - Blob upload gear active. 09:25:19 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 09:25:19 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 09:25:19 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Fx-Team-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 09:25:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Fx-Team-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 09:25:19 INFO - (blobuploader) - INFO - Open directory for files ... 09:25:19 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 09:25:19 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:25:19 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:25:20 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 09:25:20 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:25:20 INFO - (blobuploader) - INFO - Done attempting. 09:25:20 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 09:25:20 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:25:20 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:25:21 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 09:25:21 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:25:21 INFO - (blobuploader) - INFO - Done attempting. 09:25:21 INFO - (blobuploader) - INFO - Iteration through files over. 09:25:21 INFO - Return code: 0 09:25:21 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 09:25:21 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 09:25:21 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/98b787956bf152c1a0205731d1d3e30af119818a29605195ece167011a51ed0cc80fdbebcf9cbd6edb2521d0cfb9213011a310c105b6e985d116704cd31af280", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/19e5c7dbfaf852ef917b410b7d36fc236da0a6114771724ff7226ac423d1b69a2184cd601362af20cee34db4fba3364d229d3930769a2feb565514c5e8b800e9"} 09:25:21 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 09:25:21 INFO - Writing to file /builds/slave/test/properties/blobber_files 09:25:21 INFO - Contents: 09:25:21 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/98b787956bf152c1a0205731d1d3e30af119818a29605195ece167011a51ed0cc80fdbebcf9cbd6edb2521d0cfb9213011a310c105b6e985d116704cd31af280", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/19e5c7dbfaf852ef917b410b7d36fc236da0a6114771724ff7226ac423d1b69a2184cd601362af20cee34db4fba3364d229d3930769a2feb565514c5e8b800e9"} 09:25:21 INFO - Running post-run listener: copy_logs_to_upload_dir 09:25:21 INFO - Copying logs to upload dir... 09:25:21 INFO - mkdir: /builds/slave/test/build/upload/logs 09:25:21 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1233.534123 ========= master_lag: -0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 33 secs) (at 2016-03-07 09:25:18.927515) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-03-07 09:25:18.931008) ========= 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=1861a34ebfea852630dec091000001fa-1457370210.916850-397263336 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/98b787956bf152c1a0205731d1d3e30af119818a29605195ece167011a51ed0cc80fdbebcf9cbd6edb2521d0cfb9213011a310c105b6e985d116704cd31af280", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/19e5c7dbfaf852ef917b410b7d36fc236da0a6114771724ff7226ac423d1b69a2184cd601362af20cee34db4fba3364d229d3930769a2feb565514c5e8b800e9"} build_url:https://queue.taskcluster.net/v1/task/CaF8lg2sSMWTIJP7hX9rwg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011314 build_url: 'https://queue.taskcluster.net/v1/task/CaF8lg2sSMWTIJP7hX9rwg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/98b787956bf152c1a0205731d1d3e30af119818a29605195ece167011a51ed0cc80fdbebcf9cbd6edb2521d0cfb9213011a310c105b6e985d116704cd31af280", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/19e5c7dbfaf852ef917b410b7d36fc236da0a6114771724ff7226ac423d1b69a2184cd601362af20cee34db4fba3364d229d3930769a2feb565514c5e8b800e9"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-03-07 09:25:18.955294) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-03-07 09:25:18.955580) ========= 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=1861a34ebfea852630dec091000001fa-1457370210.916850-397263336 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004465 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-03-07 09:25:19.039303) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-07 09:25:19.039608) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-07 09:25:19.039896) ========= ========= Total master_lag: 0.66 =========