builder: fx-team_ubuntu64_hw_test-dromaeojs slave: talos-linux64-ix-032 starttime: 1459275851.16 results: success (0) buildid: 20160329104135 builduid: 504145ff48c64edc8f3f1596614c10da revision: 1e908cdc6c424be15d00ddefa9667f9b07531ccb ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-03-29 11:24:11.162923) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-03-29 11:24:11.163314) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-29 11:24:11.163753) ========= 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=745a4373a2a16df560f216e000000264-1459275715.420491-752098626 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test program finished with exit code 0 elapsedTime=0.006380 basedir: '/builds/slave/test' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-29 11:24:11.192016) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-03-29 11:24:11.192323) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-03-29 11:24:11.253494) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-29 11:24:11.253788) ========= 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=745a4373a2a16df560f216e000000264-1459275715.420491-752098626 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004622 ========= master_lag: 0.07 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-29 11:24:11.324912) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-29 11:24:11.325242) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-29 11:24:11.325556) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-29 11:24:11.325836) ========= 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=745a4373a2a16df560f216e000000264-1459275715.420491-752098626 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-03-29 11:24:11-- 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% 228M=0s 2016-03-29 11:24:11 (228 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.110633 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-29 11:24:11.448995) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-29 11:24:11.449268) ========= 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=745a4373a2a16df560f216e000000264-1459275715.420491-752098626 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.017336 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-29 11:24:11.498121) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-29 11:24:11.498439) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 1e908cdc6c424be15d00ddefa9667f9b07531ccb --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 1e908cdc6c424be15d00ddefa9667f9b07531ccb --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=745a4373a2a16df560f216e000000264-1459275715.420491-752098626 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-03-29 11:24:11,748 truncating revision to first 12 chars 2016-03-29 11:24:11,748 Setting DEBUG logging. 2016-03-29 11:24:11,749 attempt 1/10 2016-03-29 11:24:11,749 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/1e908cdc6c42?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-03-29 11:24:12,006 unpacking tar archive at: fx-team-1e908cdc6c42/testing/mozharness/ program finished with exit code 0 elapsedTime=0.552772 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-29 11:24:12.065789) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-29 11:24:12.066116) ========= echo 1e908cdc6c424be15d00ddefa9667f9b07531ccb in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'1e908cdc6c424be15d00ddefa9667f9b07531ccb'] 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=745a4373a2a16df560f216e000000264-1459275715.420491-752098626 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 1e908cdc6c424be15d00ddefa9667f9b07531ccb program finished with exit code 0 elapsedTime=0.004456 script_repo_revision: '1e908cdc6c424be15d00ddefa9667f9b07531ccb' ========= master_lag: 0.05 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-29 11:24:12.118051) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-29 11:24:12.118333) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-29 11:24:12.128117) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 48 secs) (at 2016-03-29 11:24:12.128407) ========= /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=745a4373a2a16df560f216e000000264-1459275715.420491-752098626 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 11:24:12 INFO - MultiFileLogger online at 20160329 11:24:12 in /builds/slave/test 11:24:12 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 11:24:12 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 11:24:12 INFO - {'append_to_log': False, 11:24:12 INFO - 'base_work_dir': '/builds/slave/test', 11:24:12 INFO - 'blob_upload_branch': 'Fx-Team-Non-PGO', 11:24:12 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 11:24:12 INFO - 'branch': 'Fx-Team-Non-PGO', 11:24:12 INFO - 'buildbot_json_path': 'buildprops.json', 11:24:12 INFO - 'config_files': ('talos/linux_config.py',), 11:24:12 INFO - 'default_actions': ('clobber', 11:24:12 INFO - 'read-buildbot-config', 11:24:12 INFO - 'download-and-extract', 11:24:12 INFO - 'populate-webroot', 11:24:12 INFO - 'create-virtualenv', 11:24:12 INFO - 'install', 11:24:12 INFO - 'run-tests'), 11:24:12 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 11:24:12 INFO - 'download_minidump_stackwalk': True, 11:24:12 INFO - 'download_symbols': 'ondemand', 11:24:12 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 11:24:12 INFO - 'tooltool.py': '/tools/tooltool.py', 11:24:12 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 11:24:12 INFO - '/tools/misc-python/virtualenv.py')}, 11:24:12 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 11:24:12 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 11:24:12 INFO - 'installer_path': 'installer.exe', 11:24:12 INFO - 'log_level': 'info', 11:24:12 INFO - 'log_name': 'talos', 11:24:12 INFO - 'log_to_console': True, 11:24:12 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 11:24:12 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 11:24:12 INFO - 'opt_config_files': (), 11:24:12 INFO - 'pip_index': False, 11:24:12 INFO - 'sps_profile': False, 11:24:12 INFO - 'sps_profile_interval': 0, 11:24:12 INFO - 'suite': 'dromaeojs', 11:24:12 INFO - 'system_bits': '32', 11:24:12 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 11:24:12 INFO - 'title': 'talos-linux64-ix-032', 11:24:12 INFO - 'tooltool_cache': '/builds/tooltool_cache', 11:24:12 INFO - 'use_talos_json': True, 11:24:12 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 11:24:12 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 11:24:12 INFO - 'work_dir': 'build'} 11:24:12 INFO - ##### 11:24:12 INFO - ##### Running clobber step. 11:24:12 INFO - ##### 11:24:12 INFO - Running pre-action listener: _resource_record_pre_action 11:24:12 INFO - Running main action method: clobber 11:24:12 INFO - rmtree: /builds/slave/test/build 11:24:12 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 11:24:13 INFO - Running post-action listener: _resource_record_post_action 11:24:13 INFO - ##### 11:24:13 INFO - ##### Running read-buildbot-config step. 11:24:13 INFO - ##### 11:24:13 INFO - Running pre-action listener: _resource_record_pre_action 11:24:13 INFO - Running main action method: read_buildbot_config 11:24:13 INFO - Using buildbot properties: 11:24:13 INFO - { 11:24:13 INFO - "project": "", 11:24:13 INFO - "product": "firefox", 11:24:13 INFO - "script_repo_revision": "production", 11:24:13 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs", 11:24:13 INFO - "repository": "", 11:24:13 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team talos dromaeojs", 11:24:13 INFO - "buildid": "20160329104135", 11:24:13 INFO - "pgo_build": "False", 11:24:13 INFO - "basedir": "/builds/slave/test", 11:24:13 INFO - "buildnumber": 2715, 11:24:13 INFO - "slavename": "talos-linux64-ix-032", 11:24:13 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 11:24:13 INFO - "platform": "ubuntu64_hw", 11:24:13 INFO - "scheduler": "tests-fx-team-linux64-talos", 11:24:13 INFO - "branch": "fx-team", 11:24:13 INFO - "repo_path": "integration/fx-team", 11:24:13 INFO - "revision": "1e908cdc6c424be15d00ddefa9667f9b07531ccb", 11:24:13 INFO - "stage_platform": "linux64", 11:24:13 INFO - "builduid": "504145ff48c64edc8f3f1596614c10da", 11:24:13 INFO - "slavebuilddir": "test" 11:24:13 INFO - } 11:24:13 INFO - Found installer url https://queue.taskcluster.net/v1/task/XLewxWcOS4eHcaHfEAyOLA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2. 11:24:13 INFO - Running post-action listener: _resource_record_post_action 11:24:13 INFO - ##### 11:24:13 INFO - ##### Running download-and-extract step. 11:24:13 INFO - ##### 11:24:13 INFO - Running pre-action listener: _resource_record_pre_action 11:24:13 INFO - Running main action method: download_and_extract 11:24:13 INFO - mkdir: /builds/slave/test/build/tests 11:24:13 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')]} 11:24:13 INFO - https://queue.taskcluster.net/v1/task/XLewxWcOS4eHcaHfEAyOLA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 11:24:13 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XLewxWcOS4eHcaHfEAyOLA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 11:24:13 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XLewxWcOS4eHcaHfEAyOLA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 11:24:13 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XLewxWcOS4eHcaHfEAyOLA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 11:24:13 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XLewxWcOS4eHcaHfEAyOLA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 11:24:15 INFO - Downloaded 1361 bytes. 11:24:15 INFO - Reading from file /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 11:24:15 INFO - Using the following test package requirements: 11:24:15 INFO - {u'common': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'], 11:24:15 INFO - u'cppunittest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 11:24:15 INFO - u'firefox-48.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 11:24:15 INFO - u'gtest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 11:24:15 INFO - u'firefox-48.0a1.en-US.linux-x86_64.gtest.tests.zip'], 11:24:15 INFO - u'jittest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 11:24:15 INFO - u'jsshell-linux-x86_64.zip'], 11:24:15 INFO - u'mochitest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 11:24:15 INFO - u'firefox-48.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 11:24:15 INFO - u'mozbase': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'], 11:24:15 INFO - u'reftest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 11:24:15 INFO - u'firefox-48.0a1.en-US.linux-x86_64.reftest.tests.zip'], 11:24:15 INFO - u'talos': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 11:24:15 INFO - u'firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'], 11:24:15 INFO - u'web-platform': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 11:24:15 INFO - u'firefox-48.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 11:24:15 INFO - u'xpcshell': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 11:24:15 INFO - u'firefox-48.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 11:24:15 INFO - Downloading packages: [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 11:24:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:24:15 INFO - https://queue.taskcluster.net/v1/task/XLewxWcOS4eHcaHfEAyOLA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 11:24:15 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XLewxWcOS4eHcaHfEAyOLA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 11:24:15 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XLewxWcOS4eHcaHfEAyOLA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 11:24:15 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XLewxWcOS4eHcaHfEAyOLA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 11:24:15 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XLewxWcOS4eHcaHfEAyOLA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 11:24:16 INFO - Downloaded 22100669 bytes. 11:24:16 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 11:24:16 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 11:24:17 INFO - Return code: 0 11:24:17 INFO - Downloading packages: [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 11:24: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')]} 11:24:17 INFO - https://queue.taskcluster.net/v1/task/XLewxWcOS4eHcaHfEAyOLA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 11:24:17 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XLewxWcOS4eHcaHfEAyOLA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 11:24:17 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XLewxWcOS4eHcaHfEAyOLA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 11:24:17 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XLewxWcOS4eHcaHfEAyOLA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 11:24:17 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XLewxWcOS4eHcaHfEAyOLA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 11:24:29 INFO - Downloaded 22100669 bytes. 11:24:29 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 11:24:29 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 11:24:30 INFO - Return code: 0 11:24:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:24:30 INFO - https://queue.taskcluster.net/v1/task/XLewxWcOS4eHcaHfEAyOLA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 11:24:30 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XLewxWcOS4eHcaHfEAyOLA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 11:24:30 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XLewxWcOS4eHcaHfEAyOLA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 11:24:30 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XLewxWcOS4eHcaHfEAyOLA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 11:24:30 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XLewxWcOS4eHcaHfEAyOLA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 11:24:31 INFO - Downloaded 10847531 bytes. 11:24:31 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 11:24:31 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 11:24:31 INFO - Return code: 0 11:24:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:24:31 INFO - https://queue.taskcluster.net/v1/task/XLewxWcOS4eHcaHfEAyOLA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 11:24:31 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XLewxWcOS4eHcaHfEAyOLA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 11:24:31 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XLewxWcOS4eHcaHfEAyOLA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 11:24:31 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XLewxWcOS4eHcaHfEAyOLA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 11:24:31 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/XLewxWcOS4eHcaHfEAyOLA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 11:24:33 INFO - Downloaded 54253935 bytes. 11:24:33 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/XLewxWcOS4eHcaHfEAyOLA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 11:24:33 INFO - mkdir: /builds/slave/test/properties 11:24:33 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 11:24:33 INFO - Writing to file /builds/slave/test/properties/build_url 11:24:33 INFO - Contents: 11:24:33 INFO - build_url:https://queue.taskcluster.net/v1/task/XLewxWcOS4eHcaHfEAyOLA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 11:24:34 INFO - Running post-action listener: _resource_record_post_action 11:24:34 INFO - Running post-action listener: set_extra_try_arguments 11:24:34 INFO - ##### 11:24:34 INFO - ##### Running populate-webroot step. 11:24:34 INFO - ##### 11:24:34 INFO - Running pre-action listener: _resource_record_pre_action 11:24:34 INFO - Running main action method: populate_webroot 11:24:34 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 11:24:34 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 11:24:34 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 11:24:34 INFO - '--tppagecycles', 11:24:34 INFO - '7'], 11:24:34 INFO - 'tests': ['tsvgm']}}, 11:24:34 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 11:24:34 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 11:24:34 INFO - 'tests': ['tresize', 'tcanvasmark']}, 11:24:34 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 11:24:34 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 11:24:34 INFO - 'tests': ['dromaeo_css', 'kraken']}, 11:24:34 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:24:34 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 11:24:34 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:24:34 INFO - 'talos_options': ['--e10s'], 11:24:34 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 11:24:34 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:24:34 INFO - 'tests': ['damp', 'tps']}, 11:24:34 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:24:34 INFO - 'talos_options': ['--e10s'], 11:24:34 INFO - 'tests': ['damp', 'tps']}, 11:24:34 INFO - 'g3': {'tests': ['dromaeo_dom']}, 11:24:34 INFO - 'g3-e10s': {'talos_options': ['--e10s'], 11:24:34 INFO - 'tests': ['dromaeo_dom']}, 11:24:34 INFO - 'other': {'tests': ['a11yr', 11:24:34 INFO - 'ts_paint', 11:24:34 INFO - 'tpaint', 11:24:34 INFO - 'sessionrestore', 11:24:34 INFO - 'sessionrestore_no_auto_restore', 11:24:34 INFO - 'tabpaint']}, 11:24:34 INFO - 'other-e10s': {'talos_options': ['--e10s'], 11:24:34 INFO - 'tests': ['a11yr', 11:24:34 INFO - 'ts_paint', 11:24:34 INFO - 'tpaint', 11:24:34 INFO - 'sessionrestore', 11:24:34 INFO - 'sessionrestore_no_auto_restore', 11:24:34 INFO - 'tabpaint']}, 11:24:34 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 11:24:34 INFO - 'tests': ['a11yr', 11:24:34 INFO - 'ts_paint', 11:24:34 INFO - 'tpaint', 11:24:34 INFO - 'sessionrestore', 11:24:34 INFO - 'sessionrestore_no_auto_restore', 11:24:34 INFO - 'tabpaint']}, 11:24:34 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 11:24:34 INFO - 'tests': ['a11yr', 11:24:34 INFO - 'ts_paint', 11:24:34 INFO - 'tpaint', 11:24:34 INFO - 'sessionrestore', 11:24:34 INFO - 'sessionrestore_no_auto_restore', 11:24:34 INFO - 'tabpaint']}, 11:24:34 INFO - 'other_l64': {'tests': ['a11yr', 11:24:34 INFO - 'ts_paint', 11:24:34 INFO - 'tpaint', 11:24:34 INFO - 'sessionrestore', 11:24:34 INFO - 'sessionrestore_no_auto_restore', 11:24:34 INFO - 'tabpaint']}, 11:24:34 INFO - 'other_nol64': {'tests': ['a11yr', 11:24:34 INFO - 'ts_paint', 11:24:34 INFO - 'tpaint', 11:24:34 INFO - 'sessionrestore', 11:24:34 INFO - 'sessionrestore_no_auto_restore', 11:24:34 INFO - 'tabpaint']}, 11:24:34 INFO - 'svgr': {'tests': ['tsvgx', 11:24:34 INFO - 'tsvgr_opacity', 11:24:34 INFO - 'tart', 11:24:34 INFO - 'tscrollx', 11:24:34 INFO - 'cart']}, 11:24:34 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 11:24:34 INFO - 'tests': ['tsvgx', 11:24:34 INFO - 'tsvgr_opacity', 11:24:34 INFO - 'tart', 11:24:34 INFO - 'tscrollx', 11:24:34 INFO - 'cart']}, 11:24:34 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:24:34 INFO - 'tests': ['tp5o']}, 11:24:34 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:24:34 INFO - 'talos_options': ['--e10s'], 11:24:34 INFO - 'tests': ['tp5o']}, 11:24:34 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:24:34 INFO - 'talos_options': ['--xperf_path', 11:24:34 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 11:24:34 INFO - 'tests': ['tp5n']}, 11:24:34 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:24:34 INFO - 'talos_options': ['--e10s', 11:24:34 INFO - '--xperf_path', 11:24:34 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 11:24:34 INFO - 'tests': ['tp5n']}}, 11:24:34 INFO - 'talos.zip': {'path': '', 11:24:34 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 11:24:34 INFO - Running post-action listener: _resource_record_post_action 11:24:34 INFO - ##### 11:24:34 INFO - ##### Running create-virtualenv step. 11:24:34 INFO - ##### 11:24:34 INFO - Running pre-action listener: _resource_record_pre_action 11:24:34 INFO - Running main action method: create_virtualenv 11:24:34 INFO - Creating virtualenv /builds/slave/test/build/venv 11:24:34 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 11:24:34 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 11:24:34 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 11:24:34 INFO - Using real prefix '/usr' 11:24:34 INFO - New python executable in /builds/slave/test/build/venv/bin/python 11:24:35 INFO - Installing distribute.............................................................................................................................................................................................done. 11:24:37 INFO - Installing pip.................done. 11:24:37 INFO - Return code: 0 11:24:37 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 11:24:37 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')]} 11:24:37 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:24:37 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:24:37 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')]} 11:24:37 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:24:37 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:24:37 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 0x7f2c2f0a6f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28228a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x28ed5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x297c410>, '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 0x297d310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x297d7a0>, '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': '745a4373a2a16df560f216e000000264-1459275715.420491-752098626', '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 11:24:37 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 11:24:37 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 11:24:37 INFO - Using env: {'DISPLAY': ':0', 11:24:37 INFO - 'HOME': '/home/cltbld', 11:24:37 INFO - 'LANG': 'en_US.UTF-8', 11:24:37 INFO - 'LANGUAGE': 'en_US:en', 11:24:37 INFO - 'LOGNAME': 'cltbld', 11:24:37 INFO - 'MAIL': '/var/mail/cltbld', 11:24:37 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:24:37 INFO - 'MOZ_NO_REMOTE': '1', 11:24:37 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:24:37 INFO - 'NO_EM_RESTART': '1', 11:24:37 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:24:37 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:24:37 INFO - 'PWD': '/builds/slave/test', 11:24:37 INFO - 'SHELL': '/bin/bash', 11:24:37 INFO - 'SHLVL': '1', 11:24:37 INFO - 'TERM': 'linux', 11:24:37 INFO - 'TMOUT': '86400', 11:24:37 INFO - 'USER': 'cltbld', 11:24:37 INFO - 'XDG_SESSION_COOKIE': '745a4373a2a16df560f216e000000264-1459275715.420491-752098626', 11:24:37 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:24:37 INFO - '_': '/tools/buildbot/bin/python'} 11:24:37 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:24:37 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 11:24:37 INFO - Cleaning up... 11:24:37 INFO - Return code: 0 11:24:37 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 11:24:37 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')]} 11:24:37 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:24:37 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:24:37 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')]} 11:24:37 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:24:37 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:24:37 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 0x7f2c2f0a6f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28228a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x28ed5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x297c410>, '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 0x297d310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x297d7a0>, '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': '745a4373a2a16df560f216e000000264-1459275715.420491-752098626', '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 11:24:37 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 11:24:37 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 11:24:37 INFO - Using env: {'DISPLAY': ':0', 11:24:37 INFO - 'HOME': '/home/cltbld', 11:24:37 INFO - 'LANG': 'en_US.UTF-8', 11:24:37 INFO - 'LANGUAGE': 'en_US:en', 11:24:37 INFO - 'LOGNAME': 'cltbld', 11:24:37 INFO - 'MAIL': '/var/mail/cltbld', 11:24:37 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:24:37 INFO - 'MOZ_NO_REMOTE': '1', 11:24:37 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:24:37 INFO - 'NO_EM_RESTART': '1', 11:24:37 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:24:37 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:24:37 INFO - 'PWD': '/builds/slave/test', 11:24:37 INFO - 'SHELL': '/bin/bash', 11:24:37 INFO - 'SHLVL': '1', 11:24:37 INFO - 'TERM': 'linux', 11:24:37 INFO - 'TMOUT': '86400', 11:24:37 INFO - 'USER': 'cltbld', 11:24:37 INFO - 'XDG_SESSION_COOKIE': '745a4373a2a16df560f216e000000264-1459275715.420491-752098626', 11:24:37 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:24:37 INFO - '_': '/tools/buildbot/bin/python'} 11:24:37 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:24:37 INFO - Downloading/unpacking psutil>=0.7.1 11:24:37 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 11:24:37 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 11:24:37 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 11:24:37 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 11:24:37 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 11:24:37 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 11:24:39 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 11:24:39 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 11:24:39 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 11:24:39 INFO - Installing collected packages: psutil 11:24:39 INFO - Running setup.py install for psutil 11:24:39 INFO - building 'psutil._psutil_linux' extension 11:24:39 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 11:24:39 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 11:24:39 INFO - building 'psutil._psutil_posix' extension 11:24:39 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 11:24:39 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 11:24:39 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 11:24:39 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 11:24:39 INFO - Successfully installed psutil 11:24:39 INFO - Cleaning up... 11:24:40 INFO - Return code: 0 11:24:40 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 11:24:40 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')]} 11:24:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:24:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:24:40 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')]} 11:24:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:24:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:24:40 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 0x7f2c2f0a6f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28228a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x28ed5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x297c410>, '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 0x297d310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x297d7a0>, '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': '745a4373a2a16df560f216e000000264-1459275715.420491-752098626', '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 11:24:40 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 11:24:40 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 11:24:40 INFO - Using env: {'DISPLAY': ':0', 11:24:40 INFO - 'HOME': '/home/cltbld', 11:24:40 INFO - 'LANG': 'en_US.UTF-8', 11:24:40 INFO - 'LANGUAGE': 'en_US:en', 11:24:40 INFO - 'LOGNAME': 'cltbld', 11:24:40 INFO - 'MAIL': '/var/mail/cltbld', 11:24:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:24:40 INFO - 'MOZ_NO_REMOTE': '1', 11:24:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:24:40 INFO - 'NO_EM_RESTART': '1', 11:24:40 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:24:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:24:40 INFO - 'PWD': '/builds/slave/test', 11:24:40 INFO - 'SHELL': '/bin/bash', 11:24:40 INFO - 'SHLVL': '1', 11:24:40 INFO - 'TERM': 'linux', 11:24:40 INFO - 'TMOUT': '86400', 11:24:40 INFO - 'USER': 'cltbld', 11:24:40 INFO - 'XDG_SESSION_COOKIE': '745a4373a2a16df560f216e000000264-1459275715.420491-752098626', 11:24:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:24:40 INFO - '_': '/tools/buildbot/bin/python'} 11:24:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:24:40 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 11:24:40 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 11:24:40 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 11:24:40 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 11:24:40 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 11:24:40 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 11:24:40 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 11:24:42 INFO - Downloading mozsystemmonitor-0.0.tar.gz 11:24:42 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 11:24:42 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 11:24:42 INFO - Installing collected packages: mozsystemmonitor 11:24:42 INFO - Running setup.py install for mozsystemmonitor 11:24:42 INFO - Successfully installed mozsystemmonitor 11:24:42 INFO - Cleaning up... 11:24:42 INFO - Return code: 0 11:24:42 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 11:24:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:24:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:24:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:24:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:24:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:24:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:24:42 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 0x7f2c2f0a6f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28228a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x28ed5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x297c410>, '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 0x297d310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x297d7a0>, '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': '745a4373a2a16df560f216e000000264-1459275715.420491-752098626', '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 11:24:42 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 11:24:42 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 11:24:42 INFO - Using env: {'DISPLAY': ':0', 11:24:42 INFO - 'HOME': '/home/cltbld', 11:24:42 INFO - 'LANG': 'en_US.UTF-8', 11:24:42 INFO - 'LANGUAGE': 'en_US:en', 11:24:42 INFO - 'LOGNAME': 'cltbld', 11:24:42 INFO - 'MAIL': '/var/mail/cltbld', 11:24:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:24:42 INFO - 'MOZ_NO_REMOTE': '1', 11:24:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:24:42 INFO - 'NO_EM_RESTART': '1', 11:24:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:24:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:24:42 INFO - 'PWD': '/builds/slave/test', 11:24:42 INFO - 'SHELL': '/bin/bash', 11:24:42 INFO - 'SHLVL': '1', 11:24:42 INFO - 'TERM': 'linux', 11:24:42 INFO - 'TMOUT': '86400', 11:24:42 INFO - 'USER': 'cltbld', 11:24:42 INFO - 'XDG_SESSION_COOKIE': '745a4373a2a16df560f216e000000264-1459275715.420491-752098626', 11:24:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:24:42 INFO - '_': '/tools/buildbot/bin/python'} 11:24:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:24:42 INFO - Downloading/unpacking blobuploader==1.2.4 11:24:42 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 11:24:42 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 11:24:42 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 11:24:42 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 11:24:42 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 11:24:42 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 11:24:44 INFO - Downloading blobuploader-1.2.4.tar.gz 11:24:44 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 11:24:44 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 11:24:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:24:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:24:44 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:24:44 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:24:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:24:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:24:44 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 11:24:44 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 11:24:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:24:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:24:44 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:24:44 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:24:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:24:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:24:44 INFO - Downloading docopt-0.6.1.tar.gz 11:24:44 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 11:24:45 INFO - Installing collected packages: blobuploader, requests, docopt 11:24:45 INFO - Running setup.py install for blobuploader 11:24:45 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 11:24:45 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 11:24:45 INFO - Running setup.py install for requests 11:24:45 INFO - Running setup.py install for docopt 11:24:45 INFO - Successfully installed blobuploader requests docopt 11:24:45 INFO - Cleaning up... 11:24:45 INFO - Return code: 0 11:24:45 INFO - Installing None into virtualenv /builds/slave/test/build/venv 11:24:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:24:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:24:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:24:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:24:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:24:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:24:45 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f2c2f0a6f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28228a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x28ed5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x297c410>, '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 0x297d310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x297d7a0>, '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': '745a4373a2a16df560f216e000000264-1459275715.420491-752098626', '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 11:24:45 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 11:24:45 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 11:24:45 INFO - Using env: {'DISPLAY': ':0', 11:24:45 INFO - 'HOME': '/home/cltbld', 11:24:45 INFO - 'LANG': 'en_US.UTF-8', 11:24:45 INFO - 'LANGUAGE': 'en_US:en', 11:24:45 INFO - 'LOGNAME': 'cltbld', 11:24:45 INFO - 'MAIL': '/var/mail/cltbld', 11:24:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:24:45 INFO - 'MOZ_NO_REMOTE': '1', 11:24:45 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:24:45 INFO - 'NO_EM_RESTART': '1', 11:24:45 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:24:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:24:45 INFO - 'PWD': '/builds/slave/test', 11:24:45 INFO - 'SHELL': '/bin/bash', 11:24:45 INFO - 'SHLVL': '1', 11:24:45 INFO - 'TERM': 'linux', 11:24:45 INFO - 'TMOUT': '86400', 11:24:45 INFO - 'USER': 'cltbld', 11:24:45 INFO - 'XDG_SESSION_COOKIE': '745a4373a2a16df560f216e000000264-1459275715.420491-752098626', 11:24:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:24:45 INFO - '_': '/tools/buildbot/bin/python'} 11:24:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:24:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 11:24:45 INFO - Running setup.py (path:/tmp/pip-gpp3gt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 11:24:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 11:24:45 INFO - Running setup.py (path:/tmp/pip-AwznEz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 11:24:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 11:24:46 INFO - Running setup.py (path:/tmp/pip-CRFCKX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 11:24:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 11:24:46 INFO - Running setup.py (path:/tmp/pip-OtHi6j-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 11:24:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 11:24:46 INFO - Running setup.py (path:/tmp/pip-KrXk6j-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 11:24:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 11:24:46 INFO - Running setup.py (path:/tmp/pip-wsCcKC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 11:24:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 11:24:46 INFO - Running setup.py (path:/tmp/pip-wmOK77-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 11:24:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 11:24:46 INFO - Running setup.py (path:/tmp/pip-UXMVqA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 11:24:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 11:24:46 INFO - Running setup.py (path:/tmp/pip-Nu8mrf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 11:24:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 11:24:46 INFO - Running setup.py (path:/tmp/pip-xfAAaW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 11:24:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 11:24:46 INFO - Running setup.py (path:/tmp/pip-bTO1mn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 11:24:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 11:24:46 INFO - Running setup.py (path:/tmp/pip-09R1K7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 11:24:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 11:24:46 INFO - Running setup.py (path:/tmp/pip-cvo774-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 11:24:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 11:24:46 INFO - Running setup.py (path:/tmp/pip-YjY4q2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 11:24:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 11:24:46 INFO - Running setup.py (path:/tmp/pip-SGqEhq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 11:24:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 11:24:46 INFO - Running setup.py (path:/tmp/pip-kQ8j6w-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 11:24:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 11:24:47 INFO - Running setup.py (path:/tmp/pip-jUDvhh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 11:24:47 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 11:24:47 INFO - Running setup.py install for manifestparser 11:24:47 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 11:24:47 INFO - Running setup.py install for mozcrash 11:24:47 INFO - Running setup.py install for mozdebug 11:24:47 INFO - Running setup.py install for mozdevice 11:24:47 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 11:24:47 INFO - Installing dm script to /builds/slave/test/build/venv/bin 11:24:47 INFO - Running setup.py install for mozfile 11:24:47 INFO - Running setup.py install for mozhttpd 11:24:47 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 11:24:47 INFO - Running setup.py install for mozinfo 11:24:47 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 11:24:47 INFO - Running setup.py install for mozInstall 11:24:47 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 11:24:47 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 11:24:47 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 11:24:47 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 11:24:47 INFO - Running setup.py install for mozleak 11:24:47 INFO - Running setup.py install for mozlog 11:24:48 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 11:24:48 INFO - Running setup.py install for moznetwork 11:24:48 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 11:24:48 INFO - Running setup.py install for mozprocess 11:24:48 INFO - Running setup.py install for mozprofile 11:24:48 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 11:24:48 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 11:24:48 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 11:24:48 INFO - Running setup.py install for mozrunner 11:24:48 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 11:24:48 INFO - Running setup.py install for mozscreenshot 11:24:48 INFO - Running setup.py install for moztest 11:24:48 INFO - Running setup.py install for mozversion 11:24:48 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 11:24:48 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 11:24:48 INFO - Cleaning up... 11:24:48 INFO - Return code: 0 11:24:48 INFO - Installing None into virtualenv /builds/slave/test/build/venv 11:24: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')]} 11:24:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:24:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:24: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')]} 11:24:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:24:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:24:48 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f2c2f0a6f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28228a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x28ed5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x297c410>, '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 0x297d310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x297d7a0>, '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': '745a4373a2a16df560f216e000000264-1459275715.420491-752098626', '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 11:24:48 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 11:24:48 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 11:24:48 INFO - Using env: {'DISPLAY': ':0', 11:24:48 INFO - 'HOME': '/home/cltbld', 11:24:48 INFO - 'LANG': 'en_US.UTF-8', 11:24:48 INFO - 'LANGUAGE': 'en_US:en', 11:24:48 INFO - 'LOGNAME': 'cltbld', 11:24:48 INFO - 'MAIL': '/var/mail/cltbld', 11:24:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:24:48 INFO - 'MOZ_NO_REMOTE': '1', 11:24:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:24:48 INFO - 'NO_EM_RESTART': '1', 11:24:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:24:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:24:48 INFO - 'PWD': '/builds/slave/test', 11:24:48 INFO - 'SHELL': '/bin/bash', 11:24:48 INFO - 'SHLVL': '1', 11:24:48 INFO - 'TERM': 'linux', 11:24:48 INFO - 'TMOUT': '86400', 11:24:48 INFO - 'USER': 'cltbld', 11:24:48 INFO - 'XDG_SESSION_COOKIE': '745a4373a2a16df560f216e000000264-1459275715.420491-752098626', 11:24:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:24:48 INFO - '_': '/tools/buildbot/bin/python'} 11:24:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:24:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 11:24:49 INFO - Running setup.py (path:/tmp/pip-bSUTKI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 11:24:49 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)) 11:24:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 11:24:49 INFO - Running setup.py (path:/tmp/pip-wCUlSH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 11:24:49 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)) 11:24:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 11:24:49 INFO - Running setup.py (path:/tmp/pip-UrYce_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 11:24:49 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)) 11:24:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 11:24:49 INFO - Running setup.py (path:/tmp/pip-Baz3Y2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 11:24:49 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)) 11:24:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 11:24:49 INFO - Running setup.py (path:/tmp/pip-qMJo9U-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 11:24:49 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)) 11:24:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 11:24:49 INFO - Running setup.py (path:/tmp/pip-cUMB7o-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 11:24:49 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)) 11:24:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 11:24:49 INFO - Running setup.py (path:/tmp/pip-aKoc6u-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 11:24:49 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)) 11:24:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 11:24:49 INFO - Running setup.py (path:/tmp/pip-ip1Uyf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 11:24:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 11:24:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 11:24:49 INFO - Running setup.py (path:/tmp/pip-DBNFq_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 11:24:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 11:24:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 11:24:49 INFO - Running setup.py (path:/tmp/pip-o6r3oQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 11:24:49 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)) 11:24:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 11:24:49 INFO - Running setup.py (path:/tmp/pip-MhMKAe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 11:24:49 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 11:24:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 11:24:49 INFO - Running setup.py (path:/tmp/pip-LRh0RX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 11:24:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 11:24:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 11:24:49 INFO - Running setup.py (path:/tmp/pip-Ots6uX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 11:24:50 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)) 11:24:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 11:24:50 INFO - Running setup.py (path:/tmp/pip-QZJ3FT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 11:24:50 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)) 11:24:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 11:24:50 INFO - Running setup.py (path:/tmp/pip-sORUHT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 11:24:50 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)) 11:24:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 11:24:50 INFO - Running setup.py (path:/tmp/pip-aYvzFn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 11:24:50 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)) 11:24:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 11:24:50 INFO - Running setup.py (path:/tmp/pip-g7RtVQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 11:24:50 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)) 11:24:50 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)) 11:24:50 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)) 11:24:50 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)) 11:24:50 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)) 11:24:50 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)) 11:24:50 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 11:24:50 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 11:24:50 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 11:24:50 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 11:24:50 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 11:24:50 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 11:24:50 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 11:24:52 INFO - Downloading blessings-1.6.tar.gz 11:24:52 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 11:24:52 INFO - Installing collected packages: blessings 11:24:52 INFO - Running setup.py install for blessings 11:24:52 INFO - Successfully installed blessings 11:24:52 INFO - Cleaning up... 11:24:52 INFO - Return code: 0 11:24:52 INFO - Done creating virtualenv /builds/slave/test/build/venv. 11:24:52 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 11:24:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 11:24:52 INFO - Reading from file tmpfile_stdout 11:24:52 INFO - Current package versions: 11:24:52 INFO - argparse == 1.2.1 11:24:52 INFO - blessings == 1.6 11:24:52 INFO - blobuploader == 1.2.4 11:24:52 INFO - docopt == 0.6.1 11:24:52 INFO - manifestparser == 1.1 11:24:52 INFO - mozInstall == 1.12 11:24:52 INFO - mozcrash == 0.17 11:24:52 INFO - mozdebug == 0.1 11:24:52 INFO - mozdevice == 0.48 11:24:52 INFO - mozfile == 1.2 11:24:52 INFO - mozhttpd == 0.7 11:24:52 INFO - mozinfo == 0.9 11:24:52 INFO - mozleak == 0.1 11:24:52 INFO - mozlog == 3.1 11:24:52 INFO - moznetwork == 0.27 11:24:52 INFO - mozprocess == 0.22 11:24:52 INFO - mozprofile == 0.28 11:24:52 INFO - mozrunner == 6.11 11:24:52 INFO - mozscreenshot == 0.1 11:24:52 INFO - mozsystemmonitor == 0.0 11:24:52 INFO - moztest == 0.7 11:24:52 INFO - mozversion == 1.4 11:24:52 INFO - psutil == 3.1.1 11:24:52 INFO - requests == 1.2.3 11:24:52 INFO - wsgiref == 0.1.2 11:24:52 INFO - Installing None into virtualenv /builds/slave/test/build/venv 11:24:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:24:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:24:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:24:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:24:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:24:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:24:52 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f2c2f0a6f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28228a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x28ed5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x297c410>, '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 0x297d310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x297d7a0>, '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': '745a4373a2a16df560f216e000000264-1459275715.420491-752098626', '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 11:24:52 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 11:24:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 11:24:52 INFO - Using env: {'DISPLAY': ':0', 11:24:52 INFO - 'HOME': '/home/cltbld', 11:24:52 INFO - 'LANG': 'en_US.UTF-8', 11:24:52 INFO - 'LANGUAGE': 'en_US:en', 11:24:52 INFO - 'LOGNAME': 'cltbld', 11:24:52 INFO - 'MAIL': '/var/mail/cltbld', 11:24:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:24:52 INFO - 'MOZ_NO_REMOTE': '1', 11:24:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:24:52 INFO - 'NO_EM_RESTART': '1', 11:24:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:24:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:24:52 INFO - 'PWD': '/builds/slave/test', 11:24:52 INFO - 'SHELL': '/bin/bash', 11:24:52 INFO - 'SHLVL': '1', 11:24:52 INFO - 'TERM': 'linux', 11:24:52 INFO - 'TMOUT': '86400', 11:24:52 INFO - 'USER': 'cltbld', 11:24:52 INFO - 'XDG_SESSION_COOKIE': '745a4373a2a16df560f216e000000264-1459275715.420491-752098626', 11:24:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:24:52 INFO - '_': '/tools/buildbot/bin/python'} 11:24:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:24:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 11:24:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 11:24:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 11:24:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 11:24:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 11:24:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 11:24:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 11:24:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 11:24:52 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 11:24:52 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 11:24:52 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 11:24:52 INFO - Cleaning up... 11:24:52 INFO - Return code: 0 11:24:52 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 11:24:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:24:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:24:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:24:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:24:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:24:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:24:52 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f2c2f0a6f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28228a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x28ed5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x297c410>, '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 0x297d310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x297d7a0>, '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': '745a4373a2a16df560f216e000000264-1459275715.420491-752098626', '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 11:24:52 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 11:24:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 11:24:52 INFO - Using env: {'DISPLAY': ':0', 11:24:52 INFO - 'HOME': '/home/cltbld', 11:24:52 INFO - 'LANG': 'en_US.UTF-8', 11:24:52 INFO - 'LANGUAGE': 'en_US:en', 11:24:52 INFO - 'LOGNAME': 'cltbld', 11:24:52 INFO - 'MAIL': '/var/mail/cltbld', 11:24:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:24:52 INFO - 'MOZ_NO_REMOTE': '1', 11:24:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:24:52 INFO - 'NO_EM_RESTART': '1', 11:24:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:24:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:24:52 INFO - 'PWD': '/builds/slave/test', 11:24:52 INFO - 'SHELL': '/bin/bash', 11:24:52 INFO - 'SHLVL': '1', 11:24:52 INFO - 'TERM': 'linux', 11:24:52 INFO - 'TMOUT': '86400', 11:24:52 INFO - 'USER': 'cltbld', 11:24:52 INFO - 'XDG_SESSION_COOKIE': '745a4373a2a16df560f216e000000264-1459275715.420491-752098626', 11:24:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:24:52 INFO - '_': '/tools/buildbot/bin/python'} 11:24:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:24:53 INFO - Downloading/unpacking jsonschema 11:24:53 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 11:24:53 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 11:24:53 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 11:24:53 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 11:24:53 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 11:24:53 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 11:24:54 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 11:24:54 INFO - Downloading/unpacking functools32 (from jsonschema) 11:24:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:24:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:24:54 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:24:54 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:24:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:24:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:24:55 INFO - Downloading functools32-3.2.3-2.tar.gz 11:24:55 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 11:24:55 INFO - warning: no files found matching '*.txt' 11:24:55 INFO - no previously-included directories found matching 'build' 11:24:55 INFO - no previously-included directories found matching 'dist' 11:24:55 INFO - no previously-included directories found matching '.git*' 11:24:55 INFO - Installing collected packages: jsonschema, functools32 11:24:55 INFO - Running setup.py install for functools32 11:24:55 INFO - warning: no files found matching '*.txt' 11:24:55 INFO - no previously-included directories found matching 'build' 11:24:55 INFO - no previously-included directories found matching 'dist' 11:24:55 INFO - no previously-included directories found matching '.git*' 11:24:55 INFO - Successfully installed jsonschema functools32 11:24:55 INFO - Cleaning up... 11:24:55 INFO - Return code: 0 11:24:55 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 11:24:55 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')]} 11:24:55 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:24:55 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:24:55 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')]} 11:24:55 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:24:55 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:24:55 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 0x7f2c2f0a6f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28228a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x28ed5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x297c410>, '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 0x297d310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x297d7a0>, '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': '745a4373a2a16df560f216e000000264-1459275715.420491-752098626', '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 11:24:55 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 11:24:55 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 11:24:55 INFO - Using env: {'DISPLAY': ':0', 11:24:55 INFO - 'HOME': '/home/cltbld', 11:24:55 INFO - 'LANG': 'en_US.UTF-8', 11:24:55 INFO - 'LANGUAGE': 'en_US:en', 11:24:55 INFO - 'LOGNAME': 'cltbld', 11:24:55 INFO - 'MAIL': '/var/mail/cltbld', 11:24:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:24:55 INFO - 'MOZ_NO_REMOTE': '1', 11:24:55 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:24:55 INFO - 'NO_EM_RESTART': '1', 11:24:55 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:24:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:24:55 INFO - 'PWD': '/builds/slave/test', 11:24:55 INFO - 'SHELL': '/bin/bash', 11:24:55 INFO - 'SHLVL': '1', 11:24:55 INFO - 'TERM': 'linux', 11:24:55 INFO - 'TMOUT': '86400', 11:24:55 INFO - 'USER': 'cltbld', 11:24:55 INFO - 'XDG_SESSION_COOKIE': '745a4373a2a16df560f216e000000264-1459275715.420491-752098626', 11:24:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:24:55 INFO - '_': '/tools/buildbot/bin/python'} 11:24:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:24:55 INFO - Downloading/unpacking flake8 11:24:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:24:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:24:55 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:24:55 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:24:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:24:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:24:57 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 11:24:57 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 11:24:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:24:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:24:57 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:24:57 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:24:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:24:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:24:57 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 11:24:57 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 11:24:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:24:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:24:57 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:24:57 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:24:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:24:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:24:57 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 11:24:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:24:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:24:57 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:24:57 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:24:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:24:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:24:58 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 11:24:58 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 11:24:58 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 11:24:58 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 11:24:58 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 11:24:58 INFO - no previously-included directories found matching 'docs/_build' 11:24:58 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 11:24:58 INFO - Running setup.py install for pep8 11:24:58 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 11:24:58 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 11:24:58 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 11:24:58 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 11:24:58 INFO - no previously-included directories found matching 'docs/_build' 11:24:58 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 11:24:58 INFO - Successfully installed flake8 mccabe pyflakes pep8 11:24:58 INFO - Cleaning up... 11:24:58 INFO - Return code: 0 11:24:58 INFO - Running post-action listener: _resource_record_post_action 11:24:58 INFO - Running post-action listener: _start_resource_monitoring 11:24:58 INFO - Starting resource monitoring. 11:24:58 INFO - ##### 11:24:58 INFO - ##### Running install step. 11:24:58 INFO - ##### 11:24:58 INFO - Running pre-action listener: _resource_record_pre_action 11:24:58 INFO - Running main action method: install 11:24:58 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 11:24:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 11:24:58 INFO - Reading from file tmpfile_stdout 11:24:58 INFO - Detecting whether we're running mozinstall >=1.0... 11:24:58 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 11:24:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 11:24:58 INFO - Reading from file tmpfile_stdout 11:24:58 INFO - Output received: 11:24:58 INFO - Usage: mozinstall [options] installer 11:24:58 INFO - Options: 11:24:58 INFO - -h, --help show this help message and exit 11:24:58 INFO - -d DEST, --destination=DEST 11:24:58 INFO - Directory to install application into. [default: 11:24:58 INFO - "/builds/slave/test"] 11:24:58 INFO - --app=APP Application being installed. [default: firefox] 11:24:58 INFO - mkdir: /builds/slave/test/build/application 11:24:58 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 11:24:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 11:25:14 INFO - Reading from file tmpfile_stdout 11:25:14 INFO - Output received: 11:25:14 INFO - /builds/slave/test/build/application/firefox/firefox 11:25:14 INFO - Running post-action listener: _resource_record_post_action 11:25:14 INFO - ##### 11:25:14 INFO - ##### Running run-tests step. 11:25:14 INFO - ##### 11:25:14 INFO - Running pre-action listener: _resource_record_pre_action 11:25:14 INFO - Running main action method: run_tests 11:25:14 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 11:25:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 11:25:14 INFO - Python 2.7.3 11:25:14 INFO - Return code: 0 11:25:14 INFO - grabbing minidump binary from tooltool 11:25: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')]} 11:25:14 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x297c410>, '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 0x297d310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x297d7a0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 11:25:14 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 11:25:14 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 11:25:15 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 11:25:15 INFO - Return code: 0 11:25:15 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 11:25:15 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 11:25:15 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 11:25:15 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 11:25:15 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 11:25:15 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 11:25:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 11:25:16 INFO - Return code: 0 11:25:16 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/XLewxWcOS4eHcaHfEAyOLA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-032', '--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 11:25:16 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/XLewxWcOS4eHcaHfEAyOLA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-032 --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 11:25:16 INFO - Using env: {'DISPLAY': ':0', 11:25:16 INFO - 'HOME': '/home/cltbld', 11:25:16 INFO - 'LANG': 'en_US.UTF-8', 11:25:16 INFO - 'LANGUAGE': 'en_US:en', 11:25:16 INFO - 'LOGNAME': 'cltbld', 11:25:16 INFO - 'MAIL': '/var/mail/cltbld', 11:25:16 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 11:25:16 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 11:25:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:25:16 INFO - 'MOZ_NO_REMOTE': '1', 11:25:16 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 11:25:16 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:25:16 INFO - 'NO_EM_RESTART': '1', 11:25:16 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:25:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:25:16 INFO - 'PWD': '/builds/slave/test', 11:25:16 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 11:25:16 INFO - 'SHELL': '/bin/bash', 11:25:16 INFO - 'SHLVL': '1', 11:25:16 INFO - 'TERM': 'linux', 11:25:16 INFO - 'TMOUT': '86400', 11:25:16 INFO - 'USER': 'cltbld', 11:25:16 INFO - 'XDG_SESSION_COOKIE': '745a4373a2a16df560f216e000000264-1459275715.420491-752098626', 11:25:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:25:16 INFO - '_': '/tools/buildbot/bin/python'} 11:25:16 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/XLewxWcOS4eHcaHfEAyOLA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-032', '--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 11:25:16 INFO - mozversion application_buildid: 20160329104135 11:25:16 INFO - mozversion application_changeset: 1e908cdc6c424be15d00ddefa9667f9b07531ccb 11:25:16 INFO - mozversion application_display_name: Nightly 11:25:16 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 11:25:16 INFO - mozversion application_name: Firefox 11:25:16 INFO - mozversion application_remotingname: firefox 11:25:16 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 11:25:16 INFO - mozversion application_vendor: Mozilla 11:25:16 INFO - mozversion application_version: 48.0a1 11:25:16 INFO - mozversion platform_buildid: 20160329104135 11:25:16 INFO - mozversion platform_changeset: 1e908cdc6c424be15d00ddefa9667f9b07531ccb 11:25:16 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 11:25:16 INFO - mozversion platform_version: 48.0a1 11:25:16 INFO - using testdate: 1459275916 11:25:16 INFO - actual date: 1459275916 11:25:16 INFO - starting webserver on 'localhost:37077' 11:25:16 INFO - SUITE-START | Running 2 tests 11:25:16 INFO - TEST-START | dromaeo_css 11:25:16 INFO - operating with platform_type : linux_ 11:25:16 INFO - Initialising browser for dromaeo_css test... 11:25:16 INFO - TEST-INFO | started process 30171 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpS5Fyu9/profile http://localhost:37077/getInfo.html) 11:25:21 INFO - PROCESS | 30171 | __metrics Screen width/height:1600/1200 11:25:21 INFO - PROCESS | 30171 | colorDepth:24 11:25:21 INFO - PROCESS | 30171 | Browser inner width/height: 1024/697 11:25:21 INFO - PROCESS | 30171 | __metrics 11:25:22 ERROR - PROCESS | 30171 | JavaScript error: resource://app/modules/AboutNewTab.jsm, line 36: TypeError: this.pageListener is null 11:25:23 INFO - TEST-INFO | 30171: exit 0 11:25:23 INFO - Browser initialized. 11:25:23 INFO - Running cycle 1/1 for dromaeo_css test... 11:25:23 INFO - TEST-INFO | started process 30265 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpS5Fyu9/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 11:25:35 INFO - PROCESS | 30265 | RSS: Main: 155111424 11:25:35 INFO - PROCESS | 30265 | 11:26:26 INFO - PROCESS | 30265 | 1459275986339 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] 11:28:39 INFO - PROCESS | 30265 | Cycle 1(1): loaded http://localhost:37077/tests/dromaeo/cssquery-dojo.html (next: http://localhost:37077/tests/dromaeo/cssquery-ext.html) 11:28:40 INFO - PROCESS | 30265 | RSS: Main: 242094080 11:28:40 INFO - PROCESS | 30265 | 11:31:42 INFO - PROCESS | 30265 | Cycle 1(1): loaded http://localhost:37077/tests/dromaeo/cssquery-ext.html (next: http://localhost:37077/tests/dromaeo/cssquery-jquery.html) 11:31:43 INFO - PROCESS | 30265 | RSS: Main: 236417024 11:31:43 INFO - PROCESS | 30265 | 11:34:45 INFO - PROCESS | 30265 | Cycle 1(1): loaded http://localhost:37077/tests/dromaeo/cssquery-jquery.html (next: http://localhost:37077/tests/dromaeo/cssquery-mootools.html) 11:34:45 INFO - PROCESS | 30265 | RSS: Main: 234356736 11:34:45 INFO - PROCESS | 30265 | 11:37:47 INFO - PROCESS | 30265 | Cycle 1(1): loaded http://localhost:37077/tests/dromaeo/cssquery-mootools.html (next: http://localhost:37077/tests/dromaeo/cssquery-prototype.html) 11:37:48 INFO - PROCESS | 30265 | RSS: Main: 211746816 11:37:48 INFO - PROCESS | 30265 | 11:40:50 INFO - PROCESS | 30265 | Cycle 1(1): loaded http://localhost:37077/tests/dromaeo/cssquery-prototype.html (next: http://localhost:37077/tests/dromaeo/cssquery-yui.html) 11:40:51 INFO - PROCESS | 30265 | RSS: Main: 198828032 11:40:51 INFO - PROCESS | 30265 | 11:43:54 INFO - PROCESS | 30265 | Cycle 1(1): loaded http://localhost:37077/tests/dromaeo/cssquery-yui.html (next: http://localhost:37077/tests/dromaeo/cssquery-dojo.html) 11:43:54 INFO - PROCESS | 30265 | RSS: Main: 274526208 11:43:54 INFO - PROCESS | 30265 | 11:43:54 INFO - PROCESS | 30265 | __start_tp_report 11:43:54 INFO - PROCESS | 30265 | _x_x_mozilla_page_load 11:43:54 INFO - PROCESS | 30265 | _x_x_mozilla_page_load_details 11:43:54 INFO - PROCESS | 30265 | |i|pagename|runs| 11:43:54 INFO - PROCESS | 30265 | |0;dojo.html;2597.753213444723;2661.2548486423807;2669.826461280018;2677.71883952185;2701.3246688327913;4563.840265590705;4598.333241679954;4603.6777425580185;4608.354830323753;4633.235516139833;4647.930281045787;4685.7188568685815;4721.102990431816;4748.738819364934;4762.7856746446405;4190.811413486385;4251.829926802932;4291.184674911772;4413.117376524692;4434.268345722952;4392.472903251598;4430.9587246996925;4450.465944086698;4459.308807134883;4487.259602165655;4171.353440216772;4234.449521562208;4243.024104455962;4322.092360604277;4347.065380943112;4315.935260971057;4316.050468896838;4320.351947207912;4341.131773645252;4361.171377438308;4272.2950713132295;4284.950187204155;4315.287977483711;4323.697341186118;4336.306191009455;4378.584034516716;4548.636109111296;4619.076184763027;4622.075584883037;4640.930386044212;4996.375453068366;5002.849914502571;5003.874903127415;5007.774650140753;5041.823536176253;4999.675021123651;5012.649114561982;5015.648904576681;5016.573591244749;5068.138416469209;4581.977090114528;4620.1221767864;4710.199266124767;4726.314684370747;4730.124926888537;5066.341375621146;5067.619928505377;5071.442141364447;5095.210242412432;5115.488451154854;4872.049950259665;4874.8537543873745;4875.366202393666;4884.4871288514905;4914.778834952435;4853.077915196172;4965.751712414365;4988.8752781180765;5087.389513258433;5097.745112744422;4914.582260507826;4927.408710954636;4935.7532123393685;4935.8519244422005;4980.252962055721;4919.4834542373255;4921.975390123026;4927.531884471041;4930.8767280818265;4980.7509624518625;4188.246115699203;4254.31930891056;4254.617084462413;4262.722923009995;4265.1043280910735;3729.701623870084;3776.0371105368504;3787.9431808522895;3789.317922773872;3791.848326066982;4316.762578058174;4321.9135617287475;4329.307310830315;4337.0458499130145;4385.188740083095;4993.750312484434;5017.874553136201;5025.849224523197;5031.84904452867;5060.898782024339;4347.3261644445165;4361.6510679145595;4362.8691139265875;4367.956320436819;4406.647468202536;4348.782560872007;4553.271476563734;4598.3102534620075;4621.630269578425;4638.79125439356;4773.236282194832;4776.5701086902345;4795.064962332382;4803.231482962709;4842.7336496493035;4925.975370123127;5003.699778013331;5006.148954677787;5024.095662780588;5068.341115654941;4805.663603547718;4806.255030470283;4808.855734327975;4839.322494850794;4857.781399836945;4812.51874812516;4840.588549973291;4846.927296090491;4847.854564363075;4889.266610008527;4909.3126962224605;4913.361263035782;4916.0905232532095;4959.62802789785;5024.120778863758;4762.047590481849;4782.952170478251;4785.449673287477;4809.975950120227;4831.685940413862;4735.976320118378;4767.928481072856;4769.594584460359;4773.976130119466;4836.371271734652;4635.884102897455;4713.505081966344;4771.1888978872985;4777.378940737682;4865.270209468466;4898.559129678346;4917.729524876167;4921.163402221559;4924.285978533164;4926.778294976806;4833.854984350475;4837.733924634179;4839.927401088916;4840.419149702058;4857.1742803724155 11:43:54 INFO - PROCESS | 30265 | |1;ext.html;499.5828483216514;536.3081624704132;536.8792021795099;564.8813749112686;572.6106247751527;26661.33346666332;27089.729102708992;27107.32231694206;35400.645993540056;35871;37903;38272;38320.80839595798;38330;38399.39207295128;7601.619919004055;7828.5694286814205;7840.803979900519;7841.843163136762;7850.882236766424;7574.621268936558;7690.115636701767;7714.305712485875;7718.807029824271;7723.111842138142;7923.524588524678;7957.641906114239;7983.760487185394;7989.121196668362;8000.599970001505;7841.333486653612;7900.32847207988;7902.999999999971;7910.683572657087;7911;7773.106092799288;7923.96038019812;7928.127905930343;7928.484648497887;7931.167227441093;37564.06089847748;37733.43399848977;38093.23813523714;38107;38155.427668584714;3089.567460555524;3238.4332741770095;3238.935221295561;3250.138713240993;3288.8684452621865;28834.134975950754;29242;29406;29758.85120574383;30255.848720756476;3489.494023366623;3544.068946255422;3554.8400321985573;3556.110972256936;3576.517170182018;244312;249238;249801;250046;250256;58376.708116459995;58396;58845.41154588485;58922.70538647365;58966.41033589695;63219;63547.36452635507;64375.67812160909;64468.67765661141;64520;15073.698526029419;15102;15165.772513412308;15285.38858445672;15308.311125999357;11556.94221528887;11712;11712.824307635392;11730.354830484406;11804.586839460577;19914.203431862563;20003.899980500006;20073.498162546053;20116.295929642685;20127.496812579804;7029.5430796998035;7131.322524360177;7365.447591430664;7507.662155203029;7553.962230188924;866.6316815353449;904.9230815380635;929.6235024814961;965.9613615455444;999.8450240212778;26721.599176012376;28011.15966520967;28093.719062809112;28123.859380703376;28182.43635127286;919.3472634429496;971.4025874087386;974.1962880623514;976.2043934193752;1067.9480711499168;13603;13640;13768.586942391745;13847.930760346335;13855;348010;355881;356548;356624;357299;49837.501624983284;49981.25028124581;50074.24888626674;50339.49660503421;50442.24336634953;1066.589363095214;1221.1451983611507;1242.6147894152841;1251.3993283223922;1337.8662133786738;24600.876995614908;25745.356366090997;26004;26107;26128;39360;39914.80042599768;40109;40149.3940242387;40334;187664;189262;198830;198906;201416;26616;31105.8444707775;31546.842265788524;31717.841410792797;31868.203294917814;37661.435078473296;39201.80399097986;39353.80323098366;39543;39758.60241397549;33163.83418082894;33230.83384583062;33705.49441758425;33745.15637109092;33949.15127121842;33678.32643347168;33759.324813504085;34329.485057724654;34471.65528344785;34496.48255276223;33375;33394.33211335808;34184;34203.48694769531;34229.828850855585;29329.266768330963;29976.550351745176;30119;30551.54172687367;30688.232794180323;23671.526569468857;24024.87987560051;24119.995403241024;24240.878795606615;24348.634770478104 11:43:54 INFO - PROCESS | 30265 | |2;jquery.html;342.7771948233648;352.84651176738123;357.47714735227936;358.290584642408;364.0716173756919;15631.531054068368;16070.27683754231;16123;16562.50312490627;16593.917030414832;15303.69392612147;15486.845131548682;15509.457168999088;15576.299066542004;15759.133247671374;5057.696538207711;5129.948700512984;5201.141811601081;5204.115300398941;5216.035033518792;5024.949750502503;5125.2055931330515;5136.948630513684;5173;5178.093833579127;5135.794568217286;5138.871528211787;5146.588272938156;5147.279380886679;5147.794088236466;5047.0915235257635;5232.502912223333;5240.030594340059;5247.186686063647;5249.737513124329;5041.344625198701;5068.645194836363;5070.366204224472;5072.188449848043;5072.442031376546;11795.705107372385;12470.75058498825;12473.31396773177;12480.375981200994;12487.75024499514;2052.10733331;2053.1787285085934;2240.2271216430304;2324.5815753164425;2424.2665498984998;9341.673041443517;9410.858837117448;10320.845187322197;12543.24740515563;13033.087683862133;1756.6837969165545;1771.4597047900386;1790.4270633397318;1813.7732783402075;1822.5352535103596;60033;61465.38534614642;63730.68134659297;64606.67696661487;64738.67630661864;9739.8425008592;9773.65792197284;9788.9021109788;9794.314397992215;9824.852627210455;13443.596692099252;13617.046806723632;13632.591022269347;13641.658958525917;13653.658658533615;7361.668724907392;7367.4842761007285;7427.702891884373;7461.738839140713;7511.812204694817;7124.251953544906;7164.21193668696;7178.353948144692;7197.856042879113;7220.241874603196;4267.701260911706;4275.230458517434;4294.849680261176;4316.3093904975685;4360.956390436118;1772.5125590462726;1789.7941736700445;1791.758112654801;1834.5780470491861;1866.3654357518508;837.5770236030887;844.3161039557978;855.2046596665161;873.4584557574344;907.8275127725711;15191.544253672408;15313;15855.841441585668;16018.359265629477;16054.518364449084;862.7368652560904;863.7840539865034;876.8071024374627;889.6352495476953;906.1889608800087;9003.909960900439;9359.719208423758;9405.623775048922;9435.386699864486;9482.478463684425;393990;410361;413645;415636;415786;44036.11927761427;44511.55488445139;59300;67387.32612673909;69558;927.096081320707;941.1294552539011;946.2288235088519;956.9569369378395;967.9370840895319;11624;14483.348249329016;14621.0496317739;14709.705805884036;15169.165695886391;30668.38663226678;31802.522962155123;31916.361672766878;32126.83936580302;32655;39879.60120398875;39949;40273.19453610853;40505.1898962025;40623.59376406198;7189.604571748604;7403.7408690695565;7432.293932076444;7488.438367122379;7539;9308.860367094363;10264.790467344603;10969.177311701815;11187.21689481761;11205.775884482428;9417.152456278967;9701.854472183064;9717.17404020666;9802.705918822447;10069.69790906274;9320.95339523298;9674;9808;10087.89912100899;10143.391396516232;9979.950100249453;10264.486775661337;10433.74795024602;10688.519016644113;10792.622258220925;7318.377937875341;7412.221716719882;7417.147028091838;7424.703011879465;7463.2163622818825;9430.19843313326;10455.215858810772;10483.633072842415;10553.314034587727;10679.412632305297 11:43:54 INFO - PROCESS | 30265 | |3;mootools.html;1243.061488576125;1390.6036779517838;1404.6137312239132;1538.3769573322802;1770.9203085861127;6857.45140388769;7359.300866417689;7512.361449276805;7525.397968162548;7532.849343013137;7561.281678240573;7707;7710.498817576868;7717.112532058815;7725.768226953201;1946.464722201399;2227.676986836908;2264.2188444986496;2296.7588403217674;2297.023764899919;2293.7706229377013;2298.3449716830705;2302.458922153293;2303.7581053989343;2305.561943230789;2204.492966617679;2258.119333459952;2265.3430505153488;2268.7050683411217;2269.500709843832;2218.279059305724;2226.1206823304865;2271.1710225767642;2290.667853161299;2297.609406400899;2254.3349711834885;2265.082641530183;2270.4096934796908;2274.329072923475;2309.434188623798;7816;7862.8820567690955;7879.36965042801;7879.960600196962;7886.723964661267;4746.52534746526;4878.292647566119;4887.877803054952;4894.41267047953;4896.828610998598;3069.4321550513005;3069.9539506907413;3091.299080455192;3103.596532450767;3128.6089238845143;956.4022485946283;971.1502435369052;985.069109691342;1014.9035841595037;1019.5157300282307;10754.462276886125;10760.946195269053;10764.13886889047;10790.082842958358;10801.891981080245;4307.590778876064;4407.669424793154;4489.595936365743;4504.324351347324;4511.909761804745;9104.590293436811;9157.542122893828;9159.450432974043;9202.539873006323;9205.907940920639;4227.788610569459;4828.686135401258;4832.420109586872;4835.492273311252;4843.346148270009;4212.326027835532;4292.441982542249;4311.9784401077795;4329.805158767863;4338.219120558329;3583.8566457341935;3664.102294937704;3681.3557627415094;3685.0603096210293;3709.5919448860604;1194.3729541990351;1224.3572124634638;1232.6733415644862;1235.8146278058364;1238.3746208164819;1234.5679012345606;1238.386998435762;1259.1123258103016;1264.3551788587702;1265.9303738294298;7309.415246780245;7407.555546667218;7424.740134095388;7427.108746950401;7487.213842546563;460.2773645376793;469.16020323620336;473.14597152140027;478.0295999121719;479.56838845039744;5685.772569097273;5727.570432217601;5740.311162660508;5741.052726300114;5756.453136951983;8967.551622418852;9186.127317904788;9190.448573085636;9340.626374945063;9369.390989585656;9197.402168859002;9251.67619133327;9269.397489163182;9294.535273236446;9302.348835581579;7187.89218161728;7264.273572642799;7529.2470752925365;7558.206388329256;7580.469367144247;7178.641067946686;7196.96401517989;7234.96382518084;7237.927620723936;7244.166920804175;8067.233612806774;8215.630296636546;8329.54187519668;8390.244877961013;8491.660333586835;8420.200080992296;8463.957680211806;8511.531865747444;8524.147585241426;8682.956585217033;6070.696465176812;6474.384933431316;6524.1192439022025;6704.161979752531;6790.490713196629;7374.815629609088;7391.186969433251;7401.0748656417945;7413.406927445683;7433.145188303414;6453.774117905851;6506.967465162644;6614.140161779131;6639.933600663931;6714.4292735116105;6649.301823308677;6669.166354205724;6681.09805176295;6694.196696396463;6751.831204219934;6616.867662646624;6670.566413183127;6701.564398314094;6865.5537390069485;6871.622060786704;6468.8059358219325;6662.367075127855;6668.966655166693;6672.5329226953645;6678.365555272241;6437.871242575028;6440.67796610177;6456;6465.967670161619;6471.935280647133 11:43:54 INFO - PROCESS | 30265 | |4;prototype.html;317.088370933566;321.36530352553694;322.1254294590188;326.45482044984874;329.12945259787864;5241.161414173728;5333.120035194193;5339.946600533994;5358.866028349288;5386.218998245252;5256.342957130359;5269.420363759983;5274.525292723654;5279.41926388097;5294.708791016493;3931.60683931606;4026.516817981846;4111.424400583921;4154.709170358076;4156.625903668669;4147.958520414787;4162.105147393309;4163.125743593849;4164.146349998243;4166.166766646667;4105.014796448861;4111.753294802322;4118;4119.908224320558;4121.196366708493;3913.941290880639;4013.3578627419765;4125.793710314472;4137.275976704095;4153.480814898137;3642.562892452896;3672.173760903802;3675.6691897729334;3682.6317368263226;3692.2061756722164;5065.4174769901565;5074.441811400743;5101.693898366073;5102.260172275037;5111.284420181178;4777.8327758528285;4799.2801079837955;4800.183968725325;4803.03939212159;4806.519348065201;5586.636868603528;5601.327840659106;5605.80379686709;5607.607467477278;5615.747291371898;4039.979800100981;4049.736767110158;4053;4054.594540545922;4054.837806487737;5722.246460159459;5820.417958204188;5870.11948207768;5872.530197584183;5887.4406931341455;4128.401381799622;4144.70987030911;4144.772037537964;4149.522804877478;4153.293940030202;4198.5591512891315;4203.306454434984;4207;4217.599328063829;4218.156368726267;4767.856964291077;4779.976100119477;4781.641376896747;4781.947971446276;4784.473707892129;5587.3015873015875;5598.748056337393;5610.885958293186;5615.943840561542;5617.634853734494;1456.7596346602693;1487.5611694550134;1490.7242160200399;1491.1574960147482;1492.060002198608;900.0864122915247;920.7559996600907;956.9043095690375;999.3154689038032;1021.1320377679062;4867.732274724854;4959.156943319572;4968.22992436173;4978.452370239271;4980.327655766425;5741.569382296345;5750.338711048283;5755.424457554295;5762.452567006211;5763.337216220105;4916.287138364917;4919.0899683558655;4923.803047878045;4934.037862616827;4939.333190019373;3074.0624109646774;3118.3295591447495;3134.044116544476;3145.418097651942;3145.7168854803176;5578.748956296977;5583.664980101207;5585.441455854382;5597.608167428322;5597.720113994365;5825.676460514366;5930.183162997541;6003.189569408074;6005.279366475964;6006.279246490449;5555.194496798023;5568.972155139199;5571.498565129158;5574.386817449996;5575.581831362664;5844.590878638454;5846.444587764156;5847.06446968483;5850.619709718854;5852.590318677651;5696.658200507983;5723.3418156912485;5731.8567035824435;5741.2536370273265;5745;5576.386597474356;5578.107502799533;5582.748776305158;5587.888242235052;5594.776208951759;3857.9421308680953;4019.1961607677995;4049.493813273341;4053.635172834459;4059.79701014954;5789.015867302653;5794.710264486843;5803.332616749128;5809.24479817621;5815.04051831443;5609.102543593006;5610.7755689773585;5611.270534830446;5613.775448982158;5617.775288988395;5582.8325150245555;5597.608167428404;5609.186667933209;5611.074172761449;5617.719114044363;5508.9724551376985;5517;5520.779168833202;5526.91709624364;5531.640443371168;5417.404085550507;5641.294838145232;5657.12314591239;5688.943110568841;5705.087186050212;5527.170924361378;5556.388797232382;5558.082916318924;5562.22128901946;5564.805231816867 11:43:54 INFO - PROCESS | 30265 | |5;yui.html;668.7826456401671;679.687343821842;767.0488594143261;792.9127795942449;816.6733306677332;11987.580434684787;12096.939515302432;12109.939450302758;12121;12125.878741212586;12192.329421881794;12274.140810143272;13415.12801667891;14002.719945601082;14017.719645607081;796.5937371940295;808.0908977400425;808.2119933065273;809.4617079642031;809.7165991902846;652.3574279334875;793.5992323876434;804.5775967616989;815.0382548592659;819;843.026304618164;845.4039901869198;845.6110189312924;846.2299307630058;849.1084361420484;838.7399906029151;840.9032961209448;841.0118111219324;841.7096101844854;844.2233145506149;498.35960790384183;607.7295603456464;618.780332981794;618.928823185335;619.0281258424276;12254.754904901942;12265.509379624893;12272.754544909141;12288.569900053544;12357.814632780515;11817.881821181763;11864.822027669592;12020.51917923282;12024.098192635587;12397.070219733556;9933.850992235122;10109.34289271195;10122.089011988883;10127.848082278771;10493.475326233658;3350.279689866666;3411.0619579615554;3425.3320602482527;3486.3027394521196;3490.022793617791;45637.771811141065;46354.76822615933;46420.30369544459;46520.767396163144;46556;9294.302927280482;9452.52737363129;9471.479068651153;9496.240300775922;9521;15117;15123;15178.165200913834;15195.316210770541;15234.847651523565;6413.775517856946;6659.433948114368;6718.260991290954;6796.35434633709;6806;3759.736818422739;3774.7923864187183;3784.6026167252594;3809;3871.341871881787;2814.957775633367;2856.3287627407544;2858.1282708773606;2882.654081510232;2944.160914139503;527.5568522441168;531.7155321902841;538.1470369464364;539.3042974562849;540.5162379670173;567.1775924908816;588.5968111843401;592.2094004503949;596.6002778138658;599.9130126131773;6672.2994085621285;7408.814779630552;7558.168601453835;7568.810779730551;7718.845623087619;460.1464283753656;509.35820865709474;550.7989583801883;562.5134258866051;581.5841673203595;3438.2607739336163;3449.6550344965303;3533.5229743984232;3585.6055833858254;3598.5861625913353;51040;51362.22956655653;51385;51885.740571296905;52484;43142.56857431385;43520.564794352285;43998;44090;44145.33781993273;41647;43473.347899781525;43810.56189438065;43838.7808060964;43906.34140487895;8098.51408915467;8343.332533397435;8689.695860644848;8705.956470217609;8884.156005179497;32329.51505727369;32330.515042273913;32970.17574560559;33094.33811323808;33374.165645859044;39827;41143.17713645651;41784.58215417807;41839.58160418357;42322.78838605787;10328.793424131625;10407.271490995558;10413.9479302603;10574.365538067741;10703.732406689584;11404.885951140383;11442.141839362248;11508.654740357802;11570.652880413601;12677.87322126767;9771.902280977383;11018.614348497764;11301;11337.943310283395;11863.466144023712;10748;10808.891911081104;11132.944335278271;11472.196946214019;11502.82745758831;10833.349999000086;11032.724181895195;11623.6512904613;11631.127665424958;11993.82009269879;9688.806223875625;9892.208623310262;9989.900100998897;10029.99700029991;10121.38708218841;9070.954645226731;9168.35821492489;9307.534623268944;9447.448813137142;9492.145706886136 11:43:54 INFO - PROCESS | 30265 | __end_tp_report 11:43:54 INFO - PROCESS | 30265 | __start_cc_report 11:43:54 INFO - PROCESS | 30265 | _x_x_mozilla_cycle_collect,869 11:43:54 INFO - PROCESS | 30265 | __end_cc_report 11:43:54 INFO - PROCESS | 30265 | __startTimestamp1459277034517__endTimestamp 11:43:54 INFO - PROCESS | 30265 | 11:43:54 INFO - PROCESS | 30265 | ------- Summary: start ------- 11:43:54 INFO - PROCESS | 30265 | Number of tests: 6 11:43:54 INFO - PROCESS | 30265 | 11:43:54 INFO - PROCESS | 30265 | [#0] dojo.html Cycles:165 Average:4622.90 Median:4773.24 stddev:463.66 (9.7%) stddev-sans-first:437.02 11:43:54 INFO - PROCESS | 30265 | Values: 2597.8 2661.3 2669.8 2677.7 2701.3 4563.8 4598.3 4603.7 4608.4 4633.2 4647.9 4685.7 4721.1 4748.7 4762.8 4190.8 4251.8 4291.2 4413.1 4434.3 4392.5 4431.0 4450.5 4459.3 4487.3 4171.4 4234.4 4243.0 4322.1 4347.1 4315.9 4316.1 4320.4 4341.1 4361.2 4272.3 4285.0 4315.3 4323.7 4336.3 4378.6 4548.6 4619.1 4622.1 4640.9 4996.4 5002.8 5003.9 5007.8 5041.8 4999.7 5012.6 5015.6 5016.6 5068.1 4582.0 4620.1 4710.2 4726.3 4730.1 5066.3 5067.6 5071.4 5095.2 5115.5 4872.0 4874.9 4875.4 4884.5 4914.8 4853.1 4965.8 4988.9 5087.4 5097.7 4914.6 4927.4 4935.8 4935.9 4980.3 4919.5 4922.0 4927.5 4930.9 4980.8 4188.2 4254.3 4254.6 4262.7 4265.1 3729.7 3776.0 3787.9 3789.3 3791.8 4316.8 4321.9 4329.3 4337.0 4385.2 4993.8 5017.9 5025.8 5031.8 5060.9 4347.3 4361.7 4362.9 4368.0 4406.6 4348.8 4553.3 4598.3 4621.6 4638.8 4773.2 4776.6 4795.1 4803.2 4842.7 4926.0 5003.7 5006.1 5024.1 5068.3 4805.7 4806.3 4808.9 4839.3 4857.8 4812.5 4840.6 4846.9 4847.9 4889.3 4909.3 4913.4 4916.1 4959.6 5024.1 4762.0 4783.0 4785.4 4810.0 4831.7 4736.0 4767.9 4769.6 4774.0 4836.4 4635.9 4713.5 4771.2 4777.4 4865.3 4898.6 4917.7 4921.2 4924.3 4926.8 4833.9 4837.7 4839.9 4840.4 4857.2 11:43:54 INFO - PROCESS | 30265 | 11:43:54 INFO - PROCESS | 30265 | [#1] ext.html Cycles:180 Average:42901.50 Median:19445.07 stddev:72128.86 (370.9%) stddev-sans-first:72260.93 11:43:54 INFO - PROCESS | 30265 | Values: 499.6 536.3 536.9 564.9 572.6 26661.3 27089.7 27107.3 35400.6 35871.0 37903.0 38272.0 38320.8 38330.0 38399.4 7601.6 7828.6 7840.8 7841.8 7850.9 7574.6 7690.1 7714.3 7718.8 7723.1 7923.5 7957.6 7983.8 7989.1 8000.6 7841.3 7900.3 7903.0 7910.7 7911.0 7773.1 7924.0 7928.1 7928.5 7931.2 37564.1 37733.4 38093.2 38107.0 38155.4 3089.6 3238.4 3238.9 3250.1 3288.9 28834.1 29242.0 29406.0 29758.9 30255.8 3489.5 3544.1 3554.8 3556.1 3576.5 244312.0 249238.0 249801.0 250046.0 250256.0 58376.7 58396.0 58845.4 58922.7 58966.4 63219.0 63547.4 64375.7 64468.7 64520.0 15073.7 15102.0 15165.8 15285.4 15308.3 11556.9 11712.0 11712.8 11730.4 11804.6 19914.2 20003.9 20073.5 20116.3 20127.5 7029.5 7131.3 7365.4 7507.7 7554.0 866.6 904.9 929.6 966.0 999.8 26721.6 28011.2 28093.7 28123.9 28182.4 919.3 971.4 974.2 976.2 1067.9 13603.0 13640.0 13768.6 13847.9 13855.0 348010.0 355881.0 356548.0 356624.0 357299.0 49837.5 49981.3 50074.2 50339.5 50442.2 1066.6 1221.1 1242.6 1251.4 1337.9 24600.9 25745.4 26004.0 26107.0 26128.0 39360.0 39914.8 40109.0 40149.4 40334.0 187664.0 189262.0 198830.0 198906.0 201416.0 26616.0 31105.8 31546.8 31717.8 31868.2 37661.4 39201.8 39353.8 39543.0 39758.6 33163.8 33230.8 33705.5 33745.2 33949.2 33678.3 33759.3 34329.5 34471.7 34496.5 33375.0 33394.3 34184.0 34203.5 34229.8 29329.3 29976.6 30119.0 30551.5 30688.2 23671.5 24024.9 24120.0 24240.9 24348.6 11:43:54 INFO - PROCESS | 30265 | 11:43:54 INFO - PROCESS | 30265 | [#2] jquery.html Cycles:180 Average:23292.76 Median:5033.15 stddev:67059.50 (1332.4%) stddev-sans-first:67225.48 11:43:54 INFO - PROCESS | 30265 | Values: 342.8 352.8 357.5 358.3 364.1 15631.5 16070.3 16123.0 16562.5 16593.9 15303.7 15486.8 15509.5 15576.3 15759.1 5057.7 5129.9 5201.1 5204.1 5216.0 5024.9 5125.2 5136.9 5173.0 5178.1 5135.8 5138.9 5146.6 5147.3 5147.8 5047.1 5232.5 5240.0 5247.2 5249.7 5041.3 5068.6 5070.4 5072.2 5072.4 11795.7 12470.8 12473.3 12480.4 12487.8 2052.1 2053.2 2240.2 2324.6 2424.3 9341.7 9410.9 10320.8 12543.2 13033.1 1756.7 1771.5 1790.4 1813.8 1822.5 60033.0 61465.4 63730.7 64606.7 64738.7 9739.8 9773.7 9788.9 9794.3 9824.9 13443.6 13617.0 13632.6 13641.7 13653.7 7361.7 7367.5 7427.7 7461.7 7511.8 7124.3 7164.2 7178.4 7197.9 7220.2 4267.7 4275.2 4294.8 4316.3 4361.0 1772.5 1789.8 1791.8 1834.6 1866.4 837.6 844.3 855.2 873.5 907.8 15191.5 15313.0 15855.8 16018.4 16054.5 862.7 863.8 876.8 889.6 906.2 9003.9 9359.7 9405.6 9435.4 9482.5 393990.0 410361.0 413645.0 415636.0 415786.0 44036.1 44511.6 59300.0 67387.3 69558.0 927.1 941.1 946.2 957.0 967.9 11624.0 14483.3 14621.0 14709.7 15169.2 30668.4 31802.5 31916.4 32126.8 32655.0 39879.6 39949.0 40273.2 40505.2 40623.6 7189.6 7403.7 7432.3 7488.4 7539.0 9308.9 10264.8 10969.2 11187.2 11205.8 9417.2 9701.9 9717.2 9802.7 10069.7 9321.0 9674.0 9808.0 10087.9 10143.4 9980.0 10264.5 10433.7 10688.5 10792.6 7318.4 7412.2 7417.1 7424.7 7463.2 9430.2 10455.2 10483.6 10553.3 10679.4 11:43:54 INFO - PROCESS | 30265 | 11:43:54 INFO - PROCESS | 30265 | [#3] mootools.html Cycles:180 Average:5408.95 Median:6454.89 stddev:2820.67 (43.7%) stddev-sans-first:2811.20 11:43:54 INFO - PROCESS | 30265 | Values: 1243.1 1390.6 1404.6 1538.4 1770.9 6857.5 7359.3 7512.4 7525.4 7532.8 7561.3 7707.0 7710.5 7717.1 7725.8 1946.5 2227.7 2264.2 2296.8 2297.0 2293.8 2298.3 2302.5 2303.8 2305.6 2204.5 2258.1 2265.3 2268.7 2269.5 2218.3 2226.1 2271.2 2290.7 2297.6 2254.3 2265.1 2270.4 2274.3 2309.4 7816.0 7862.9 7879.4 7880.0 7886.7 4746.5 4878.3 4887.9 4894.4 4896.8 3069.4 3070.0 3091.3 3103.6 3128.6 956.4 971.2 985.1 1014.9 1019.5 10754.5 10760.9 10764.1 10790.1 10801.9 4307.6 4407.7 4489.6 4504.3 4511.9 9104.6 9157.5 9159.5 9202.5 9205.9 4227.8 4828.7 4832.4 4835.5 4843.3 4212.3 4292.4 4312.0 4329.8 4338.2 3583.9 3664.1 3681.4 3685.1 3709.6 1194.4 1224.4 1232.7 1235.8 1238.4 1234.6 1238.4 1259.1 1264.4 1265.9 7309.4 7407.6 7424.7 7427.1 7487.2 460.3 469.2 473.1 478.0 479.6 5685.8 5727.6 5740.3 5741.1 5756.5 8967.6 9186.1 9190.4 9340.6 9369.4 9197.4 9251.7 9269.4 9294.5 9302.3 7187.9 7264.3 7529.2 7558.2 7580.5 7178.6 7197.0 7235.0 7237.9 7244.2 8067.2 8215.6 8329.5 8390.2 8491.7 8420.2 8464.0 8511.5 8524.1 8683.0 6070.7 6474.4 6524.1 6704.2 6790.5 7374.8 7391.2 7401.1 7413.4 7433.1 6453.8 6507.0 6614.1 6639.9 6714.4 6649.3 6669.2 6681.1 6694.2 6751.8 6616.9 6670.6 6701.6 6865.6 6871.6 6468.8 6662.4 6669.0 6672.5 6678.4 6437.9 6440.7 6456.0 6466.0 6471.9 11:43:54 INFO - PROCESS | 30265 | 11:43:54 INFO - PROCESS | 30265 | [#4] prototype.html Cycles:180 Average:4675.91 Median:5287.06 stddev:1361.62 (25.8%) stddev-sans-first:1325.55 11:43:54 INFO - PROCESS | 30265 | Values: 317.1 321.4 322.1 326.5 329.1 5241.2 5333.1 5339.9 5358.9 5386.2 5256.3 5269.4 5274.5 5279.4 5294.7 3931.6 4026.5 4111.4 4154.7 4156.6 4148.0 4162.1 4163.1 4164.1 4166.2 4105.0 4111.8 4118.0 4119.9 4121.2 3913.9 4013.4 4125.8 4137.3 4153.5 3642.6 3672.2 3675.7 3682.6 3692.2 5065.4 5074.4 5101.7 5102.3 5111.3 4777.8 4799.3 4800.2 4803.0 4806.5 5586.6 5601.3 5605.8 5607.6 5615.7 4040.0 4049.7 4053.0 4054.6 4054.8 5722.2 5820.4 5870.1 5872.5 5887.4 4128.4 4144.7 4144.8 4149.5 4153.3 4198.6 4203.3 4207.0 4217.6 4218.2 4767.9 4780.0 4781.6 4781.9 4784.5 5587.3 5598.7 5610.9 5615.9 5617.6 1456.8 1487.6 1490.7 1491.2 1492.1 900.1 920.8 956.9 999.3 1021.1 4867.7 4959.2 4968.2 4978.5 4980.3 5741.6 5750.3 5755.4 5762.5 5763.3 4916.3 4919.1 4923.8 4934.0 4939.3 3074.1 3118.3 3134.0 3145.4 3145.7 5578.7 5583.7 5585.4 5597.6 5597.7 5825.7 5930.2 6003.2 6005.3 6006.3 5555.2 5569.0 5571.5 5574.4 5575.6 5844.6 5846.4 5847.1 5850.6 5852.6 5696.7 5723.3 5731.9 5741.3 5745.0 5576.4 5578.1 5582.7 5587.9 5594.8 3857.9 4019.2 4049.5 4053.6 4059.8 5789.0 5794.7 5803.3 5809.2 5815.0 5609.1 5610.8 5611.3 5613.8 5617.8 5582.8 5597.6 5609.2 5611.1 5617.7 5509.0 5517.0 5520.8 5526.9 5531.6 5417.4 5641.3 5657.1 5688.9 5705.1 5527.2 5556.4 5558.1 5562.2 5564.8 11:43:54 INFO - PROCESS | 30265 | 11:43:54 INFO - PROCESS | 30265 | [#5] yui.html Cycles:180 Average:12810.11 Median:43872.56 stddev:14532.90 (33.1%) stddev-sans-first:14545.06 11:43:54 INFO - PROCESS | 30265 | Values: 668.8 679.7 767.0 792.9 816.7 11987.6 12096.9 12109.9 12121.0 12125.9 12192.3 12274.1 13415.1 14002.7 14017.7 796.6 808.1 808.2 809.5 809.7 652.4 793.6 804.6 815.0 819.0 843.0 845.4 845.6 846.2 849.1 838.7 840.9 841.0 841.7 844.2 498.4 607.7 618.8 618.9 619.0 12254.8 12265.5 12272.8 12288.6 12357.8 11817.9 11864.8 12020.5 12024.1 12397.1 9933.9 10109.3 10122.1 10127.8 10493.5 3350.3 3411.1 3425.3 3486.3 3490.0 45637.8 46354.8 46420.3 46520.8 46556.0 9294.3 9452.5 9471.5 9496.2 9521.0 15117.0 15123.0 15178.2 15195.3 15234.8 6413.8 6659.4 6718.3 6796.4 6806.0 3759.7 3774.8 3784.6 3809.0 3871.3 2815.0 2856.3 2858.1 2882.7 2944.2 527.6 531.7 538.1 539.3 540.5 567.2 588.6 592.2 596.6 599.9 6672.3 7408.8 7558.2 7568.8 7718.8 460.1 509.4 550.8 562.5 581.6 3438.3 3449.7 3533.5 3585.6 3598.6 51040.0 51362.2 51385.0 51885.7 52484.0 43142.6 43520.6 43998.0 44090.0 44145.3 41647.0 43473.3 43810.6 43838.8 43906.3 8098.5 8343.3 8689.7 8706.0 8884.2 32329.5 32330.5 32970.2 33094.3 33374.2 39827.0 41143.2 41784.6 41839.6 42322.8 10328.8 10407.3 10413.9 10574.4 10703.7 11404.9 11442.1 11508.7 11570.7 12677.9 9771.9 11018.6 11301.0 11337.9 11863.5 10748.0 10808.9 11132.9 11472.2 11502.8 10833.3 11032.7 11623.7 11631.1 11993.8 9688.8 9892.2 9989.9 10030.0 10121.4 9071.0 9168.4 9307.5 9447.4 9492.1 11:43:54 INFO - PROCESS | 30265 | -------- Summary: end -------- 11:43:54 INFO - PROCESS | 30265 | 11:43:55 INFO - TEST-INFO | 30265: exit 0 11:43:55 INFO - TEST-OK | dromaeo_css | took 1119066ms 11:43:55 INFO - TEST-START | kraken 11:43:55 INFO - operating with platform_type : linux_ 11:43:55 INFO - Initialising browser for kraken test... 11:43:55 INFO - TEST-INFO | started process 30445 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpeR4tUl/profile http://localhost:37077/getInfo.html) 11:44:00 INFO - PROCESS | 30445 | __metrics Screen width/height:1600/1200 11:44:00 INFO - PROCESS | 30445 | colorDepth:24 11:44:00 INFO - PROCESS | 30445 | Browser inner width/height: 1024/697 11:44:00 INFO - PROCESS | 30445 | __metrics 11:44:01 ERROR - PROCESS | 30445 | JavaScript error: resource://app/modules/AboutNewTab.jsm, line 36: TypeError: this.pageListener is null 11:44:01 INFO - TEST-INFO | 30445: exit 0 11:44:01 INFO - Browser initialized. 11:44:01 INFO - Running cycle 1/1 for kraken test... 11:44:01 INFO - TEST-INFO | started process 30529 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpeR4tUl/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 11:44:13 INFO - PROCESS | 30529 | RSS: Main: 154738688 11:44:13 INFO - PROCESS | 30529 | 11:44:16 INFO - PROCESS | 30529 | Cycle 1(1): loaded http://localhost:37077/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:37077/tests/kraken/driver.html?testName=audio-beat-detection) 11:44:17 INFO - PROCESS | 30529 | RSS: Main: 196091904 11:44:17 INFO - PROCESS | 30529 | 11:44:19 INFO - PROCESS | 30529 | Cycle 1(1): loaded http://localhost:37077/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:37077/tests/kraken/driver.html?testName=audio-dft) 11:44:20 INFO - PROCESS | 30529 | RSS: Main: 185765888 11:44:20 INFO - PROCESS | 30529 | 11:44:23 INFO - PROCESS | 30529 | Cycle 1(1): loaded http://localhost:37077/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:37077/tests/kraken/driver.html?testName=audio-fft) 11:44:24 INFO - PROCESS | 30529 | RSS: Main: 171921408 11:44:24 INFO - PROCESS | 30529 | 11:44:26 INFO - PROCESS | 30529 | Cycle 1(1): loaded http://localhost:37077/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:37077/tests/kraken/driver.html?testName=audio-oscillator) 11:44:26 INFO - PROCESS | 30529 | RSS: Main: 171589632 11:44:26 INFO - PROCESS | 30529 | 11:44:29 INFO - PROCESS | 30529 | Cycle 1(1): loaded http://localhost:37077/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:37077/tests/kraken/driver.html?testName=imaging-gaussian-blur) 11:44:29 INFO - PROCESS | 30529 | RSS: Main: 173248512 11:44:29 INFO - PROCESS | 30529 | 11:44:32 INFO - PROCESS | 30529 | Cycle 1(1): loaded http://localhost:37077/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:37077/tests/kraken/driver.html?testName=imaging-darkroom) 11:44:33 INFO - PROCESS | 30529 | RSS: Main: 173821952 11:44:33 INFO - PROCESS | 30529 | 11:44:36 INFO - PROCESS | 30529 | Cycle 1(1): loaded http://localhost:37077/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:37077/tests/kraken/driver.html?testName=imaging-desaturate) 11:44:37 INFO - PROCESS | 30529 | RSS: Main: 171569152 11:44:37 INFO - PROCESS | 30529 | 11:44:40 INFO - PROCESS | 30529 | Cycle 1(1): loaded http://localhost:37077/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:37077/tests/kraken/driver.html?testName=json-parse-financial) 11:44:40 INFO - PROCESS | 30529 | RSS: Main: 172630016 11:44:40 INFO - PROCESS | 30529 | 11:44:42 INFO - PROCESS | 30529 | Cycle 1(1): loaded http://localhost:37077/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:37077/tests/kraken/driver.html?testName=json-stringify-tinderbox) 11:44:43 INFO - PROCESS | 30529 | RSS: Main: 189542400 11:44:43 INFO - PROCESS | 30529 | 11:44:45 INFO - PROCESS | 30529 | Cycle 1(1): loaded http://localhost:37077/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:37077/tests/kraken/driver.html?testName=stanford-crypto-aes) 11:44:45 INFO - PROCESS | 30529 | RSS: Main: 186564608 11:44:45 INFO - PROCESS | 30529 | 11:44:47 INFO - PROCESS | 30529 | Cycle 1(1): loaded http://localhost:37077/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:37077/tests/kraken/driver.html?testName=stanford-crypto-ccm) 11:44:48 INFO - PROCESS | 30529 | RSS: Main: 197693440 11:44:48 INFO - PROCESS | 30529 | 11:44:50 INFO - PROCESS | 30529 | Cycle 1(1): loaded http://localhost:37077/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:37077/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 11:44:51 INFO - PROCESS | 30529 | RSS: Main: 204083200 11:44:51 INFO - PROCESS | 30529 | 11:44:53 INFO - PROCESS | 30529 | Cycle 1(1): loaded http://localhost:37077/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:37077/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 11:44:54 INFO - PROCESS | 30529 | RSS: Main: 202706944 11:44:54 INFO - PROCESS | 30529 | 11:44:56 INFO - PROCESS | 30529 | Cycle 1(1): loaded http://localhost:37077/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:37077/tests/kraken/driver.html?testName=ai-astar) 11:44:56 INFO - PROCESS | 30529 | RSS: Main: 264081408 11:44:56 INFO - PROCESS | 30529 | 11:44:56 INFO - PROCESS | 30529 | __start_tp_report 11:44:56 INFO - PROCESS | 30529 | _x_x_mozilla_page_load 11:44:56 INFO - PROCESS | 30529 | _x_x_mozilla_page_load_details 11:44:56 INFO - PROCESS | 30529 | |i|pagename|runs| 11:44:56 INFO - PROCESS | 30529 | |0;ai-astar;111;112;108;113;115;112;101;111;113;119 11:44:56 INFO - PROCESS | 30529 | |1;audio-beat-detection;159;139;167;186;134;156;161;141;182;136 11:44:56 INFO - PROCESS | 30529 | |2;audio-dft;163;160;161;160;159;160;161;162;164;164 11:44:56 INFO - PROCESS | 30529 | |3;audio-fft;74;77;105;99;74;73;73;116;99;75 11:44:56 INFO - PROCESS | 30529 | |4;audio-oscillator;93;95;138;93;94;94;153;94;94;139 11:44:56 INFO - PROCESS | 30529 | |5;imaging-gaussian-blur;117;116;117;117;116;116;117;117;117;117 11:44:56 INFO - PROCESS | 30529 | |6;imaging-darkroom;147;147;147;146;146;146;146;146;147;146 11:44:56 INFO - PROCESS | 30529 | |7;imaging-desaturate;95;96;96;95;95;96;95;95;95;96 11:44:56 INFO - PROCESS | 30529 | |8;json-parse-financial;64;65;63;63;69;64;63;72;61;61 11:44:56 INFO - PROCESS | 30529 | |9;json-stringify-tinderbox;63;64;65;64;65;65;64;64;64;64 11:44:56 INFO - PROCESS | 30529 | |10;stanford-crypto-aes;84;81;83;81;83;83;83;83;84;81 11:44:56 INFO - PROCESS | 30529 | |11;stanford-crypto-ccm;118;132;128;118;120;115;130;124;121;116 11:44:56 INFO - PROCESS | 30529 | |12;stanford-crypto-pbkdf2;131;131;141;139;147;129;141;135;131;145 11:44:56 INFO - PROCESS | 30529 | |13;stanford-crypto-sha256-iterative;67;67;67;66;66;66;65;69;65;66 11:44:56 INFO - PROCESS | 30529 | __end_tp_report 11:44:56 INFO - PROCESS | 30529 | __start_cc_report 11:44:56 INFO - PROCESS | 30529 | _x_x_mozilla_cycle_collect,1165 11:44:56 INFO - PROCESS | 30529 | __end_cc_report 11:44:56 INFO - PROCESS | 30529 | __startTimestamp1459277096498__endTimestamp 11:44:56 INFO - PROCESS | 30529 | 11:44:56 INFO - PROCESS | 30529 | ------- Summary: start ------- 11:44:56 INFO - PROCESS | 30529 | Number of tests: 14 11:44:56 INFO - PROCESS | 30529 | 11:44:56 INFO - PROCESS | 30529 | [#0] ai-astar Cycles:10 Average:111.50 Median:112.50 stddev:4.67 (4.2%) stddev-sans-first:4.95 11:44:56 INFO - PROCESS | 30529 | Values: 111.0 112.0 108.0 113.0 115.0 112.0 101.0 111.0 113.0 119.0 11:44:56 INFO - PROCESS | 30529 | 11:44:56 INFO - PROCESS | 30529 | [#1] audio-beat-detection Cycles:10 Average:156.10 Median:160.00 stddev:18.65 (11.7%) stddev-sans-first:19.75 11:44:56 INFO - PROCESS | 30529 | Values: 159.0 139.0 167.0 186.0 134.0 156.0 161.0 141.0 182.0 136.0 11:44:56 INFO - PROCESS | 30529 | 11:44:56 INFO - PROCESS | 30529 | [#2] audio-dft Cycles:10 Average:161.40 Median:161.50 stddev:1.78 (1.1%) stddev-sans-first:1.79 11:44:56 INFO - PROCESS | 30529 | Values: 163.0 160.0 161.0 160.0 159.0 160.0 161.0 162.0 164.0 164.0 11:44:56 INFO - PROCESS | 30529 | 11:44:56 INFO - PROCESS | 30529 | [#3] audio-fft Cycles:10 Average:86.50 Median:74.50 stddev:16.41 (22.0%) stddev-sans-first:16.77 11:44:56 INFO - PROCESS | 30529 | Values: 74.0 77.0 105.0 99.0 74.0 73.0 73.0 116.0 99.0 75.0 11:44:56 INFO - PROCESS | 30529 | 11:44:56 INFO - PROCESS | 30529 | [#4] audio-oscillator Cycles:10 Average:108.70 Median:94.00 stddev:24.23 (25.8%) stddev-sans-first:25.03 11:44:56 INFO - PROCESS | 30529 | Values: 93.0 95.0 138.0 93.0 94.0 94.0 153.0 94.0 94.0 139.0 11:44:56 INFO - PROCESS | 30529 | 11:44:56 INFO - PROCESS | 30529 | [#5] imaging-gaussian-blur Cycles:10 Average:116.70 Median:117.00 stddev:0.48 (0.4%) stddev-sans-first:0.50 11:44:56 INFO - PROCESS | 30529 | Values: 117.0 116.0 117.0 117.0 116.0 116.0 117.0 117.0 117.0 117.0 11:44:56 INFO - PROCESS | 30529 | 11:44:56 INFO - PROCESS | 30529 | [#6] imaging-darkroom Cycles:10 Average:146.40 Median:146.50 stddev:0.52 (0.4%) stddev-sans-first:0.50 11:44:56 INFO - PROCESS | 30529 | Values: 147.0 147.0 147.0 146.0 146.0 146.0 146.0 146.0 147.0 146.0 11:44:56 INFO - PROCESS | 30529 | 11:44:56 INFO - PROCESS | 30529 | [#7] imaging-desaturate Cycles:10 Average:95.40 Median:95.50 stddev:0.52 (0.5%) stddev-sans-first:0.53 11:44:56 INFO - PROCESS | 30529 | Values: 95.0 96.0 96.0 95.0 95.0 96.0 95.0 95.0 95.0 96.0 11:44:56 INFO - PROCESS | 30529 | 11:44:56 INFO - PROCESS | 30529 | [#8] json-parse-financial Cycles:10 Average:64.50 Median:64.00 stddev:3.47 (5.4%) stddev-sans-first:3.68 11:44:56 INFO - PROCESS | 30529 | Values: 64.0 65.0 63.0 63.0 69.0 64.0 63.0 72.0 61.0 61.0 11:44:56 INFO - PROCESS | 30529 | 11:44:56 INFO - PROCESS | 30529 | [#9] json-stringify-tinderbox Cycles:10 Average:64.20 Median:64.00 stddev:0.63 (1.0%) stddev-sans-first:0.50 11:44:56 INFO - PROCESS | 30529 | Values: 63.0 64.0 65.0 64.0 65.0 65.0 64.0 64.0 64.0 64.0 11:44:56 INFO - PROCESS | 30529 | 11:44:56 INFO - PROCESS | 30529 | [#10] stanford-crypto-aes Cycles:10 Average:82.60 Median:83.00 stddev:1.17 (1.4%) stddev-sans-first:1.13 11:44:56 INFO - PROCESS | 30529 | Values: 84.0 81.0 83.0 81.0 83.0 83.0 83.0 83.0 84.0 81.0 11:44:56 INFO - PROCESS | 30529 | 11:44:56 INFO - PROCESS | 30529 | [#11] stanford-crypto-ccm Cycles:10 Average:122.20 Median:122.50 stddev:6.01 (4.9%) stddev-sans-first:6.18 11:44:56 INFO - PROCESS | 30529 | Values: 118.0 132.0 128.0 118.0 120.0 115.0 130.0 124.0 121.0 116.0 11:44:56 INFO - PROCESS | 30529 | 11:44:56 INFO - PROCESS | 30529 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:137.00 Median:140.00 stddev:6.46 (4.6%) stddev-sans-first:6.48 11:44:56 INFO - PROCESS | 30529 | Values: 131.0 131.0 141.0 139.0 147.0 129.0 141.0 135.0 131.0 145.0 11:44:56 INFO - PROCESS | 30529 | 11:44:56 INFO - PROCESS | 30529 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:66.40 Median:66.50 stddev:1.17 (1.8%) stddev-sans-first:1.22 11:44:56 INFO - PROCESS | 30529 | Values: 67.0 67.0 67.0 66.0 66.0 66.0 65.0 69.0 65.0 66.0 11:44:56 INFO - PROCESS | 30529 | -------- Summary: end -------- 11:44:56 INFO - PROCESS | 30529 | 11:44:57 INFO - TEST-INFO | 30529: exit 0 11:44:57 INFO - TEST-OK | kraken | took 62205ms 11:44:57 INFO - SUITE-END | took 1181s 11:44:57 INFO - Completed test suite (00:19:41) 11:44:57 INFO - javascript benchmark 11:44:57 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [2597.753213444723, 2661.2548486423807, 2669.826461280018, 2677.71883952185, 2701.3246688327913, 4563.840265590705, 4598.333241679954, 4603.6777425580185, 4608.354830323753, 4633.235516139833, 4647.930281045787, 4685.7188568685815, 4721.102990431816, 4748.738819364934, 4762.7856746446405, 4190.811413486385, 4251.829926802932, 4291.184674911772, 4413.117376524692, 4434.268345722952, 4392.472903251598, 4430.9587246996925, 4450.465944086698, 4459.308807134883, 4487.259602165655, 4171.353440216772, 4234.449521562208, 4243.024104455962, 4322.092360604277, 4347.065380943112, 4315.935260971057, 4316.050468896838, 4320.351947207912, 4341.131773645252, 4361.171377438308, 4272.2950713132295, 4284.950187204155, 4315.287977483711, 4323.697341186118, 4336.306191009455, 4378.584034516716, 4548.636109111296, 4619.076184763027, 4622.075584883037, 4640.930386044212, 4996.375453068366, 5002.849914502571, 5003.874903127415, 5007.774650140753, 5041.823536176253, 4999.675021123651, 5012.649114561982, 5015.648904576681, 5016.573591244749, 5068.138416469209, 4581.977090114528, 4620.1221767864, 4710.199266124767, 4726.314684370747, 4730.124926888537, 5066.341375621146, 5067.619928505377, 5071.442141364447, 5095.210242412432, 5115.488451154854, 4872.049950259665, 4874.8537543873745, 4875.366202393666, 4884.4871288514905, 4914.778834952435, 4853.077915196172, 4965.751712414365, 4988.8752781180765, 5087.389513258433, 5097.745112744422, 4914.582260507826, 4927.408710954636, 4935.7532123393685, 4935.8519244422005, 4980.252962055721, 4919.4834542373255, 4921.975390123026, 4927.531884471041, 4930.8767280818265, 4980.7509624518625, 4188.246115699203, 4254.31930891056, 4254.617084462413, 4262.722923009995, 4265.1043280910735, 3729.701623870084, 3776.0371105368504, 3787.9431808522895, 3789.317922773872, 3791.848326066982, 4316.762578058174, 4321.9135617287475, 4329.307310830315, 4337.0458499130145, 4385.188740083095, 4993.750312484434, 5017.874553136201, 5025.849224523197, 5031.84904452867, 5060.898782024339, 4347.3261644445165, 4361.6510679145595, 4362.8691139265875, 4367.956320436819, 4406.647468202536, 4348.782560872007, 4553.271476563734, 4598.3102534620075, 4621.630269578425, 4638.79125439356, 4773.236282194832, 4776.5701086902345, 4795.064962332382, 4803.231482962709, 4842.7336496493035, 4925.975370123127, 5003.699778013331, 5006.148954677787, 5024.095662780588, 5068.341115654941, 4805.663603547718, 4806.255030470283, 4808.855734327975, 4839.322494850794, 4857.781399836945, 4812.51874812516, 4840.588549973291, 4846.927296090491, 4847.854564363075, 4889.266610008527, 4909.3126962224605, 4913.361263035782, 4916.0905232532095, 4959.62802789785, 5024.120778863758, 4762.047590481849, 4782.952170478251, 4785.449673287477, 4809.975950120227, 4831.685940413862, 4735.976320118378, 4767.928481072856, 4769.594584460359, 4773.976130119466, 4836.371271734652, 4635.884102897455, 4713.505081966344, 4771.1888978872985, 4777.378940737682, 4865.270209468466, 4898.559129678346, 4917.729524876167, 4921.163402221559, 4924.285978533164, 4926.778294976806, 4833.854984350475, 4837.733924634179, 4839.927401088916, 4840.419149702058, 4857.1742803724155], "unit": "score", "name": "dojo.html", "value": 4594.613778883473}, {"lowerIsBetter": false, "replicates": [499.5828483216514, 536.3081624704132, 536.8792021795099, 564.8813749112686, 572.6106247751527, 26661.33346666332, 27089.729102708992, 27107.32231694206, 35400.645993540056, 35871.0, 37903.0, 38272.0, 38320.80839595798, 38330.0, 38399.39207295128, 7601.619919004055, 7828.5694286814205, 7840.803979900519, 7841.843163136762, 7850.882236766424, 7574.621268936558, 7690.115636701767, 7714.305712485875, 7718.807029824271, 7723.111842138142, 7923.524588524678, 7957.641906114239, 7983.760487185394, 7989.121196668362, 8000.599970001505, 7841.333486653612, 7900.32847207988, 7902.999999999971, 7910.683572657087, 7911.0, 7773.106092799288, 7923.96038019812, 7928.127905930343, 7928.484648497887, 7931.167227441093, 37564.06089847748, 37733.43399848977, 38093.23813523714, 38107.0, 38155.427668584714, 3089.567460555524, 3238.4332741770095, 3238.935221295561, 3250.138713240993, 3288.8684452621865, 28834.134975950754, 29242.0, 29406.0, 29758.85120574383, 30255.848720756476, 3489.494023366623, 3544.068946255422, 3554.8400321985573, 3556.110972256936, 3576.517170182018, 244312.0, 249238.0, 249801.0, 250046.0, 250256.0, 58376.708116459995, 58396.0, 58845.41154588485, 58922.70538647365, 58966.41033589695, 63219.0, 63547.36452635507, 64375.67812160909, 64468.67765661141, 64520.0, 15073.698526029419, 15102.0, 15165.772513412308, 15285.38858445672, 15308.311125999357, 11556.94221528887, 11712.0, 11712.824307635392, 11730.354830484406, 11804.586839460577, 19914.203431862563, 20003.899980500006, 20073.498162546053, 20116.295929642685, 20127.496812579804, 7029.5430796998035, 7131.322524360177, 7365.447591430664, 7507.662155203029, 7553.962230188924, 866.6316815353449, 904.9230815380635, 929.6235024814961, 965.9613615455444, 999.8450240212778, 26721.599176012376, 28011.15966520967, 28093.719062809112, 28123.859380703376, 28182.43635127286, 919.3472634429496, 971.4025874087386, 974.1962880623514, 976.2043934193752, 1067.9480711499168, 13603.0, 13640.0, 13768.586942391745, 13847.930760346335, 13855.0, 348010.0, 355881.0, 356548.0, 356624.0, 357299.0, 49837.501624983284, 49981.25028124581, 50074.24888626674, 50339.49660503421, 50442.24336634953, 1066.589363095214, 1221.1451983611507, 1242.6147894152841, 1251.3993283223922, 1337.8662133786738, 24600.876995614908, 25745.356366090997, 26004.0, 26107.0, 26128.0, 39360.0, 39914.80042599768, 40109.0, 40149.3940242387, 40334.0, 187664.0, 189262.0, 198830.0, 198906.0, 201416.0, 26616.0, 31105.8444707775, 31546.842265788524, 31717.841410792797, 31868.203294917814, 37661.435078473296, 39201.80399097986, 39353.80323098366, 39543.0, 39758.60241397549, 33163.83418082894, 33230.83384583062, 33705.49441758425, 33745.15637109092, 33949.15127121842, 33678.32643347168, 33759.324813504085, 34329.485057724654, 34471.65528344785, 34496.48255276223, 33375.0, 33394.33211335808, 34184.0, 34203.48694769531, 34229.828850855585, 29329.266768330963, 29976.550351745176, 30119.0, 30551.54172687367, 30688.232794180323, 23671.526569468857, 24024.87987560051, 24119.995403241024, 24240.878795606615, 24348.634770478104], "unit": "score", "name": "ext.html", "value": 17202.353178756897}, {"lowerIsBetter": false, "replicates": [342.7771948233648, 352.84651176738123, 357.47714735227936, 358.290584642408, 364.0716173756919, 15631.531054068368, 16070.27683754231, 16123.0, 16562.50312490627, 16593.917030414832, 15303.69392612147, 15486.845131548682, 15509.457168999088, 15576.299066542004, 15759.133247671374, 5057.696538207711, 5129.948700512984, 5201.141811601081, 5204.115300398941, 5216.035033518792, 5024.949750502503, 5125.2055931330515, 5136.948630513684, 5173.0, 5178.093833579127, 5135.794568217286, 5138.871528211787, 5146.588272938156, 5147.279380886679, 5147.794088236466, 5047.0915235257635, 5232.502912223333, 5240.030594340059, 5247.186686063647, 5249.737513124329, 5041.344625198701, 5068.645194836363, 5070.366204224472, 5072.188449848043, 5072.442031376546, 11795.705107372385, 12470.75058498825, 12473.31396773177, 12480.375981200994, 12487.75024499514, 2052.10733331, 2053.1787285085934, 2240.2271216430304, 2324.5815753164425, 2424.2665498984998, 9341.673041443517, 9410.858837117448, 10320.845187322197, 12543.24740515563, 13033.087683862133, 1756.6837969165545, 1771.4597047900386, 1790.4270633397318, 1813.7732783402075, 1822.5352535103596, 60033.0, 61465.38534614642, 63730.68134659297, 64606.67696661487, 64738.67630661864, 9739.8425008592, 9773.65792197284, 9788.9021109788, 9794.314397992215, 9824.852627210455, 13443.596692099252, 13617.046806723632, 13632.591022269347, 13641.658958525917, 13653.658658533615, 7361.668724907392, 7367.4842761007285, 7427.702891884373, 7461.738839140713, 7511.812204694817, 7124.251953544906, 7164.21193668696, 7178.353948144692, 7197.856042879113, 7220.241874603196, 4267.701260911706, 4275.230458517434, 4294.849680261176, 4316.3093904975685, 4360.956390436118, 1772.5125590462726, 1789.7941736700445, 1791.758112654801, 1834.5780470491861, 1866.3654357518508, 837.5770236030887, 844.3161039557978, 855.2046596665161, 873.4584557574344, 907.8275127725711, 15191.544253672408, 15313.0, 15855.841441585668, 16018.359265629477, 16054.518364449084, 862.7368652560904, 863.7840539865034, 876.8071024374627, 889.6352495476953, 906.1889608800087, 9003.909960900439, 9359.719208423758, 9405.623775048922, 9435.386699864486, 9482.478463684425, 393990.0, 410361.0, 413645.0, 415636.0, 415786.0, 44036.11927761427, 44511.55488445139, 59300.0, 67387.32612673909, 69558.0, 927.096081320707, 941.1294552539011, 946.2288235088519, 956.9569369378395, 967.9370840895319, 11624.0, 14483.348249329016, 14621.0496317739, 14709.705805884036, 15169.165695886391, 30668.38663226678, 31802.522962155123, 31916.361672766878, 32126.83936580302, 32655.0, 39879.60120398875, 39949.0, 40273.19453610853, 40505.1898962025, 40623.59376406198, 7189.604571748604, 7403.7408690695565, 7432.293932076444, 7488.438367122379, 7539.0, 9308.860367094363, 10264.790467344603, 10969.177311701815, 11187.21689481761, 11205.775884482428, 9417.152456278967, 9701.854472183064, 9717.17404020666, 9802.705918822447, 10069.69790906274, 9320.95339523298, 9674.0, 9808.0, 10087.89912100899, 10143.391396516232, 9979.950100249453, 10264.486775661337, 10433.74795024602, 10688.519016644113, 10792.622258220925, 7318.377937875341, 7412.221716719882, 7417.147028091838, 7424.703011879465, 7463.2163622818825, 9430.19843313326, 10455.215858810772, 10483.633072842415, 10553.314034587727, 10679.412632305297], "unit": "score", "name": "jquery.html", "value": 7844.411104147225}, {"lowerIsBetter": false, "replicates": [1243.061488576125, 1390.6036779517838, 1404.6137312239132, 1538.3769573322802, 1770.9203085861127, 6857.45140388769, 7359.300866417689, 7512.361449276805, 7525.397968162548, 7532.849343013137, 7561.281678240573, 7707.0, 7710.498817576868, 7717.112532058815, 7725.768226953201, 1946.464722201399, 2227.676986836908, 2264.2188444986496, 2296.7588403217674, 2297.023764899919, 2293.7706229377013, 2298.3449716830705, 2302.458922153293, 2303.7581053989343, 2305.561943230789, 2204.492966617679, 2258.119333459952, 2265.3430505153488, 2268.7050683411217, 2269.500709843832, 2218.279059305724, 2226.1206823304865, 2271.1710225767642, 2290.667853161299, 2297.609406400899, 2254.3349711834885, 2265.082641530183, 2270.4096934796908, 2274.329072923475, 2309.434188623798, 7816.0, 7862.8820567690955, 7879.36965042801, 7879.960600196962, 7886.723964661267, 4746.52534746526, 4878.292647566119, 4887.877803054952, 4894.41267047953, 4896.828610998598, 3069.4321550513005, 3069.9539506907413, 3091.299080455192, 3103.596532450767, 3128.6089238845143, 956.4022485946283, 971.1502435369052, 985.069109691342, 1014.9035841595037, 1019.5157300282307, 10754.462276886125, 10760.946195269053, 10764.13886889047, 10790.082842958358, 10801.891981080245, 4307.590778876064, 4407.669424793154, 4489.595936365743, 4504.324351347324, 4511.909761804745, 9104.590293436811, 9157.542122893828, 9159.450432974043, 9202.539873006323, 9205.907940920639, 4227.788610569459, 4828.686135401258, 4832.420109586872, 4835.492273311252, 4843.346148270009, 4212.326027835532, 4292.441982542249, 4311.9784401077795, 4329.805158767863, 4338.219120558329, 3583.8566457341935, 3664.102294937704, 3681.3557627415094, 3685.0603096210293, 3709.5919448860604, 1194.3729541990351, 1224.3572124634638, 1232.6733415644862, 1235.8146278058364, 1238.3746208164819, 1234.5679012345606, 1238.386998435762, 1259.1123258103016, 1264.3551788587702, 1265.9303738294298, 7309.415246780245, 7407.555546667218, 7424.740134095388, 7427.108746950401, 7487.213842546563, 460.2773645376793, 469.16020323620336, 473.14597152140027, 478.0295999121719, 479.56838845039744, 5685.772569097273, 5727.570432217601, 5740.311162660508, 5741.052726300114, 5756.453136951983, 8967.551622418852, 9186.127317904788, 9190.448573085636, 9340.626374945063, 9369.390989585656, 9197.402168859002, 9251.67619133327, 9269.397489163182, 9294.535273236446, 9302.348835581579, 7187.89218161728, 7264.273572642799, 7529.2470752925365, 7558.206388329256, 7580.469367144247, 7178.641067946686, 7196.96401517989, 7234.96382518084, 7237.927620723936, 7244.166920804175, 8067.233612806774, 8215.630296636546, 8329.54187519668, 8390.244877961013, 8491.660333586835, 8420.200080992296, 8463.957680211806, 8511.531865747444, 8524.147585241426, 8682.956585217033, 6070.696465176812, 6474.384933431316, 6524.1192439022025, 6704.161979752531, 6790.490713196629, 7374.815629609088, 7391.186969433251, 7401.0748656417945, 7413.406927445683, 7433.145188303414, 6453.774117905851, 6506.967465162644, 6614.140161779131, 6639.933600663931, 6714.4292735116105, 6649.301823308677, 6669.166354205724, 6681.09805176295, 6694.196696396463, 6751.831204219934, 6616.867662646624, 6670.566413183127, 6701.564398314094, 6865.5537390069485, 6871.622060786704, 6468.8059358219325, 6662.367075127855, 6668.966655166693, 6672.5329226953645, 6678.365555272241, 6437.871242575028, 6440.67796610177, 6456.0, 6465.967670161619, 6471.935280647133], "unit": "score", "name": "mootools.html", "value": 4369.840491468622}, {"lowerIsBetter": false, "replicates": [317.088370933566, 321.36530352553694, 322.1254294590188, 326.45482044984874, 329.12945259787864, 5241.161414173728, 5333.120035194193, 5339.946600533994, 5358.866028349288, 5386.218998245252, 5256.342957130359, 5269.420363759983, 5274.525292723654, 5279.41926388097, 5294.708791016493, 3931.60683931606, 4026.516817981846, 4111.424400583921, 4154.709170358076, 4156.625903668669, 4147.958520414787, 4162.105147393309, 4163.125743593849, 4164.146349998243, 4166.166766646667, 4105.014796448861, 4111.753294802322, 4118.0, 4119.908224320558, 4121.196366708493, 3913.941290880639, 4013.3578627419765, 4125.793710314472, 4137.275976704095, 4153.480814898137, 3642.562892452896, 3672.173760903802, 3675.6691897729334, 3682.6317368263226, 3692.2061756722164, 5065.4174769901565, 5074.441811400743, 5101.693898366073, 5102.260172275037, 5111.284420181178, 4777.8327758528285, 4799.2801079837955, 4800.183968725325, 4803.03939212159, 4806.519348065201, 5586.636868603528, 5601.327840659106, 5605.80379686709, 5607.607467477278, 5615.747291371898, 4039.979800100981, 4049.736767110158, 4053.0, 4054.594540545922, 4054.837806487737, 5722.246460159459, 5820.417958204188, 5870.11948207768, 5872.530197584183, 5887.4406931341455, 4128.401381799622, 4144.70987030911, 4144.772037537964, 4149.522804877478, 4153.293940030202, 4198.5591512891315, 4203.306454434984, 4207.0, 4217.599328063829, 4218.156368726267, 4767.856964291077, 4779.976100119477, 4781.641376896747, 4781.947971446276, 4784.473707892129, 5587.3015873015875, 5598.748056337393, 5610.885958293186, 5615.943840561542, 5617.634853734494, 1456.7596346602693, 1487.5611694550134, 1490.7242160200399, 1491.1574960147482, 1492.060002198608, 900.0864122915247, 920.7559996600907, 956.9043095690375, 999.3154689038032, 1021.1320377679062, 4867.732274724854, 4959.156943319572, 4968.22992436173, 4978.452370239271, 4980.327655766425, 5741.569382296345, 5750.338711048283, 5755.424457554295, 5762.452567006211, 5763.337216220105, 4916.287138364917, 4919.0899683558655, 4923.803047878045, 4934.037862616827, 4939.333190019373, 3074.0624109646774, 3118.3295591447495, 3134.044116544476, 3145.418097651942, 3145.7168854803176, 5578.748956296977, 5583.664980101207, 5585.441455854382, 5597.608167428322, 5597.720113994365, 5825.676460514366, 5930.183162997541, 6003.189569408074, 6005.279366475964, 6006.279246490449, 5555.194496798023, 5568.972155139199, 5571.498565129158, 5574.386817449996, 5575.581831362664, 5844.590878638454, 5846.444587764156, 5847.06446968483, 5850.619709718854, 5852.590318677651, 5696.658200507983, 5723.3418156912485, 5731.8567035824435, 5741.2536370273265, 5745.0, 5576.386597474356, 5578.107502799533, 5582.748776305158, 5587.888242235052, 5594.776208951759, 3857.9421308680953, 4019.1961607677995, 4049.493813273341, 4053.635172834459, 4059.79701014954, 5789.015867302653, 5794.710264486843, 5803.332616749128, 5809.24479817621, 5815.04051831443, 5609.102543593006, 5610.7755689773585, 5611.270534830446, 5613.775448982158, 5617.775288988395, 5582.8325150245555, 5597.608167428404, 5609.186667933209, 5611.074172761449, 5617.719114044363, 5508.9724551376985, 5517.0, 5520.779168833202, 5526.91709624364, 5531.640443371168, 5417.404085550507, 5641.294838145232, 5657.12314591239, 5688.943110568841, 5705.087186050212, 5527.170924361378, 5556.388797232382, 5558.082916318924, 5562.22128901946, 5564.805231816867], "unit": "score", "name": "prototype.html", "value": 4242.247752005661}, {"lowerIsBetter": false, "replicates": [668.7826456401671, 679.687343821842, 767.0488594143261, 792.9127795942449, 816.6733306677332, 11987.580434684787, 12096.939515302432, 12109.939450302758, 12121.0, 12125.878741212586, 12192.329421881794, 12274.140810143272, 13415.12801667891, 14002.719945601082, 14017.719645607081, 796.5937371940295, 808.0908977400425, 808.2119933065273, 809.4617079642031, 809.7165991902846, 652.3574279334875, 793.5992323876434, 804.5775967616989, 815.0382548592659, 819.0, 843.026304618164, 845.4039901869198, 845.6110189312924, 846.2299307630058, 849.1084361420484, 838.7399906029151, 840.9032961209448, 841.0118111219324, 841.7096101844854, 844.2233145506149, 498.35960790384183, 607.7295603456464, 618.780332981794, 618.928823185335, 619.0281258424276, 12254.754904901942, 12265.509379624893, 12272.754544909141, 12288.569900053544, 12357.814632780515, 11817.881821181763, 11864.822027669592, 12020.51917923282, 12024.098192635587, 12397.070219733556, 9933.850992235122, 10109.34289271195, 10122.089011988883, 10127.848082278771, 10493.475326233658, 3350.279689866666, 3411.0619579615554, 3425.3320602482527, 3486.3027394521196, 3490.022793617791, 45637.771811141065, 46354.76822615933, 46420.30369544459, 46520.767396163144, 46556.0, 9294.302927280482, 9452.52737363129, 9471.479068651153, 9496.240300775922, 9521.0, 15117.0, 15123.0, 15178.165200913834, 15195.316210770541, 15234.847651523565, 6413.775517856946, 6659.433948114368, 6718.260991290954, 6796.35434633709, 6806.0, 3759.736818422739, 3774.7923864187183, 3784.6026167252594, 3809.0, 3871.341871881787, 2814.957775633367, 2856.3287627407544, 2858.1282708773606, 2882.654081510232, 2944.160914139503, 527.5568522441168, 531.7155321902841, 538.1470369464364, 539.3042974562849, 540.5162379670173, 567.1775924908816, 588.5968111843401, 592.2094004503949, 596.6002778138658, 599.9130126131773, 6672.2994085621285, 7408.814779630552, 7558.168601453835, 7568.810779730551, 7718.845623087619, 460.1464283753656, 509.35820865709474, 550.7989583801883, 562.5134258866051, 581.5841673203595, 3438.2607739336163, 3449.6550344965303, 3533.5229743984232, 3585.6055833858254, 3598.5861625913353, 51040.0, 51362.22956655653, 51385.0, 51885.740571296905, 52484.0, 43142.56857431385, 43520.564794352285, 43998.0, 44090.0, 44145.33781993273, 41647.0, 43473.347899781525, 43810.56189438065, 43838.7808060964, 43906.34140487895, 8098.51408915467, 8343.332533397435, 8689.695860644848, 8705.956470217609, 8884.156005179497, 32329.51505727369, 32330.515042273913, 32970.17574560559, 33094.33811323808, 33374.165645859044, 39827.0, 41143.17713645651, 41784.58215417807, 41839.58160418357, 42322.78838605787, 10328.793424131625, 10407.271490995558, 10413.9479302603, 10574.365538067741, 10703.732406689584, 11404.885951140383, 11442.141839362248, 11508.654740357802, 11570.652880413601, 12677.87322126767, 9771.902280977383, 11018.614348497764, 11301.0, 11337.943310283395, 11863.466144023712, 10748.0, 10808.891911081104, 11132.944335278271, 11472.196946214019, 11502.82745758831, 10833.349999000086, 11032.724181895195, 11623.6512904613, 11631.127665424958, 11993.82009269879, 9688.806223875625, 9892.208623310262, 9989.900100998897, 10029.99700029991, 10121.38708218841, 9070.954645226731, 9168.35821492489, 9307.534623268944, 9447.448813137142, 9492.145706886136], "unit": "score", "name": "yui.html", "value": 5917.459340717148}], "name": "dromaeo_css", "value": 6389.096131576035}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [111.0, 112.0, 108.0, 113.0, 115.0, 112.0, 101.0, 111.0, 113.0, 119.0], "unit": "score", "name": "ai-astar", "value": 111.5}, {"lowerIsBetter": true, "replicates": [159.0, 139.0, 167.0, 186.0, 134.0, 156.0, 161.0, 141.0, 182.0, 136.0], "unit": "score", "name": "audio-beat-detection", "value": 156.1}, {"lowerIsBetter": true, "replicates": [163.0, 160.0, 161.0, 160.0, 159.0, 160.0, 161.0, 162.0, 164.0, 164.0], "unit": "score", "name": "audio-dft", "value": 161.4}, {"lowerIsBetter": true, "replicates": [74.0, 77.0, 105.0, 99.0, 74.0, 73.0, 73.0, 116.0, 99.0, 75.0], "unit": "score", "name": "audio-fft", "value": 86.5}, {"lowerIsBetter": true, "replicates": [93.0, 95.0, 138.0, 93.0, 94.0, 94.0, 153.0, 94.0, 94.0, 139.0], "unit": "score", "name": "audio-oscillator", "value": 108.7}, {"lowerIsBetter": true, "replicates": [117.0, 116.0, 117.0, 117.0, 116.0, 116.0, 117.0, 117.0, 117.0, 117.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 116.7}, {"lowerIsBetter": true, "replicates": [147.0, 147.0, 147.0, 146.0, 146.0, 146.0, 146.0, 146.0, 147.0, 146.0], "unit": "score", "name": "imaging-darkroom", "value": 146.4}, {"lowerIsBetter": true, "replicates": [95.0, 96.0, 96.0, 95.0, 95.0, 96.0, 95.0, 95.0, 95.0, 96.0], "unit": "score", "name": "imaging-desaturate", "value": 95.4}, {"lowerIsBetter": true, "replicates": [64.0, 65.0, 63.0, 63.0, 69.0, 64.0, 63.0, 72.0, 61.0, 61.0], "unit": "score", "name": "json-parse-financial", "value": 64.5}, {"lowerIsBetter": true, "replicates": [63.0, 64.0, 65.0, 64.0, 65.0, 65.0, 64.0, 64.0, 64.0, 64.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 64.2}, {"lowerIsBetter": true, "replicates": [84.0, 81.0, 83.0, 81.0, 83.0, 83.0, 83.0, 83.0, 84.0, 81.0], "unit": "score", "name": "stanford-crypto-aes", "value": 82.6}, {"lowerIsBetter": true, "replicates": [118.0, 132.0, 128.0, 118.0, 120.0, 115.0, 130.0, 124.0, 121.0, 116.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 122.2}, {"lowerIsBetter": true, "replicates": [131.0, 131.0, 141.0, 139.0, 147.0, 129.0, 141.0, 135.0, 131.0, 145.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 137.0}, {"lowerIsBetter": true, "replicates": [67.0, 67.0, 67.0, 66.0, 66.0, 66.0, 65.0, 69.0, 65.0, 66.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 66.4}], "name": "kraken", "value": 1519.6000000000001}]} 11:44:57 INFO - Return code: 0 11:44:57 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 11:44:57 ERROR - # TBPL SUCCESS # 11:44:57 INFO - Running post-action listener: _resource_record_post_action 11:44:57 INFO - Running post-run listener: _resource_record_post_run 11:44:58 INFO - Total resource usage - Wall time: 1199s; CPU: 13.0%; Read bytes: 4096; Write bytes: 518553600; Read time: 20; Write time: 1144272 11:44:58 INFO - install - Wall time: 17s; CPU: 17.0%; Read bytes: 0; Write bytes: 233127936; Read time: 0; Write time: 700320 11:44:58 INFO - run-tests - Wall time: 1183s; CPU: 13.0%; Read bytes: 4096; Write bytes: 285425664; Read time: 20; Write time: 443952 11:44:58 INFO - Running post-run listener: _upload_blobber_files 11:44:58 INFO - Blob upload gear active. 11:44:58 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 11:44:58 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 11:44:58 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'] 11:44:58 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 11:44:59 INFO - (blobuploader) - INFO - Open directory for files ... 11:44:59 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 11:44:59 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:44:59 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:45:00 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 11:45:00 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:45:00 INFO - (blobuploader) - INFO - Done attempting. 11:45:00 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 11:45:00 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:45:00 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:45:00 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 11:45:00 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:45:00 INFO - (blobuploader) - INFO - Done attempting. 11:45:00 INFO - (blobuploader) - INFO - Iteration through files over. 11:45:01 INFO - Return code: 0 11:45:01 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 11:45:01 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 11:45:01 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/f218d138ea9ca9a4d265732ec643aca054a7f393716fc51f05e601a1a5910a1585a15873d296e66e4f7aeaed7cf63c1449809c2b45e533d9393a8149ac8bb8cc", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/741a532e4201cff3077583e8217a98a413207e1b8d72f7088839cba21e7c4896bad3b98f026eb57de237acad8eaf23b497c264f1c8193ed75a7b4ef631afa57e"} 11:45:01 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 11:45:01 INFO - Writing to file /builds/slave/test/properties/blobber_files 11:45:01 INFO - Contents: 11:45:01 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/f218d138ea9ca9a4d265732ec643aca054a7f393716fc51f05e601a1a5910a1585a15873d296e66e4f7aeaed7cf63c1449809c2b45e533d9393a8149ac8bb8cc", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/741a532e4201cff3077583e8217a98a413207e1b8d72f7088839cba21e7c4896bad3b98f026eb57de237acad8eaf23b497c264f1c8193ed75a7b4ef631afa57e"} 11:45:01 INFO - Running post-run listener: copy_logs_to_upload_dir 11:45:01 INFO - Copying logs to upload dir... 11:45:01 INFO - mkdir: /builds/slave/test/build/upload/logs 11:45:01 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1248.702969 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 48 secs) (at 2016-03-29 11:45:00.849832) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-03-29 11:45:00.853054) ========= 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=745a4373a2a16df560f216e000000264-1459275715.420491-752098626 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/f218d138ea9ca9a4d265732ec643aca054a7f393716fc51f05e601a1a5910a1585a15873d296e66e4f7aeaed7cf63c1449809c2b45e533d9393a8149ac8bb8cc", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/741a532e4201cff3077583e8217a98a413207e1b8d72f7088839cba21e7c4896bad3b98f026eb57de237acad8eaf23b497c264f1c8193ed75a7b4ef631afa57e"} build_url:https://queue.taskcluster.net/v1/task/XLewxWcOS4eHcaHfEAyOLA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011377 build_url: 'https://queue.taskcluster.net/v1/task/XLewxWcOS4eHcaHfEAyOLA/artifacts/public/build/firefox-48.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/f218d138ea9ca9a4d265732ec643aca054a7f393716fc51f05e601a1a5910a1585a15873d296e66e4f7aeaed7cf63c1449809c2b45e533d9393a8149ac8bb8cc", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/741a532e4201cff3077583e8217a98a413207e1b8d72f7088839cba21e7c4896bad3b98f026eb57de237acad8eaf23b497c264f1c8193ed75a7b4ef631afa57e"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-03-29 11:45:00.877790) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-03-29 11:45:00.878112) ========= 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=745a4373a2a16df560f216e000000264-1459275715.420491-752098626 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004538 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-03-29 11:45:00.960730) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-29 11:45:00.961066) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-29 11:45:00.961378) ========= ========= Total master_lag: 0.30 =========