builder: fx-team_ubuntu64_hw_test-dromaeojs slave: talos-linux64-ix-057 starttime: 1450696840.93 results: success (0) buildid: 20151221022728 builduid: ee993f99361c4e4f96aa86421fbf6268 revision: b76ea647debcadd234066150c78b3bba77a50c74 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-12-21 03:20:40.934916) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-12-21 03:20:40.935351) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-12-21 03:20:40.935654) ========= 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=6b42339bb4b96cfc3b1ae7e5000001a3-1450696377.733355-1385016550 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test program finished with exit code 0 elapsedTime=0.006371 basedir: '/builds/slave/test' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-12-21 03:20:40.966992) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-12-21 03:20:40.967266) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-12-21 03:20:40.991949) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-21 03:20:40.992260) ========= 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=6b42339bb4b96cfc3b1ae7e5000001a3-1450696377.733355-1385016550 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004719 ========= master_lag: 0.07 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-21 03:20:41.065127) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-12-21 03:20:41.065428) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-12-21 03:20:41.065806) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-12-21 03:20:41.066163) ========= 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=6b42339bb4b96cfc3b1ae7e5000001a3-1450696377.733355-1385016550 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2015-12-21 03:20:41-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 40.3M=0s 2015-12-21 03:20:41 (40.3 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.115303 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-12-21 03:20:41.205833) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-21 03:20:41.206146) ========= 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=6b42339bb4b96cfc3b1ae7e5000001a3-1450696377.733355-1385016550 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.015124 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-21 03:20:41.265374) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2015-12-21 03:20:41.265732) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev b76ea647debcadd234066150c78b3bba77a50c74 --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 b76ea647debcadd234066150c78b3bba77a50c74 --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=6b42339bb4b96cfc3b1ae7e5000001a3-1450696377.733355-1385016550 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2015-12-21 03:20:42,110 truncating revision to first 12 chars 2015-12-21 03:20:42,111 Setting DEBUG logging. 2015-12-21 03:20:42,111 attempt 1/10 2015-12-21 03:20:42,111 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/b76ea647debc?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-12-21 03:20:43,302 unpacking tar archive at: fx-team-b76ea647debc/testing/mozharness/ program finished with exit code 0 elapsedTime=1.472860 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2015-12-21 03:20:42.752694) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-12-21 03:20:42.752960) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-12-21 03:20:42.763125) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-12-21 03:20:42.763371) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-12-21 03:20:42.763735) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 13 secs) (at 2015-12-21 03:20:42.764048) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --system-bits 64 --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', '--system-bits', '64', '--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=6b42339bb4b96cfc3b1ae7e5000001a3-1450696377.733355-1385016550 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 03:20:43 INFO - MultiFileLogger online at 20151221 03:20:43 in /builds/slave/test 03:20:43 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --system-bits 64 --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO 03:20:43 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 03:20:43 INFO - {'append_to_log': False, 03:20:43 INFO - 'base_work_dir': '/builds/slave/test', 03:20:43 INFO - 'blob_upload_branch': 'Fx-Team-Non-PGO', 03:20:43 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 03:20:43 INFO - 'branch': 'Fx-Team-Non-PGO', 03:20:43 INFO - 'buildbot_json_path': 'buildprops.json', 03:20:43 INFO - 'config_files': ('talos/linux_config.py',), 03:20:43 INFO - 'default_actions': ('clobber', 03:20:43 INFO - 'read-buildbot-config', 03:20:43 INFO - 'download-and-extract', 03:20:43 INFO - 'populate-webroot', 03:20:43 INFO - 'create-virtualenv', 03:20:43 INFO - 'install', 03:20:43 INFO - 'run-tests'), 03:20:43 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 03:20:43 INFO - 'download_minidump_stackwalk': True, 03:20:43 INFO - 'download_symbols': 'ondemand', 03:20:43 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 03:20:43 INFO - 'tooltool.py': '/tools/tooltool.py', 03:20:43 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 03:20:43 INFO - '/tools/misc-python/virtualenv.py')}, 03:20:43 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 03:20:43 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 03:20:43 INFO - 'installer_path': 'installer.exe', 03:20:43 INFO - 'log_level': 'info', 03:20:43 INFO - 'log_name': 'talos', 03:20:43 INFO - 'log_to_console': True, 03:20:43 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 03:20:43 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 03:20:43 INFO - 'opt_config_files': (), 03:20:43 INFO - 'pip_index': False, 03:20:43 INFO - 'sps_profile': False, 03:20:43 INFO - 'sps_profile_interval': 0, 03:20:43 INFO - 'suite': 'dromaeojs', 03:20:43 INFO - 'system_bits': '64', 03:20:43 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 03:20:43 INFO - 'title': 'talos-linux64-ix-057', 03:20:43 INFO - 'tooltool_cache': '/builds/tooltool_cache', 03:20:43 INFO - 'use_talos_json': True, 03:20:43 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 03:20:43 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 03:20:43 INFO - 'work_dir': 'build'} 03:20:43 INFO - ##### 03:20:43 INFO - ##### Running clobber step. 03:20:43 INFO - ##### 03:20:43 INFO - Running pre-action listener: _resource_record_pre_action 03:20:43 INFO - Running main action method: clobber 03:20:43 INFO - rmtree: /builds/slave/test/build 03:20:43 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 03:20:44 INFO - Running post-action listener: _resource_record_post_action 03:20:44 INFO - ##### 03:20:44 INFO - ##### Running read-buildbot-config step. 03:20:44 INFO - ##### 03:20:44 INFO - Running pre-action listener: _resource_record_pre_action 03:20:44 INFO - Running main action method: read_buildbot_config 03:20:44 INFO - Using buildbot properties: 03:20:44 INFO - { 03:20:44 INFO - "project": "", 03:20:44 INFO - "product": "firefox", 03:20:44 INFO - "script_repo_revision": "production", 03:20:44 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs", 03:20:44 INFO - "repository": "", 03:20:44 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team talos dromaeojs", 03:20:44 INFO - "buildid": "20151221022728", 03:20:44 INFO - "pgo_build": "False", 03:20:44 INFO - "basedir": "/builds/slave/test", 03:20:44 INFO - "buildnumber": 2234, 03:20:44 INFO - "slavename": "talos-linux64-ix-057", 03:20:44 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 03:20:44 INFO - "platform": "ubuntu64_hw", 03:20:44 INFO - "scheduler": "tests-fx-team-linux64-talos", 03:20:44 INFO - "branch": "fx-team", 03:20:44 INFO - "repo_path": "integration/fx-team", 03:20:44 INFO - "revision": "b76ea647debcadd234066150c78b3bba77a50c74", 03:20:44 INFO - "stage_platform": "linux64", 03:20:44 INFO - "builduid": "ee993f99361c4e4f96aa86421fbf6268", 03:20:44 INFO - "slavebuilddir": "test" 03:20:44 INFO - } 03:20:44 INFO - Found installer url https://queue.taskcluster.net/v1/task/cbGO6asBRYiIn6eCmUh3iA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2. 03:20:44 INFO - Running post-action listener: _resource_record_post_action 03:20:44 INFO - ##### 03:20:44 INFO - ##### Running download-and-extract step. 03:20:44 INFO - ##### 03:20:44 INFO - Running pre-action listener: _resource_record_pre_action 03:20:44 INFO - Running main action method: download_and_extract 03:20:44 INFO - mkdir: /builds/slave/test/build/tests 03:20:44 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')]} 03:20:44 INFO - https://queue.taskcluster.net/v1/task/cbGO6asBRYiIn6eCmUh3iA/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 03:20:44 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cbGO6asBRYiIn6eCmUh3iA/artifacts/public/build/test_packages.json 03:20:44 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cbGO6asBRYiIn6eCmUh3iA/artifacts/public/build/test_packages.json 03:20:44 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cbGO6asBRYiIn6eCmUh3iA/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 03:20:44 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cbGO6asBRYiIn6eCmUh3iA/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 03:20:44 INFO - Downloaded 1302 bytes. 03:20:44 INFO - Reading from file /builds/slave/test/build/test_packages.json 03:20:44 INFO - Using the following test package requirements: 03:20:44 INFO - {u'common': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 03:20:44 INFO - u'cppunittest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 03:20:44 INFO - u'firefox-46.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 03:20:44 INFO - u'jittest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 03:20:44 INFO - u'jsshell-linux-x86_64.zip'], 03:20:44 INFO - u'mochitest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 03:20:44 INFO - u'firefox-46.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 03:20:44 INFO - u'mozbase': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 03:20:44 INFO - u'reftest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 03:20:44 INFO - u'firefox-46.0a1.en-US.linux-x86_64.reftest.tests.zip'], 03:20:44 INFO - u'talos': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 03:20:44 INFO - u'firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'], 03:20:44 INFO - u'web-platform': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 03:20:44 INFO - u'firefox-46.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 03:20:44 INFO - u'webapprt': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 03:20:44 INFO - u'xpcshell': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 03:20:44 INFO - u'firefox-46.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 03:20:44 INFO - Downloading packages: [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 03:20:44 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')]} 03:20:44 INFO - https://queue.taskcluster.net/v1/task/cbGO6asBRYiIn6eCmUh3iA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 03:20:44 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cbGO6asBRYiIn6eCmUh3iA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 03:20:44 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cbGO6asBRYiIn6eCmUh3iA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 03:20:44 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cbGO6asBRYiIn6eCmUh3iA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 03:20:44 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cbGO6asBRYiIn6eCmUh3iA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 03:20:45 INFO - Downloaded 21872529 bytes. 03:20:45 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] in /builds/slave/test/build/tests 03:20:45 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 03:20:45 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] with output_timeout 1760 03:20:46 INFO - Return code: 0 03:20:46 INFO - Downloading packages: [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 03:20:46 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')]} 03:20:46 INFO - https://queue.taskcluster.net/v1/task/cbGO6asBRYiIn6eCmUh3iA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 03:20:46 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cbGO6asBRYiIn6eCmUh3iA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 03:20:46 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cbGO6asBRYiIn6eCmUh3iA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 03:20:46 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cbGO6asBRYiIn6eCmUh3iA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 03:20:46 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cbGO6asBRYiIn6eCmUh3iA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 03:20:51 INFO - Downloaded 21872529 bytes. 03:20:51 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] in /builds/slave/test/build/tests 03:20:51 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 03:20:51 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] with output_timeout 1760 03:20:53 INFO - Return code: 0 03:20:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:20:53 INFO - https://queue.taskcluster.net/v1/task/cbGO6asBRYiIn6eCmUh3iA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 03:20:53 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cbGO6asBRYiIn6eCmUh3iA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 03:20:53 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cbGO6asBRYiIn6eCmUh3iA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 03:20:53 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cbGO6asBRYiIn6eCmUh3iA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 03:20:53 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cbGO6asBRYiIn6eCmUh3iA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 03:20:54 INFO - Downloaded 11132039 bytes. 03:20:54 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'] in /builds/slave/test/build/tests 03:20:54 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 03:20:54 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'] with output_timeout 1760 03:20:54 INFO - Return code: 0 03:20:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:20:54 INFO - https://queue.taskcluster.net/v1/task/cbGO6asBRYiIn6eCmUh3iA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 03:20:54 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cbGO6asBRYiIn6eCmUh3iA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 03:20:54 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cbGO6asBRYiIn6eCmUh3iA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 03:20:54 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cbGO6asBRYiIn6eCmUh3iA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 03:20:54 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cbGO6asBRYiIn6eCmUh3iA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 03:20:58 INFO - Downloaded 53069831 bytes. 03:20:58 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/cbGO6asBRYiIn6eCmUh3iA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 03:20:58 INFO - mkdir: /builds/slave/test/properties 03:20:58 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 03:20:58 INFO - Writing to file /builds/slave/test/properties/build_url 03:20:58 INFO - Contents: 03:20:58 INFO - build_url:https://queue.taskcluster.net/v1/task/cbGO6asBRYiIn6eCmUh3iA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 03:20:58 INFO - Running post-action listener: _resource_record_post_action 03:20:58 INFO - Running post-action listener: set_extra_try_arguments 03:20:58 INFO - ##### 03:20:58 INFO - ##### Running populate-webroot step. 03:20:58 INFO - ##### 03:20:58 INFO - Running pre-action listener: _resource_record_pre_action 03:20:58 INFO - Running main action method: populate_webroot 03:20:58 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 03:20:58 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 03:20:58 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 03:20:58 INFO - '--tppagecycles', 03:20:58 INFO - '7'], 03:20:58 INFO - 'tests': ['tsvgm']}}, 03:20:58 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 03:20:58 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 03:20:58 INFO - 'tests': ['tresize', 'tcanvasmark']}, 03:20:58 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 03:20:58 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 03:20:58 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 03:20:58 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:20:58 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 03:20:58 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:20:58 INFO - 'talos_options': ['--e10s'], 03:20:58 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 03:20:58 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:20:58 INFO - 'tests': ['damp', 'tps']}, 03:20:58 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:20:58 INFO - 'talos_options': ['--e10s'], 03:20:58 INFO - 'tests': ['damp', 'tps']}, 03:20:58 INFO - 'g3': {'tests': ['dromaeo_dom']}, 03:20:58 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 03:20:58 INFO - 'other': {'tests': ['a11yr', 03:20:58 INFO - 'ts_paint', 03:20:58 INFO - 'tpaint', 03:20:58 INFO - 'sessionrestore', 03:20:58 INFO - 'sessionrestore_no_auto_restore']}, 03:20:58 INFO - 'other-e10s': {'talos_options': ['--e10s'], 03:20:58 INFO - 'tests': ['a11yr', 03:20:58 INFO - 'ts_paint', 03:20:58 INFO - 'tpaint', 03:20:58 INFO - 'sessionrestore', 03:20:58 INFO - 'sessionrestore_no_auto_restore']}, 03:20:58 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 03:20:58 INFO - 'tests': ['a11yr', 03:20:58 INFO - 'ts_paint', 03:20:58 INFO - 'tpaint', 03:20:58 INFO - 'sessionrestore', 03:20:58 INFO - 'sessionrestore_no_auto_restore']}, 03:20:58 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 03:20:58 INFO - 'tests': ['a11yr', 03:20:58 INFO - 'ts_paint', 03:20:58 INFO - 'tpaint', 03:20:58 INFO - 'sessionrestore', 03:20:58 INFO - 'sessionrestore_no_auto_restore']}, 03:20:58 INFO - 'other_l64': {'tests': ['a11yr', 03:20:58 INFO - 'ts_paint', 03:20:58 INFO - 'tpaint', 03:20:58 INFO - 'sessionrestore', 03:20:58 INFO - 'sessionrestore_no_auto_restore']}, 03:20:58 INFO - 'other_nol64': {'tests': ['a11yr', 03:20:58 INFO - 'ts_paint', 03:20:58 INFO - 'tpaint', 03:20:58 INFO - 'sessionrestore', 03:20:58 INFO - 'sessionrestore_no_auto_restore']}, 03:20:58 INFO - 'svgr': {'tests': ['tsvgx', 03:20:58 INFO - 'tsvgr_opacity', 03:20:58 INFO - 'tart', 03:20:58 INFO - 'tscrollx', 03:20:58 INFO - 'cart']}, 03:20:58 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 03:20:58 INFO - 'tests': ['tsvgx', 03:20:58 INFO - 'tsvgr_opacity', 03:20:58 INFO - 'tart', 03:20:58 INFO - 'tscrollx', 03:20:58 INFO - 'cart']}, 03:20:58 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:20:58 INFO - 'tests': ['tp5o']}, 03:20:58 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:20:58 INFO - 'talos_options': ['--e10s'], 03:20:58 INFO - 'tests': ['tp5o']}, 03:20:58 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:20:58 INFO - 'talos_options': ['--xperf_path', 03:20:58 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 03:20:58 INFO - 'tests': ['tp5n']}, 03:20:58 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:20:58 INFO - 'talos_options': ['--e10s', 03:20:58 INFO - '--xperf_path', 03:20:58 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 03:20:58 INFO - 'tests': ['tp5n']}}, 03:20:58 INFO - 'talos.zip': {'path': '', 03:20:58 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 03:20:58 INFO - Running post-action listener: _resource_record_post_action 03:20:58 INFO - ##### 03:20:58 INFO - ##### Running create-virtualenv step. 03:20:58 INFO - ##### 03:20:58 INFO - Running pre-action listener: _resource_record_pre_action 03:20:58 INFO - Running main action method: create_virtualenv 03:20:58 INFO - Creating virtualenv /builds/slave/test/build/venv 03:20:58 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 03:20:58 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 03:20:58 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 03:20:58 INFO - Using real prefix '/usr' 03:20:58 INFO - New python executable in /builds/slave/test/build/venv/bin/python 03:20:59 INFO - Installing distribute.............................................................................................................................................................................................done. 03:21:01 INFO - Installing pip.................done. 03:21:01 INFO - Return code: 0 03:21:01 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 03:21:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:21:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:21:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:21:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:21:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:01 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7f814b8a0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x186e8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x193c240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19cb0b0>, '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 0x19cbfb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19cc440>, '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': '6b42339bb4b96cfc3b1ae7e5000001a3-1450696377.733355-1385016550', '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 03:21:01 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 03:21:01 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 03:21:01 INFO - Using env: {'DISPLAY': ':0', 03:21:01 INFO - 'HOME': '/home/cltbld', 03:21:01 INFO - 'LANG': 'en_US.UTF-8', 03:21:01 INFO - 'LANGUAGE': 'en_US:en', 03:21:01 INFO - 'LOGNAME': 'cltbld', 03:21:01 INFO - 'MAIL': '/var/mail/cltbld', 03:21:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:21:01 INFO - 'MOZ_NO_REMOTE': '1', 03:21:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:21:01 INFO - 'NO_EM_RESTART': '1', 03:21:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:21:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:21:01 INFO - 'PWD': '/builds/slave/test', 03:21:01 INFO - 'SHELL': '/bin/bash', 03:21:01 INFO - 'SHLVL': '1', 03:21:01 INFO - 'TERM': 'linux', 03:21:01 INFO - 'TMOUT': '86400', 03:21:01 INFO - 'USER': 'cltbld', 03:21:01 INFO - 'XDG_SESSION_COOKIE': '6b42339bb4b96cfc3b1ae7e5000001a3-1450696377.733355-1385016550', 03:21:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:21:01 INFO - '_': '/tools/buildbot/bin/python'} 03:21:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:21:01 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 03:21:01 INFO - Cleaning up... 03:21:01 INFO - Return code: 0 03:21:01 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 03:21:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:21:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:21:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:21:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:21:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:01 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7f814b8a0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x186e8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x193c240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19cb0b0>, '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 0x19cbfb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19cc440>, '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': '6b42339bb4b96cfc3b1ae7e5000001a3-1450696377.733355-1385016550', '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 03:21:01 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 03:21:01 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 03:21:01 INFO - Using env: {'DISPLAY': ':0', 03:21:01 INFO - 'HOME': '/home/cltbld', 03:21:01 INFO - 'LANG': 'en_US.UTF-8', 03:21:01 INFO - 'LANGUAGE': 'en_US:en', 03:21:01 INFO - 'LOGNAME': 'cltbld', 03:21:01 INFO - 'MAIL': '/var/mail/cltbld', 03:21:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:21:01 INFO - 'MOZ_NO_REMOTE': '1', 03:21:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:21:01 INFO - 'NO_EM_RESTART': '1', 03:21:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:21:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:21:01 INFO - 'PWD': '/builds/slave/test', 03:21:01 INFO - 'SHELL': '/bin/bash', 03:21:01 INFO - 'SHLVL': '1', 03:21:01 INFO - 'TERM': 'linux', 03:21:01 INFO - 'TMOUT': '86400', 03:21:01 INFO - 'USER': 'cltbld', 03:21:01 INFO - 'XDG_SESSION_COOKIE': '6b42339bb4b96cfc3b1ae7e5000001a3-1450696377.733355-1385016550', 03:21:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:21:01 INFO - '_': '/tools/buildbot/bin/python'} 03:21:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:21:01 INFO - Downloading/unpacking psutil>=0.7.1 03:21:01 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 03:21:01 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 03:21:01 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 03:21:01 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 03:21:01 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 03:21:01 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 03:21:03 INFO - Creating supposed download cache at /builds/slave/test/build/venv/cache 03:21:03 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 03:21:03 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 03:21:03 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 03:21:03 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 03:21:03 INFO - Installing collected packages: psutil 03:21:03 INFO - Running setup.py install for psutil 03:21:03 INFO - building 'psutil._psutil_linux' extension 03:21:03 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 03:21:03 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 03:21:03 INFO - building 'psutil._psutil_posix' extension 03:21:03 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 03:21:03 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 03:21:03 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 03:21:03 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 03:21:03 INFO - Successfully installed psutil 03:21:03 INFO - Cleaning up... 03:21:04 INFO - Return code: 0 03:21:04 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 03:21:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:21:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:21:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:21:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:21:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:04 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7f814b8a0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x186e8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x193c240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19cb0b0>, '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 0x19cbfb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19cc440>, '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': '6b42339bb4b96cfc3b1ae7e5000001a3-1450696377.733355-1385016550', '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 03:21:04 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 03:21:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 03:21:04 INFO - Using env: {'DISPLAY': ':0', 03:21:04 INFO - 'HOME': '/home/cltbld', 03:21:04 INFO - 'LANG': 'en_US.UTF-8', 03:21:04 INFO - 'LANGUAGE': 'en_US:en', 03:21:04 INFO - 'LOGNAME': 'cltbld', 03:21:04 INFO - 'MAIL': '/var/mail/cltbld', 03:21:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:21:04 INFO - 'MOZ_NO_REMOTE': '1', 03:21:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:21:04 INFO - 'NO_EM_RESTART': '1', 03:21:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:21:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:21:04 INFO - 'PWD': '/builds/slave/test', 03:21:04 INFO - 'SHELL': '/bin/bash', 03:21:04 INFO - 'SHLVL': '1', 03:21:04 INFO - 'TERM': 'linux', 03:21:04 INFO - 'TMOUT': '86400', 03:21:04 INFO - 'USER': 'cltbld', 03:21:04 INFO - 'XDG_SESSION_COOKIE': '6b42339bb4b96cfc3b1ae7e5000001a3-1450696377.733355-1385016550', 03:21:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:21:04 INFO - '_': '/tools/buildbot/bin/python'} 03:21:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:21:04 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 03:21:04 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:21:04 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:21:04 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:21:04 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:21:04 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:21:04 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:21:05 INFO - Downloading mozsystemmonitor-0.0.tar.gz 03:21:05 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 03:21:05 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 03:21:05 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 03:21:05 INFO - Installing collected packages: mozsystemmonitor 03:21:06 INFO - Running setup.py install for mozsystemmonitor 03:21:06 INFO - Successfully installed mozsystemmonitor 03:21:06 INFO - Cleaning up... 03:21:06 INFO - Return code: 0 03:21:06 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 03:21:06 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')]} 03:21:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:21:06 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:06 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')]} 03:21:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:21:06 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:06 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7f814b8a0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x186e8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x193c240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19cb0b0>, '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 0x19cbfb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19cc440>, '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': '6b42339bb4b96cfc3b1ae7e5000001a3-1450696377.733355-1385016550', '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 03:21:06 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 03:21:06 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 03:21:06 INFO - Using env: {'DISPLAY': ':0', 03:21:06 INFO - 'HOME': '/home/cltbld', 03:21:06 INFO - 'LANG': 'en_US.UTF-8', 03:21:06 INFO - 'LANGUAGE': 'en_US:en', 03:21:06 INFO - 'LOGNAME': 'cltbld', 03:21:06 INFO - 'MAIL': '/var/mail/cltbld', 03:21:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:21:06 INFO - 'MOZ_NO_REMOTE': '1', 03:21:06 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:21:06 INFO - 'NO_EM_RESTART': '1', 03:21:06 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:21:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:21:06 INFO - 'PWD': '/builds/slave/test', 03:21:06 INFO - 'SHELL': '/bin/bash', 03:21:06 INFO - 'SHLVL': '1', 03:21:06 INFO - 'TERM': 'linux', 03:21:06 INFO - 'TMOUT': '86400', 03:21:06 INFO - 'USER': 'cltbld', 03:21:06 INFO - 'XDG_SESSION_COOKIE': '6b42339bb4b96cfc3b1ae7e5000001a3-1450696377.733355-1385016550', 03:21:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:21:06 INFO - '_': '/tools/buildbot/bin/python'} 03:21:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:21:06 INFO - Downloading/unpacking blobuploader==1.2.4 03:21:06 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:21:06 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:21:06 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:21:06 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:21:06 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:21:06 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:21:08 INFO - Downloading blobuploader-1.2.4.tar.gz 03:21:08 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 03:21:08 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 03:21:08 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 03:21:08 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 03:21:08 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 03:21:08 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 03:21:08 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 03:21:08 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 03:21:08 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 03:21:08 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 03:21:08 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 03:21:08 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 03:21:08 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 03:21:08 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 03:21:08 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 03:21:08 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 03:21:08 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 03:21:08 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 03:21:08 INFO - Downloading docopt-0.6.1.tar.gz 03:21:08 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 03:21:08 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 03:21:08 INFO - Installing collected packages: blobuploader, requests, docopt 03:21:08 INFO - Running setup.py install for blobuploader 03:21:08 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 03:21:08 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 03:21:08 INFO - Running setup.py install for requests 03:21:09 INFO - Running setup.py install for docopt 03:21:09 INFO - Successfully installed blobuploader requests docopt 03:21:09 INFO - Cleaning up... 03:21:09 INFO - Return code: 0 03:21:09 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:21:09 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')]} 03:21:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:21:09 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:09 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')]} 03:21:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:21:09 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:09 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7f814b8a0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x186e8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x193c240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19cb0b0>, '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 0x19cbfb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19cc440>, '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': '6b42339bb4b96cfc3b1ae7e5000001a3-1450696377.733355-1385016550', '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 03:21:09 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 03:21:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --download-cache /builds/slave/test/build/venv/cache --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 03:21:09 INFO - Using env: {'DISPLAY': ':0', 03:21:09 INFO - 'HOME': '/home/cltbld', 03:21:09 INFO - 'LANG': 'en_US.UTF-8', 03:21:09 INFO - 'LANGUAGE': 'en_US:en', 03:21:09 INFO - 'LOGNAME': 'cltbld', 03:21:09 INFO - 'MAIL': '/var/mail/cltbld', 03:21:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:21:09 INFO - 'MOZ_NO_REMOTE': '1', 03:21:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:21:09 INFO - 'NO_EM_RESTART': '1', 03:21:09 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:21:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:21:09 INFO - 'PWD': '/builds/slave/test', 03:21:09 INFO - 'SHELL': '/bin/bash', 03:21:09 INFO - 'SHLVL': '1', 03:21:09 INFO - 'TERM': 'linux', 03:21:09 INFO - 'TMOUT': '86400', 03:21:09 INFO - 'USER': 'cltbld', 03:21:09 INFO - 'XDG_SESSION_COOKIE': '6b42339bb4b96cfc3b1ae7e5000001a3-1450696377.733355-1385016550', 03:21:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:21:09 INFO - '_': '/tools/buildbot/bin/python'} 03:21:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:21:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 03:21:09 INFO - Running setup.py (path:/tmp/pip-CI8YH9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 03:21:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 03:21:09 INFO - Running setup.py (path:/tmp/pip-S8_avZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 03:21:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 03:21:09 INFO - Running setup.py (path:/tmp/pip-HZCqaQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 03:21:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 03:21:09 INFO - Running setup.py (path:/tmp/pip-vjyBfq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 03:21:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 03:21:09 INFO - Running setup.py (path:/tmp/pip-vZJCUU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 03:21:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 03:21:09 INFO - Running setup.py (path:/tmp/pip-_bL34W-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 03:21:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 03:21:09 INFO - Running setup.py (path:/tmp/pip-dIyFiV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 03:21:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 03:21:10 INFO - Running setup.py (path:/tmp/pip-2Bdcu7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 03:21:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 03:21:10 INFO - Running setup.py (path:/tmp/pip-goNh19-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 03:21:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 03:21:10 INFO - Running setup.py (path:/tmp/pip-utyFLW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 03:21:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 03:21:10 INFO - Running setup.py (path:/tmp/pip-2L22iD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 03:21:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 03:21:10 INFO - Running setup.py (path:/tmp/pip-uxSrFU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 03:21:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 03:21:10 INFO - Running setup.py (path:/tmp/pip-YbM1dS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 03:21:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 03:21:10 INFO - Running setup.py (path:/tmp/pip-1XOYCd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 03:21:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 03:21:10 INFO - Running setup.py (path:/tmp/pip-Ld7vY9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 03:21:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 03:21:10 INFO - Running setup.py (path:/tmp/pip-XBwZ_v-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 03:21:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 03:21:10 INFO - Running setup.py (path:/tmp/pip-x4Vzf0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 03:21:10 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 03:21:10 INFO - Running setup.py install for manifestparser 03:21:10 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 03:21:10 INFO - Running setup.py install for mozcrash 03:21:10 INFO - Running setup.py install for mozdebug 03:21:11 INFO - Running setup.py install for mozdevice 03:21:11 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 03:21:11 INFO - Installing dm script to /builds/slave/test/build/venv/bin 03:21:11 INFO - Running setup.py install for mozfile 03:21:11 INFO - Running setup.py install for mozhttpd 03:21:11 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 03:21:11 INFO - Running setup.py install for mozinfo 03:21:11 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 03:21:11 INFO - Running setup.py install for mozInstall 03:21:11 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 03:21:11 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 03:21:11 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 03:21:11 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 03:21:11 INFO - Running setup.py install for mozleak 03:21:11 INFO - Running setup.py install for mozlog 03:21:11 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 03:21:11 INFO - Running setup.py install for moznetwork 03:21:11 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 03:21:11 INFO - Running setup.py install for mozprocess 03:21:11 INFO - Running setup.py install for mozprofile 03:21:12 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 03:21:12 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 03:21:12 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 03:21:12 INFO - Running setup.py install for mozrunner 03:21:12 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 03:21:12 INFO - Running setup.py install for mozscreenshot 03:21:12 INFO - Running setup.py install for moztest 03:21:12 INFO - Running setup.py install for mozversion 03:21:12 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 03:21:12 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 03:21:12 INFO - Cleaning up... 03:21:12 INFO - Return code: 0 03:21:12 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:21:12 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')]} 03:21:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:21:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:12 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')]} 03:21:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:21:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:12 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7f814b8a0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x186e8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x193c240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19cb0b0>, '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 0x19cbfb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19cc440>, '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': '6b42339bb4b96cfc3b1ae7e5000001a3-1450696377.733355-1385016550', '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 03:21:12 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 03:21:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 03:21:12 INFO - Using env: {'DISPLAY': ':0', 03:21:12 INFO - 'HOME': '/home/cltbld', 03:21:12 INFO - 'LANG': 'en_US.UTF-8', 03:21:12 INFO - 'LANGUAGE': 'en_US:en', 03:21:12 INFO - 'LOGNAME': 'cltbld', 03:21:12 INFO - 'MAIL': '/var/mail/cltbld', 03:21:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:21:12 INFO - 'MOZ_NO_REMOTE': '1', 03:21:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:21:12 INFO - 'NO_EM_RESTART': '1', 03:21:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:21:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:21:12 INFO - 'PWD': '/builds/slave/test', 03:21:12 INFO - 'SHELL': '/bin/bash', 03:21:12 INFO - 'SHLVL': '1', 03:21:12 INFO - 'TERM': 'linux', 03:21:12 INFO - 'TMOUT': '86400', 03:21:12 INFO - 'USER': 'cltbld', 03:21:12 INFO - 'XDG_SESSION_COOKIE': '6b42339bb4b96cfc3b1ae7e5000001a3-1450696377.733355-1385016550', 03:21:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:21:12 INFO - '_': '/tools/buildbot/bin/python'} 03:21:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:21:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 03:21:12 INFO - Running setup.py (path:/tmp/pip-8DBjSZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 03:21:12 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)) 03:21:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 03:21:12 INFO - Running setup.py (path:/tmp/pip-V34zu0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 03:21:12 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.16 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)) 03:21:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 03:21:12 INFO - Running setup.py (path:/tmp/pip-ify8La-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 03:21:12 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)) 03:21:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 03:21:12 INFO - Running setup.py (path:/tmp/pip-8sDvK0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 03:21:13 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.47 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)) 03:21:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 03:21:13 INFO - Running setup.py (path:/tmp/pip-dvVyPd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 03:21:13 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)) 03:21:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 03:21:13 INFO - Running setup.py (path:/tmp/pip-VUa8H2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 03:21:13 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)) 03:21:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 03:21:13 INFO - Running setup.py (path:/tmp/pip-7JjChL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 03:21:13 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)) 03:21:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 03:21:13 INFO - Running setup.py (path:/tmp/pip-kEu1tc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 03:21:13 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)) 03:21:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 03:21:13 INFO - Running setup.py (path:/tmp/pip-2116P9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 03:21:13 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)) 03:21:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 03:21:13 INFO - Running setup.py (path:/tmp/pip-i8vdZX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 03:21:13 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)) 03:21:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 03:21:13 INFO - Running setup.py (path:/tmp/pip-wl1CiP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 03:21:13 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)) 03:21:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 03:21:13 INFO - Running setup.py (path:/tmp/pip-pVyTUa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 03:21:13 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)) 03:21:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 03:21:13 INFO - Running setup.py (path:/tmp/pip-7nFlKe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 03:21:13 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.27 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)) 03:21:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 03:21:13 INFO - Running setup.py (path:/tmp/pip-DrORpk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 03:21:13 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)) 03:21:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 03:21:13 INFO - Running setup.py (path:/tmp/pip-HJbWTY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 03:21:13 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)) 03:21:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 03:21:13 INFO - Running setup.py (path:/tmp/pip-KU42JG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 03:21:13 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)) 03:21:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 03:21:13 INFO - Running setup.py (path:/tmp/pip-1N0nkb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 03:21:13 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)) 03:21:13 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.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 03:21:13 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.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 03:21:13 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)) 03:21:13 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.47->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 03:21:13 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.47->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 03:21:13 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 03:21:13 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 03:21:14 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:21:14 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:21:14 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:21:14 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:21:14 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:21:15 INFO - Downloading blessings-1.5.1.tar.gz 03:21:15 INFO - Storing download in cache at /builds/slave/test/build/venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblessings-1.5.1.tar.gz 03:21:15 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 03:21:15 INFO - Installing collected packages: blessings 03:21:15 INFO - Running setup.py install for blessings 03:21:15 INFO - Successfully installed blessings 03:21:15 INFO - Cleaning up... 03:21:15 INFO - Return code: 0 03:21:15 INFO - Done creating virtualenv /builds/slave/test/build/venv. 03:21:15 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 03:21:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 03:21:16 INFO - Reading from file tmpfile_stdout 03:21:16 INFO - Current package versions: 03:21:16 INFO - argparse == 1.2.1 03:21:16 INFO - blessings == 1.5.1 03:21:16 INFO - blobuploader == 1.2.4 03:21:16 INFO - docopt == 0.6.1 03:21:16 INFO - manifestparser == 1.1 03:21:16 INFO - mozInstall == 1.12 03:21:16 INFO - mozcrash == 0.16 03:21:16 INFO - mozdebug == 0.1 03:21:16 INFO - mozdevice == 0.47 03:21:16 INFO - mozfile == 1.2 03:21:16 INFO - mozhttpd == 0.7 03:21:16 INFO - mozinfo == 0.9 03:21:16 INFO - mozleak == 0.1 03:21:16 INFO - mozlog == 3.1 03:21:16 INFO - moznetwork == 0.27 03:21:16 INFO - mozprocess == 0.22 03:21:16 INFO - mozprofile == 0.27 03:21:16 INFO - mozrunner == 6.11 03:21:16 INFO - mozscreenshot == 0.1 03:21:16 INFO - mozsystemmonitor == 0.0 03:21:16 INFO - moztest == 0.7 03:21:16 INFO - mozversion == 1.4 03:21:16 INFO - psutil == 3.1.1 03:21:16 INFO - requests == 1.2.3 03:21:16 INFO - wsgiref == 0.1.2 03:21:16 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:21:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:21:16 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:21:16 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:21:16 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:21:16 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:16 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7f814b8a0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x186e8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x193c240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19cb0b0>, '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 0x19cbfb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19cc440>, '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': '6b42339bb4b96cfc3b1ae7e5000001a3-1450696377.733355-1385016550', '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 03:21:16 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 03:21:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 03:21:16 INFO - Using env: {'DISPLAY': ':0', 03:21:16 INFO - 'HOME': '/home/cltbld', 03:21:16 INFO - 'LANG': 'en_US.UTF-8', 03:21:16 INFO - 'LANGUAGE': 'en_US:en', 03:21:16 INFO - 'LOGNAME': 'cltbld', 03:21:16 INFO - 'MAIL': '/var/mail/cltbld', 03:21:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:21:16 INFO - 'MOZ_NO_REMOTE': '1', 03:21:16 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:21:16 INFO - 'NO_EM_RESTART': '1', 03:21:16 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:21:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:21:16 INFO - 'PWD': '/builds/slave/test', 03:21:16 INFO - 'SHELL': '/bin/bash', 03:21:16 INFO - 'SHLVL': '1', 03:21:16 INFO - 'TERM': 'linux', 03:21:16 INFO - 'TMOUT': '86400', 03:21:16 INFO - 'USER': 'cltbld', 03:21:16 INFO - 'XDG_SESSION_COOKIE': '6b42339bb4b96cfc3b1ae7e5000001a3-1450696377.733355-1385016550', 03:21:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:21:16 INFO - '_': '/tools/buildbot/bin/python'} 03:21:16 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:21:16 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 1)) 03:21:16 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 2)) 03:21:16 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 3)) 03:21:16 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 4)) 03:21:16 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 5)) 03:21:16 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 6)) 03:21:16 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 7)) 03:21:16 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 8)) 03:21:16 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.15->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 03:21:16 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 3)) 03:21:16 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.0->mozcrash>=0.15->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 03:21:16 INFO - Cleaning up... 03:21:16 INFO - Return code: 0 03:21:16 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 03:21:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:21:16 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:21:16 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:21:16 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:21:16 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:16 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7f814b8a0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x186e8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x193c240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19cb0b0>, '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 0x19cbfb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19cc440>, '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': '6b42339bb4b96cfc3b1ae7e5000001a3-1450696377.733355-1385016550', '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 03:21:16 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 03:21:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 03:21:16 INFO - Using env: {'DISPLAY': ':0', 03:21:16 INFO - 'HOME': '/home/cltbld', 03:21:16 INFO - 'LANG': 'en_US.UTF-8', 03:21:16 INFO - 'LANGUAGE': 'en_US:en', 03:21:16 INFO - 'LOGNAME': 'cltbld', 03:21:16 INFO - 'MAIL': '/var/mail/cltbld', 03:21:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:21:16 INFO - 'MOZ_NO_REMOTE': '1', 03:21:16 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:21:16 INFO - 'NO_EM_RESTART': '1', 03:21:16 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:21:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:21:16 INFO - 'PWD': '/builds/slave/test', 03:21:16 INFO - 'SHELL': '/bin/bash', 03:21:16 INFO - 'SHLVL': '1', 03:21:16 INFO - 'TERM': 'linux', 03:21:16 INFO - 'TMOUT': '86400', 03:21:16 INFO - 'USER': 'cltbld', 03:21:16 INFO - 'XDG_SESSION_COOKIE': '6b42339bb4b96cfc3b1ae7e5000001a3-1450696377.733355-1385016550', 03:21:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:21:16 INFO - '_': '/tools/buildbot/bin/python'} 03:21:16 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:21:16 INFO - Downloading/unpacking jsonschema 03:21:16 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:21:16 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:21:16 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:21:16 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:21:16 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:21:16 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:21:18 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 03:21:18 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fjsonschema-2.5.1-py2.py3-none-any.whl 03:21:18 INFO - Downloading/unpacking functools32 (from jsonschema) 03:21:18 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:21:18 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:21:18 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:21:18 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:21:18 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:21:18 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:21:18 INFO - Downloading functools32-3.2.3-2.tar.gz 03:21:18 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Ffunctools32-3.2.3-2.tar.gz 03:21:18 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 03:21:18 INFO - warning: no files found matching '*.txt' 03:21:18 INFO - no previously-included directories found matching 'build' 03:21:18 INFO - no previously-included directories found matching 'dist' 03:21:18 INFO - no previously-included directories found matching '.git*' 03:21:18 INFO - Installing collected packages: jsonschema, functools32 03:21:18 INFO - Running setup.py install for functools32 03:21:18 INFO - warning: no files found matching '*.txt' 03:21:18 INFO - no previously-included directories found matching 'build' 03:21:18 INFO - no previously-included directories found matching 'dist' 03:21:18 INFO - no previously-included directories found matching '.git*' 03:21:18 INFO - Successfully installed jsonschema functools32 03:21:18 INFO - Cleaning up... 03:21:18 INFO - Return code: 0 03:21:18 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 03:21:18 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')]} 03:21:18 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:21:18 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:18 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')]} 03:21:18 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:21:18 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:18 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7f814b8a0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x186e8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x193c240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19cb0b0>, '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 0x19cbfb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19cc440>, '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': '6b42339bb4b96cfc3b1ae7e5000001a3-1450696377.733355-1385016550', '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 03:21:18 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 03:21:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 03:21:18 INFO - Using env: {'DISPLAY': ':0', 03:21:18 INFO - 'HOME': '/home/cltbld', 03:21:18 INFO - 'LANG': 'en_US.UTF-8', 03:21:18 INFO - 'LANGUAGE': 'en_US:en', 03:21:18 INFO - 'LOGNAME': 'cltbld', 03:21:18 INFO - 'MAIL': '/var/mail/cltbld', 03:21:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:21:18 INFO - 'MOZ_NO_REMOTE': '1', 03:21:18 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:21:18 INFO - 'NO_EM_RESTART': '1', 03:21:18 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:21:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:21:18 INFO - 'PWD': '/builds/slave/test', 03:21:18 INFO - 'SHELL': '/bin/bash', 03:21:18 INFO - 'SHLVL': '1', 03:21:18 INFO - 'TERM': 'linux', 03:21:18 INFO - 'TMOUT': '86400', 03:21:18 INFO - 'USER': 'cltbld', 03:21:18 INFO - 'XDG_SESSION_COOKIE': '6b42339bb4b96cfc3b1ae7e5000001a3-1450696377.733355-1385016550', 03:21:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:21:18 INFO - '_': '/tools/buildbot/bin/python'} 03:21:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:21:18 INFO - Downloading/unpacking flake8 03:21:18 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:21:18 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:21:18 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:21:18 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:21:18 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:21:18 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:21:20 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 03:21:20 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fflake8-2.5.0-py2.py3-none-any.whl 03:21:20 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 03:21:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:21:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:21:20 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:21:20 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:21:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:21:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:21:20 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 03:21:20 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmccabe-0.3.1-py2.py3-none-any.whl 03:21:20 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 03:21:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:21:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:21:20 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:21:20 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:21:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:21:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:21:20 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpyflakes-1.0.0-py2.py3-none-any.whl 03:21:20 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 03:21:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:21:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:21:20 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:21:20 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:21:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:21:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:21:21 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpep8-1.5.7.tar.gz 03:21:21 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 03:21:21 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 03:21:21 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 03:21:21 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 03:21:21 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 03:21:21 INFO - no previously-included directories found matching 'docs/_build' 03:21:21 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 03:21:21 INFO - Running setup.py install for pep8 03:21:21 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 03:21:21 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 03:21:21 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 03:21:21 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 03:21:21 INFO - no previously-included directories found matching 'docs/_build' 03:21:21 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 03:21:21 INFO - Successfully installed flake8 mccabe pyflakes pep8 03:21:21 INFO - Cleaning up... 03:21:21 INFO - Return code: 0 03:21:21 INFO - Running post-action listener: _resource_record_post_action 03:21:21 INFO - Running post-action listener: _start_resource_monitoring 03:21:21 INFO - Starting resource monitoring. 03:21:21 INFO - ##### 03:21:21 INFO - ##### Running install step. 03:21:21 INFO - ##### 03:21:21 INFO - Running pre-action listener: _resource_record_pre_action 03:21:21 INFO - Running main action method: install 03:21:21 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 03:21:21 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 03:21:21 INFO - Reading from file tmpfile_stdout 03:21:21 INFO - Detecting whether we're running mozinstall >=1.0... 03:21:21 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 03:21:21 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 03:21:21 INFO - Reading from file tmpfile_stdout 03:21:21 INFO - Output received: 03:21:21 INFO - Usage: mozinstall [options] installer 03:21:21 INFO - Options: 03:21:21 INFO - -h, --help show this help message and exit 03:21:21 INFO - -d DEST, --destination=DEST 03:21:21 INFO - Directory to install application into. [default: 03:21:21 INFO - "/builds/slave/test"] 03:21:21 INFO - --app=APP Application being installed. [default: firefox] 03:21:21 INFO - mkdir: /builds/slave/test/build/application 03:21:21 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 03:21:21 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 03:21:37 INFO - Reading from file tmpfile_stdout 03:21:37 INFO - Output received: 03:21:37 INFO - /builds/slave/test/build/application/firefox/firefox 03:21:37 INFO - Running post-action listener: _resource_record_post_action 03:21:37 INFO - ##### 03:21:37 INFO - ##### Running run-tests step. 03:21:37 INFO - ##### 03:21:37 INFO - Running pre-action listener: _resource_record_pre_action 03:21:37 INFO - Running main action method: run_tests 03:21:37 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 03:21:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 03:21:37 INFO - Python 2.7.3 03:21:37 INFO - Return code: 0 03:21:37 INFO - grabbing minidump binary from tooltool 03:21: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')]} 03:21:37 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 0x19cb0b0>, '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 0x19cbfb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x19cc440>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 03:21:37 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 03:21:37 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 03:21:37 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 03:21:37 INFO - Return code: 0 03:21:37 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 03:21:37 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 03:21:37 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 03:21:37 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 03:21:37 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 03:21:37 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 03:21:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 03:21:38 INFO - Return code: 0 03:21:38 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/cbGO6asBRYiIn6eCmUh3iA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-057', '--webServer', 'localhost'] in /builds/slave/test/build 03:21:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --debug --branchName Fx-Team-Non-PGO --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/cbGO6asBRYiIn6eCmUh3iA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-057 --webServer localhost 03:21:38 INFO - Using env: {'DISPLAY': ':0', 03:21:38 INFO - 'HOME': '/home/cltbld', 03:21:38 INFO - 'LANG': 'en_US.UTF-8', 03:21:38 INFO - 'LANGUAGE': 'en_US:en', 03:21:38 INFO - 'LOGNAME': 'cltbld', 03:21:38 INFO - 'MAIL': '/var/mail/cltbld', 03:21:38 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 03:21:38 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 03:21:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:21:38 INFO - 'MOZ_NO_REMOTE': '1', 03:21:38 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 03:21:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:21:38 INFO - 'NO_EM_RESTART': '1', 03:21:38 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:21:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:21:38 INFO - 'PWD': '/builds/slave/test', 03:21:38 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 03:21:38 INFO - 'SHELL': '/bin/bash', 03:21:38 INFO - 'SHLVL': '1', 03:21:38 INFO - 'TERM': 'linux', 03:21:38 INFO - 'TMOUT': '86400', 03:21:38 INFO - 'USER': 'cltbld', 03:21:38 INFO - 'XDG_SESSION_COOKIE': '6b42339bb4b96cfc3b1ae7e5000001a3-1450696377.733355-1385016550', 03:21:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:21:38 INFO - '_': '/tools/buildbot/bin/python'} 03:21:38 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/cbGO6asBRYiIn6eCmUh3iA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-057', '--webServer', 'localhost'] with output_timeout 3600 03:21:38 INFO - mozversion INFO | application_buildid: 20151221022728 03:21:38 INFO - mozversion INFO | application_changeset: b76ea647debcadd234066150c78b3bba77a50c74 03:21:38 INFO - mozversion INFO | application_display_name: Nightly 03:21:38 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 03:21:38 INFO - mozversion INFO | application_name: Firefox 03:21:38 INFO - mozversion INFO | application_remotingname: firefox 03:21:38 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/integration/fx-team 03:21:38 INFO - mozversion INFO | application_vendor: Mozilla 03:21:38 INFO - mozversion INFO | application_version: 46.0a1 03:21:38 INFO - mozversion INFO | platform_buildid: 20151221022728 03:21:38 INFO - mozversion INFO | platform_changeset: b76ea647debcadd234066150c78b3bba77a50c74 03:21:38 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/integration/fx-team 03:21:38 INFO - mozversion INFO | platform_version: 46.0a1 03:21:38 INFO - 2015-12-21 03:21:38,502 DEBUG : using testdate: 1450696898 03:21:38 INFO - 2015-12-21 03:21:38,503 DEBUG : actual date: 1450696898 03:21:38 INFO - 2015-12-21 03:21:38,512 INFO : starting webserver on 'localhost:53114' 03:21:38 INFO - 2015-12-21 03:21:38,513 INFO : Starting test suite talos-linux64-ix-057 03:21:38 INFO - 2015-12-21 03:21:38,513 INFO : Starting test dromaeo_css 03:21:38 INFO - 2015-12-21 03:21:38,513 DEBUG : operating with platform_type : linux_ 03:21:38 INFO - 2015-12-21 03:21:38,514 INFO : Initialising browser for dromaeo_css test... 03:21:38 INFO - 2015-12-21 03:21:38,526 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpwS2CBg/profile http://localhost:53114/getInfo.html 03:21:42 INFO - 2015-12-21 03:21:42,641 DEBUG : BROWSER_OUTPUT: JavaScript error: resource://app/modules/BrowserUITelemetry.jsm, line 538: ReferenceError: assignment to undeclared variable item 03:21:42 INFO - 2015-12-21 03:21:42,642 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 03:21:42 INFO - 2015-12-21 03:21:42,642 DEBUG : BROWSER_OUTPUT: colorDepth:24 03:21:42 INFO - 2015-12-21 03:21:42,642 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 03:21:42 INFO - 2015-12-21 03:21:42,642 DEBUG : BROWSER_OUTPUT: __metrics 03:21:42 INFO - 2015-12-21 03:21:42,786 DEBUG : BROWSER_OUTPUT: JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 03:21:42 INFO - 2015-12-21 03:21:42,842 DEBUG : BROWSER_OUTPUT: JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 03:21:43 INFO - 2015-12-21 03:21:43,996 INFO : Browser initialized. 03:21:43 INFO - 2015-12-21 03:21:43,996 INFO : Running cycle 1/1 for dromaeo_css test... 03:21:43 INFO - 2015-12-21 03:21:43,996 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpwS2CBg/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 03:21:55 INFO - 2015-12-21 03:21:55,959 DEBUG : BROWSER_OUTPUT: RSS: Main: 150192128 03:21:55 INFO - 2015-12-21 03:21:55,959 DEBUG : BROWSER_OUTPUT: 03:22:47 INFO - 2015-12-21 03:22:47,236 DEBUG : BROWSER_OUTPUT: 1450696967234 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] 03:24:59 INFO - 2015-12-21 03:24:59,047 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:53114/tests/dromaeo/cssquery-dojo.html (next: http://localhost:53114/tests/dromaeo/cssquery-ext.html) 03:25:00 INFO - 2015-12-21 03:25:00,203 DEBUG : BROWSER_OUTPUT: RSS: Main: 264527872 03:25:00 INFO - 2015-12-21 03:25:00,203 DEBUG : BROWSER_OUTPUT: 03:28:02 INFO - 2015-12-21 03:28:02,735 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:53114/tests/dromaeo/cssquery-ext.html (next: http://localhost:53114/tests/dromaeo/cssquery-jquery.html) 03:28:03 INFO - 2015-12-21 03:28:03,301 DEBUG : BROWSER_OUTPUT: RSS: Main: 227098624 03:28:03 INFO - 2015-12-21 03:28:03,301 DEBUG : BROWSER_OUTPUT: 03:31:05 INFO - 2015-12-21 03:31:05,353 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:53114/tests/dromaeo/cssquery-jquery.html (next: http://localhost:53114/tests/dromaeo/cssquery-mootools.html) 03:31:05 INFO - 2015-12-21 03:31:05,936 DEBUG : BROWSER_OUTPUT: RSS: Main: 225751040 03:31:05 INFO - 2015-12-21 03:31:05,936 DEBUG : BROWSER_OUTPUT: 03:34:07 INFO - 2015-12-21 03:34:07,836 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:53114/tests/dromaeo/cssquery-mootools.html (next: http://localhost:53114/tests/dromaeo/cssquery-prototype.html) 03:34:08 INFO - 2015-12-21 03:34:08,409 DEBUG : BROWSER_OUTPUT: RSS: Main: 210849792 03:34:08 INFO - 2015-12-21 03:34:08,409 DEBUG : BROWSER_OUTPUT: 03:37:11 INFO - 2015-12-21 03:37:11,147 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:53114/tests/dromaeo/cssquery-prototype.html (next: http://localhost:53114/tests/dromaeo/cssquery-yui.html) 03:37:11 INFO - 2015-12-21 03:37:11,749 DEBUG : BROWSER_OUTPUT: RSS: Main: 215138304 03:37:11 INFO - 2015-12-21 03:37:11,749 DEBUG : BROWSER_OUTPUT: 03:40:14 INFO - 2015-12-21 03:40:14,192 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:53114/tests/dromaeo/cssquery-yui.html (next: http://localhost:53114/tests/dromaeo/cssquery-dojo.html) 03:40:14 INFO - 2015-12-21 03:40:14,442 DEBUG : BROWSER_OUTPUT: RSS: Main: 260972544 03:40:14 INFO - 2015-12-21 03:40:14,442 DEBUG : BROWSER_OUTPUT: 03:40:14 INFO - 2015-12-21 03:40:14,442 DEBUG : BROWSER_OUTPUT: __start_tp_report 03:40:14 INFO - 2015-12-21 03:40:14,442 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 03:40:14 INFO - 2015-12-21 03:40:14,443 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 03:40:14 INFO - 2015-12-21 03:40:14,443 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 03:40:14 INFO - 2015-12-21 03:40:14,443 DEBUG : BROWSER_OUTPUT: |0;dojo.html;2562.2441379792963;2621.0957219759175;2621.4757048590277;2643.973560264398;2647.47050589882;4243.448351714273;4374.803133858976;4399.960163330348;4414.977925110374;4439.7780110994445;4378.584034516716;4401.889952751183;4440.222960981823;4470.75410852403;4482.731036137834;4183.937240941388;4206.158768246348;4215.515215750182;4232.640225580829;4234.555371685975;3952.071263253133;4265.997490589709;4300.032492689135;4328.502222244435;4330.242207613671;4050.1494686115952;4138.586141385867;4231.555686652919;4256.021115143503;4264.33902745075;4150.128473020669;4152.065785198336;4153.06556024895;4193.496780386343;4198.160367926427;3944.0337117406134;4115.382692596135;4163.958360416387;4170.082581831992;4193.412922190896;4397.252467080604;4400.515943246241;4488.214562451558;4492.034212644265;4512.706674066175;4777.474477807438;4869.975650121763;4875.829345972874;4878.146324393252;4897.33885925399;4628.953710462886;4741.762911854394;4880.780364883589;4907.214845624683;4915.5821755150855;4405.8237670493145;4417.2269852775635;4466.062126953311;4472.306792447111;4504.932426013613;4869.610431165498;4875.8049678012485;4882.7314497702255;4909.5090490950615;4916.434610019894;4499.662525310615;4603.769811509411;4701.083288758728;4708.717476951326;4743.430788305425;4669.39297891272;4715.033418149271;4743.857684269477;4768.189407800683;4815.446223684251;4725.787339569728;4734.455537613149;4737.549932756383;4738.976305118521;4786.928196077061;4516.751578663139;4622.907541849144;4778.546038126373;4781.402324709411;4806.49531799156;3911.765294082364;3985.720999530005;4044.8786536403954;4075.7554546727292;4086.366613174963;3565.536480257602;3567.0369000370274;3576.8569257229938;3606.4770608261656;3611.0250232437097;3961.504811898513;4057.188562287495;4183.1215444756945;4191.7484950903045;4217.683673724483;4689.179393606105;4717.95282047182;4761.619070474354;4787.186178349689;4797.592204662573;4165.687573432005;4203.747775133502;4214.599613036757;4230.344296634026;4242.44848169736;4035.455213546192;4314.460692413449;4326.351047342924;4355.1725172217175;4369.126174764996;4411.823527058882;4416.470023597189;4433.423654924839;4503.234450143418;4552.840650577214;4836.685615434985;4897.167481528078;4904.386951631046;4908.82819101344;4947.381577302837;4374.956250437455;4614.815407383667;4644.117617652635;4645.977884865324;4678.883027924329;4672.182368085503;4681.438227412732;4686.343911852276;4749.382580264543;4793.712377257376;4802.639802014793;4846.345743324606;4852.393450818648;4859.052484765437;4886.218205087169;4518.932216016697;4697.718136911796;4704.9529504704515;4720.740359280135;4756.025014871874;4627.167109920112;4641.698289611165;4653.302004699187;4706.411698537683;4768.332433459388;4583.747893865736;4610.769461526843;4614.561616646413;4625.560571745679;4648.953510464852;4533.229351010402;4719.1977363847545;4723.102610503994;4733;4764.309175169512;4502.099580083931;4512.548745125461;4616.192166370939;4685.01614660925;4714.7406892619865 03:40:14 INFO - 2015-12-21 03:40:14,444 DEBUG : BROWSER_OUTPUT: |1;ext.html;571.0206995003568;578.2049681687678;580.3210244014502;582.8164128299585;593.9970300148501;27175.320616984583;27713.861430692843;27731.306717332078;35090.47364289531;35994.640053599454;39551.80224098883;40108.79945600268;40124.39813402794;40225.396619050734;40233.396499052535;7847.686092556305;8004.63979120941;8014.198580141998;8017.559034253114;8017.799555011113;7016.193137789143;7155.4633402494765;10066;10294.639687610936;10319.380837149758;10044.397336159816;10141.594336226543;10142.442165680885;10155.339902906288;10163.796724065514;7009.474289428263;7169.462290328246;9949.60201591939;10044.296899217057;10059.295849290553;6879.449644028466;7005.0893383859775;10115.49422528878;10352.327098738559;10354.482275886176;36543.269134617425;37002.62997370019;37129.628703712886;37141.62858371409;37195.62804371976;2839.304370429237;2872.755815755663;2882.3658795065053;3494.5107684924133;3579.6778289954027;26797.196084117506;26881;26913;27236.59145112825;27970.720292797014;3386.3904497190497;3415.573053368329;3434.708049815769;3470.5661792275964;3562;199840;200783;201188;202137.989310054;202328;46470.30294545584;47496.28755568669;59353;61155;61204;54497;54517;54603;54667.45332546703;54741.726291368286;13752.381142848395;13954.511592094228;13959.371828267753;13984.580462586138;14008.509702160376;10449.634262800766;10569.894301056891;10618.203634727426;10755.78488430227;10779.730506737395;18885.52786180329;19183;19193.424197274104;19240.326588569333;19264;7521.135069466972;7822.843543129219;7832.177621349791;7924.167962363984;7971.72098976533;838.6310023589601;864.9620455453481;867.2021739999216;904.692404582432;946.1673727120091;25409.49181016406;29458.263543411158;30459.390812183632;31266.687333126833;31355.216119597193;900.0864122915247;926.6525053105086;956.2111258212003;995.4972738767021;1003.1824063388315;13638.386272617756;13807.17156970585;13874.375653095634;13938;15123.848761512465;322827;326934;327278;327454;328725;47362.289565656545;47839;47981.280280795814;48027.75986120047;48146.27780583224;1160.489384670742;1177.1995043370418;1183.177691504396;1209.2442223610244;1210.0803389424102;26511.602325965512;27286;27491.587626186025;27794.861025694743;27864.16407507778;39240;39685.801570991964;39790.40314395229;39803.40294895521;39828.60171398249;231060;234651;236627;240691;241169;26881.462370752866;27010.189694309203;27048.1885543434;27052.188434347;27078.45843083088;36824;44478.3328250083;45569;45963.54036459592;46730.53269467262;32526.10353570648;32530;33165.50251746274;33305;33693.66306336905;32305.35389292154;32772.46233366387;32908;33107.33785324328;33156.50265246072;32618.51072233871;33333.33333333271;33437;33449;33639.663603364635;29237.41525169527;29508.262293441978;30542.84728576343;30558.84720576383;30576;23648.645270321304;23724.169654062025;23784.610191702297;24032.279031629078;24115 03:40:14 INFO - 2015-12-21 03:40:14,448 DEBUG : BROWSER_OUTPUT: |2;jquery.html;313.5985937999359;318.78163458031236;331.9460712238642;333.52472726364937;334.01798711787353;12688.61934141975;13112.606621801337;15094.24528773561;15548.45580404686;15773.44792932249;14486.782698259509;14957.401703931857;15493.380264789395;16036.118013509253;16068.27692753826;5527.695976721278;5566.304211973514;5658.7170641467965;5669.291338582677;5670.036093864053;4089;4204.97897510512;5575.832725018236;6482.416582507573;6737.98930160475;6508.511861610375;6585.506087043467;6645.30224326446;6691.93308066918;6699.330066993286;6578.210614726216;6629.171353580802;6632.801015969529;6634.469242460592;6635.037919501645;6203.348648391899;6333.334999824998;6343.14367560378;6408.327125651833;6415.454686351665;21219;21278.680819787714;21652.675209871864;21671.34985950424;21709.240176593903;1800.207908520247;1907.5898681783344;1924.9615007699908;1967.3409407848387;2034.5625690476618;13373.130746501447;13435.529756458476;13437.193768373929;13504.662383440394;13752.724945501033;1794.9910250448663;1862.748528948588;1880.5110671225443;1906.90465476727;1914.6936490161647;56013;58183.12725309082;59781.40218597802;59813;60585.69707151524;14625.92687036558;15063.322150503254;15099.698006039818;15125.621859453602;15176.165310907785;22861.885690571442;22923.770762292497;23176.65235021476;23243.53512929732;23248.65127023096;8353.540555269397;8453.393855167498;8489.405741598152;8525.786855328666;8588.484690918565;6848.863022739517;6848.863022739617;6897.896531552031;7154.534955227893;7188.029616001772;7391.8152046199275;7434.25657434263;7454.627268636546;7481.962590187123;7490.213527579525;2252.695886055394;2820.873060712273;2825.6044153818484;2843.1186332236657;2883.4665586866076;820.5979070255531;870.8301881133245;905.8595917632778;929.693201243588;993.5578667492896;13098.738025239441;14858.182799946107;14871.851281487263;15640.2179891005;15681.607959801097;835.143977423134;854.2354592639552;886.7472770260445;919.8226270373932;929.4748467116058;6663.5335526513645;8631.741047768577;8808.911910880937;8944.463332200088;9191.264698824078;502279;508583;542678;543716;548768.5615719198;69910.30089699037;73611.63194184101;74272.62863685648;74378;74587.62706186542;1040.6513817870946;1064.8615679961556;1069.9786004280027;1074.9731256718644;1075.9892401076045;13587.932060339635;14371.856281437053;14405.495807646683;14583;14596.197209153599;31486;31544.842275788473;31831.204219894687;32996.50505242375;33413.16467088342;36644.45033324556;37406.812965934994;37862;38264;39270.803645981585;7520.511166774142;8487;8918.420302680304;9139.908600914172;9162.175404213653;9472.905270947478;11176.664700059011;11754.529818807152;12161.69595760113;13797.448102076207;11911.583094591648;11943.343116128697;11978.58074967372;12392.75214495723;12404;12563.434645440795;12710.555130570385;12850.164739291917;13234.735305294033;13510.662233444242;12697;12933.353332333534;13192.208467491597;13214.27321497327;13542.932285338511;8711.39020268575;8759.518226497605;8915.910840891507;8943.105689431004;8944.5080520572;9354.345195836226;9409;9431.669891553762;13663.248521331423;13782.104163229358 03:40:14 INFO - 2015-12-21 03:40:14,449 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1246.0965799795144;1658.7511873219016;1699.5156380431579;1720.1141412172726;1739.0956702514688;5827.621204621697;6969.860602787941;7145.428365730742;7153.07010088689;7180.281971802817;6996.930030699691;7054.929450705491;7058.611776352299;7136.250693677167;7139.250378710239;2019.3336199054277;2056.5064384547677;2058.053295484079;2059.4336557446672;2059.536604264036;2065.122323012721;2089.665653495441;2091.759447663523;2094.979050209494;2107.3151225851584;2028.4928767808049;2050.9692354614695;2074.917003319873;2075.0454790796252;2075.1699320271937;2010.9698354524621;2034.8575599708026;2035.5827055453597;2037.1443993522755;2039.9388018359473;2038.8063134002246;2065.2565076572423;2067.018166370977;2070.0167420475304;2075.201047596671;7083.362497375209;7151.713931442736;7153.785386438415;7154.284571542856;7165.534240274365;4117.382392641128;4157.521884983235;4177.519585247705;4180.770057646828;4183.058811767328;2744.972550274492;2757.2279761666764;2770.1827960751625;2827.4910516107093;2831.490331740286;908.4095338030334;917.5595714057223;927.5779520318306;936.3445588088365;955.3885513271512;9354.766130846716;9371.062893710643;9371.578278977462;9384.390014649027;9390.765230869214;3755.9061023474087;3770.830312635938;3820;3838.7120965927666;3857.228554289153;8195.057568379712;8195.836083278302;8198.344132469389;8200;8203.630836612247;4190.811413486339;4205.495340559152;4224.387463817729;4228.5982831630945;4228.682848786353;3194.425003499346;3298.175456135966;3605.369060414417;3857.4792403025795;3858.6141385861188;3427.211741299515;3441.4149594568985;3453.2230248193955;3473.774204676688;3480.651934806499;1057.0909018244304;1067.4449286371043;1067.7437415020495;1068.8183008888507;1074.8817630060687;770.2720928722304;798.3573223555094;908.3641450984337;928.9024652411534;1080.3895798873612;6375.968120159369;6507.511936604774;6520.47836173105;6525.543211975211;6525.804225873231;992.1219720547223;1004.3572113847143;1031.128696251666;1037.7716902281486;1057.3074636113358;5158.690478571298;5184.8963020739375;5227.059129356752;5232.2674825524455;5239.528442440199;8247.95876020616;8428.199321064612;8451.32389408858;8521.786955326166;8643.135686431306;8504.702335418355;8513.318934485227;8528.275096616733;8586.441881277697;8588.52763098023;6459.870802583922;6461.967690161519;6490.415862572391;6521.8695626088165;6569.474442044625;6484.870302594016;6510.18622672166;6526.477881769352;6540.542162048801;6555.672216389257;7508.812279693051;7581.166071731995;7625.161232264558;7720.996270484801;7760.611969401394;7739.729109481141;7821.335186509211;7869.724559640385;7925.564093974886;8005.319547838266;6278;6296.905546416899;6329.7468101275435;6333.746650133943;6347.619142851444;6705.932940670726;6717.059611654275;6722.226943901318;6723.125993620798;6774.4580433564215;6390.297067322498;6440.6135631862235;6478.805635830932;6598.60408375499;6605.141331626858;5221.6344855859725;5553.500184983371;6212.06818977157;6270.059491076375;6359.236891573041;6250.218722659668;6340.873182536416;6343.302236754045;6347.68261586928;6350.936490635035;5829.883402332014;5863.912041319469;5864.120381942572;5867.559933005127;5868.589198756046;5948.821535353946;6049.848753781191;6052.727627256696;6053.606515576474;6054.9091763624465 03:40:14 INFO - 2015-12-21 03:40:14,450 DEBUG : BROWSER_OUTPUT: |4;prototype.html;289.7030543692715;298.7938322557435;299.23396105968715;306.8588449313314;307.271765914782;5259.263703081562;5290.2593636890815;5309.283246761691;5426.8914621707545;5458.6724796512235;5156.871078223037;5288.629795914278;5297.576193904488;5309.681419114856;5323.840284791462;3973.324534829086;4159.355299928501;4164;4164.083901541663;4172.123853990651;4055;4066.32905570582;4168.353905144708;4177.916441671165;4182.874513764592;4115.176964607075;4136;4136.31750761124;4139.482564679415;4143.482064741907;3930.390789427643;4018.8794336169963;4026.617471340218;4146.543880173179;4147.854825081123;3669.743117981716;3674.2651469706166;3678.6137455567314;3679.0434487033294;3681.576618688858;5066.442691303953;5113.795448182068;5116.258142569307;5129.512696293846;5130.281760553526;4695.272232803921;4723.220668589679;4757.595604373632;4758.571728544413;4763.190257656172;5457.399686034572;5566.721663916828;5569.248151499536;5573.442655734435;5576.470235327637;3935.8425662973445;3967.1272320089533;3976.840926362971;3984.063745019918;3992.740471869319;5772.595918285721;5853.5317174625925;5854.677992710399;5856.882862342729;5861.325947516048;4080.510338759368;4095.6313931746286;4099.590040995877;4104.774237416911;4106.630403263721;3857.9421308680394;3880.941785873214;4159.043420013414;4166.1251137261515;4166.145940082337;4620.306953956866;4704.741239231875;4714.4342678878065;4725.692829966041;4728.05438912219;5584;5590.468905453975;5593.790452771133;5594.300712410949;5603.831885043455;1450.4415799917108;1461.101422625078;1468.5153899213235;1473.6684246044554;1474.5281509916724;996.7906739584769;1002.1682003936716;1005.0903931941605;1006.3659894266711;1020.1991436722137;4877.804887804448;4932.235503496964;4933.901321973541;4939.629527785431;4943.184374578226;5803.7388317524965;5807.796727114531;5813.157092221604;5814.098814683731;5818.738156782871;4927.507249275044;4930.802767889316;4932.778024988884;4934.802607895644;4935.432425271139;3044.8782048718244;3091.397177550356;3126.2965832687464;3128.3899639570063;3134.2634480896972;5462.289902312674;5463.890722185534;5470.070088085035;5473.28847249855;5475.342958844964;5936.1095835625;5942.049272116441;5951.434613711691;5951.82144535656;5951.880962380815;5461.1808228766;5465.289512363367;5465.289512363367;5469.671819690831;5472.315960504937;5623.915641265303;5788.363280039108;5794.768209271582;5796.652200867961;5799.710014499174;5621.5221706155435;5632.5493960482245;5637.605367624391;5641.266635337544;5644.717764111861;5454.318210223722;5460.290162278879;5465.808696695596;5468.535174510212;5470.152126420411;4020.2160578688045;4114.485689288839;4115.506139263308;4117.155983023413;4121.711480196357;5559.388467268678;5679.858003549944;5713.1715901193265;5750.108733146369;5796.188533605383;5504.889902202013;5634.971825140848;5646.463585959327;5650.576206784425;5663.943360566342;5621.718914054362;5629.802956896489;5633.915491267552;5639.351474580476;5645.830625081254;5383.461653834585;5514.283143191359;5524.005678977823;5528.502434780889;5528.778848846001;5660.150977353265;5670.404607516151;5674.659520428788;5680.460356266148;5680.886382272414;5516.91724624139;5522.370900584257;5523.861903452445;5528.253685752372;5536.0865457200725 03:40:14 INFO - 2015-12-21 03:40:14,452 DEBUG : BROWSER_OUTPUT: |5;yui.html;681.1689738519005;724.9669221359563;772.5403384985933;801.6873419366448;814.6659869453525;10802.297850639703;12572.497100115996;12701.428435720392;12747;12754.426050827724;13150;13221;13238.33808309583;13239.735205295889;13269.668258293548;797.4617133434951;807.64059993303;812.5246730662569;812.5612169428531;813.4590497319275;637.3212528656989;647.2200997797667;779.9688012479494;790.4506368074191;808.7007807111377;840.9747707568752;844.1937949258444;850.3962186847315;851.059579165023;851.29342645604;648.4229036157823;839.7648658375665;839.937004724642;840.6385254340631;840.8024114333158;487.91705410080374;608.8873558391667;614.7633161232912;616.0851136062943;616.9321374648785;11387.715307117305;11443.313401195872;11473.541058357656;11494.770104597861;11496.367699776509;10620.522076506575;10716.571337146504;10881.401522916236;11149.058932581209;11671.416429178593;8787.692430764893;8986.19124278818;9057;9290.814183716355;9491.952540237324;3156.068959656907;3187.1834748973106;3213.501907204387;3250.463673493871;3257.4136655402017;40890.59109408897;41120.79439602783;41560.1687966242;41675.37486937668;41776.37335439971;8494.320454363637;8575.61409736551;8599.05410404855;8608.225259726654;8723.694670686495;15914.124723140338;15985.60035999086;15994.040357578582;16003.59991000211;16003.919980400024;6215.409536094064;6384.138141350951;6417;6439.774607888701;6468.482521398277;3356.8992930212135;3512.7365447591533;3629.2378600494194;3637.5634923808784;3657.8719744809337;2536.112360673749;2565.7177710451833;2574.884130214145;2575.163072001607;2579.097315939444;447.17942575373905;453.79619883621734;457.03793514651846;465.0977104417419;467.10549298094446;432.56311125763204;538.302897747418;553.9806106786324;563.456264704562;581.1892410087904;6890.173179218526;6926.441470871317;6972.2330543640155;7125;7252.3835473984245;482.3343785575953;520.7994921954999;524.5462674786359;551.4871169812033;585.648610833505;3129.5149251865996;3366.61029041257;3420.4356281213322;3425.07522968802;3494.1963348429495;48611.27083093757;48820.26769598459;48838;48909.266361004615;48934.51065489371;43912.560874391485;44237.557624423345;46960.7651961738;48299.27551086737;48667.75666121647;39828.80513584597;41055.1788964219;41085.794571026956;41130.588694112674;41301.380479292835;7037.683304251219;7635.847283054419;7645.847083058419;7729.768106956801;7812.960935195515;29347.7065229345;30024.549631755104;30744.385112297183;30751.077467676005;31314;37611.62388376081;37884;38198.618013819505;38605.806970964964;39055.2188956225;9794.412335259907;10085.445300508543;10143.137833283958;10189.796204076025;10191.082802547806;10747.462626868783;10824.134069274596;10842.674719758419;10849.403282819521;10880.455977201267;9693.176080033276;9957.452340121363;10028.64899728506;10147;10165.18678505703;9822.165115965223;9843.852342215016;9947.602095916081;9965.900340996497;10120.190384769348;9807.215422766305;9866.161376283097;9926.602935882484;10159.644412445528;10174.287799853939;7941.205879412244;8269.83460330778;8300.252977232078;8532.786680333042;8574.52840093776;7955.761327160194;7967.880481792894;8033.477823941425;8039.959800200962;8235.83528329418 03:40:14 INFO - 2015-12-21 03:40:14,452 DEBUG : BROWSER_OUTPUT: __end_tp_report 03:40:14 INFO - 2015-12-21 03:40:14,452 DEBUG : BROWSER_OUTPUT: __start_cc_report 03:40:14 INFO - 2015-12-21 03:40:14,452 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,961 03:40:14 INFO - 2015-12-21 03:40:14,452 DEBUG : BROWSER_OUTPUT: __end_cc_report 03:40:14 INFO - 2015-12-21 03:40:14,452 DEBUG : BROWSER_OUTPUT: __startTimestamp1450698014439__endTimestamp 03:40:14 INFO - 2015-12-21 03:40:14,452 DEBUG : BROWSER_OUTPUT: 03:40:14 INFO - 2015-12-21 03:40:14,452 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 03:40:14 INFO - 2015-12-21 03:40:14,452 DEBUG : BROWSER_OUTPUT: Number of tests: 6 03:40:14 INFO - 2015-12-21 03:40:14,453 DEBUG : BROWSER_OUTPUT: 03:40:14 INFO - 2015-12-21 03:40:14,453 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:4437.50 Median:4512.71 stddev:446.17 (9.9%) stddev-sans-first:422.59 03:40:14 INFO - 2015-12-21 03:40:14,454 DEBUG : BROWSER_OUTPUT: Values: 2562.2 2621.1 2621.5 2644.0 2647.5 4243.4 4374.8 4400.0 4415.0 4439.8 4378.6 4401.9 4440.2 4470.8 4482.7 4183.9 4206.2 4215.5 4232.6 4234.6 3952.1 4266.0 4300.0 4328.5 4330.2 4050.1 4138.6 4231.6 4256.0 4264.3 4150.1 4152.1 4153.1 4193.5 4198.2 3944.0 4115.4 4164.0 4170.1 4193.4 4397.3 4400.5 4488.2 4492.0 4512.7 4777.5 4870.0 4875.8 4878.1 4897.3 4629.0 4741.8 4880.8 4907.2 4915.6 4405.8 4417.2 4466.1 4472.3 4504.9 4869.6 4875.8 4882.7 4909.5 4916.4 4499.7 4603.8 4701.1 4708.7 4743.4 4669.4 4715.0 4743.9 4768.2 4815.4 4725.8 4734.5 4737.5 4739.0 4786.9 4516.8 4622.9 4778.5 4781.4 4806.5 3911.8 3985.7 4044.9 4075.8 4086.4 3565.5 3567.0 3576.9 3606.5 3611.0 3961.5 4057.2 4183.1 4191.7 4217.7 4689.2 4718.0 4761.6 4787.2 4797.6 4165.7 4203.7 4214.6 4230.3 4242.4 4035.5 4314.5 4326.4 4355.2 4369.1 4411.8 4416.5 4433.4 4503.2 4552.8 4836.7 4897.2 4904.4 4908.8 4947.4 4375.0 4614.8 4644.1 4646.0 4678.9 4672.2 4681.4 4686.3 4749.4 4793.7 4802.6 4846.3 4852.4 4859.1 4886.2 4518.9 4697.7 4705.0 4720.7 4756.0 4627.2 4641.7 4653.3 4706.4 4768.3 4583.7 4610.8 4614.6 4625.6 4649.0 4533.2 4719.2 4723.1 4733.0 4764.3 4502.1 4512.5 4616.2 4685.0 4714.7 03:40:14 INFO - 2015-12-21 03:40:14,454 DEBUG : BROWSER_OUTPUT: 03:40:14 INFO - 2015-12-21 03:40:14,454 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:41630.29 Median:327106.00 stddev:68084.84 (20.8%) stddev-sans-first:68206.04 03:40:14 INFO - 2015-12-21 03:40:14,454 DEBUG : BROWSER_OUTPUT: Values: 571.0 578.2 580.3 582.8 594.0 27175.3 27713.9 27731.3 35090.5 35994.6 39551.8 40108.8 40124.4 40225.4 40233.4 7847.7 8004.6 8014.2 8017.6 8017.8 7016.2 7155.5 10066.0 10294.6 10319.4 10044.4 10141.6 10142.4 10155.3 10163.8 7009.5 7169.5 9949.6 10044.3 10059.3 6879.4 7005.1 10115.5 10352.3 10354.5 36543.3 37002.6 37129.6 37141.6 37195.6 2839.3 2872.8 2882.4 3494.5 3579.7 26797.2 26881.0 26913.0 27236.6 27970.7 3386.4 3415.6 3434.7 3470.6 3562.0 199840.0 200783.0 201188.0 202138.0 202328.0 46470.3 47496.3 59353.0 61155.0 61204.0 54497.0 54517.0 54603.0 54667.5 54741.7 13752.4 13954.5 13959.4 13984.6 14008.5 10449.6 10569.9 10618.2 10755.8 10779.7 18885.5 19183.0 19193.4 19240.3 19264.0 7521.1 7822.8 7832.2 7924.2 7971.7 838.6 865.0 867.2 904.7 946.2 25409.5 29458.3 30459.4 31266.7 31355.2 900.1 926.7 956.2 995.5 1003.2 13638.4 13807.2 13874.4 13938.0 15123.8 322827.0 326934.0 327278.0 327454.0 328725.0 47362.3 47839.0 47981.3 48027.8 48146.3 1160.5 1177.2 1183.2 1209.2 1210.1 26511.6 27286.0 27491.6 27794.9 27864.2 39240.0 39685.8 39790.4 39803.4 39828.6 231060.0 234651.0 236627.0 240691.0 241169.0 26881.5 27010.2 27048.2 27052.2 27078.5 36824.0 44478.3 45569.0 45963.5 46730.5 32526.1 32530.0 33165.5 33305.0 33693.7 32305.4 32772.5 32908.0 33107.3 33156.5 32618.5 33333.3 33437.0 33449.0 33639.7 29237.4 29508.3 30542.8 30558.8 30576.0 23648.6 23724.2 23784.6 24032.3 24115.0 03:40:14 INFO - 2015-12-21 03:40:14,454 DEBUG : BROWSER_OUTPUT: 03:40:14 INFO - 2015-12-21 03:40:14,454 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:28163.85 Median:35028.81 stddev:86337.46 (246.5%) stddev-sans-first:86554.33 03:40:14 INFO - 2015-12-21 03:40:14,454 DEBUG : BROWSER_OUTPUT: Values: 313.6 318.8 331.9 333.5 334.0 12688.6 13112.6 15094.2 15548.5 15773.4 14486.8 14957.4 15493.4 16036.1 16068.3 5527.7 5566.3 5658.7 5669.3 5670.0 4089.0 4205.0 5575.8 6482.4 6738.0 6508.5 6585.5 6645.3 6691.9 6699.3 6578.2 6629.2 6632.8 6634.5 6635.0 6203.3 6333.3 6343.1 6408.3 6415.5 21219.0 21278.7 21652.7 21671.3 21709.2 1800.2 1907.6 1925.0 1967.3 2034.6 13373.1 13435.5 13437.2 13504.7 13752.7 1795.0 1862.7 1880.5 1906.9 1914.7 56013.0 58183.1 59781.4 59813.0 60585.7 14625.9 15063.3 15099.7 15125.6 15176.2 22861.9 22923.8 23176.7 23243.5 23248.7 8353.5 8453.4 8489.4 8525.8 8588.5 6848.9 6848.9 6897.9 7154.5 7188.0 7391.8 7434.3 7454.6 7482.0 7490.2 2252.7 2820.9 2825.6 2843.1 2883.5 820.6 870.8 905.9 929.7 993.6 13098.7 14858.2 14871.9 15640.2 15681.6 835.1 854.2 886.7 919.8 929.5 6663.5 8631.7 8808.9 8944.5 9191.3 502279.0 508583.0 542678.0 543716.0 548768.6 69910.3 73611.6 74272.6 74378.0 74587.6 1040.7 1064.9 1070.0 1075.0 1076.0 13587.9 14371.9 14405.5 14583.0 14596.2 31486.0 31544.8 31831.2 32996.5 33413.2 36644.5 37406.8 37862.0 38264.0 39270.8 7520.5 8487.0 8918.4 9139.9 9162.2 9472.9 11176.7 11754.5 12161.7 13797.4 11911.6 11943.3 11978.6 12392.8 12404.0 12563.4 12710.6 12850.2 13234.7 13510.7 12697.0 12933.4 13192.2 13214.3 13542.9 8711.4 8759.5 8915.9 8943.1 8944.5 9354.3 9409.0 9431.7 13663.2 13782.1 03:40:14 INFO - 2015-12-21 03:40:14,455 DEBUG : BROWSER_OUTPUT: 03:40:14 INFO - 2015-12-21 03:40:14,455 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:4927.59 Median:6274.03 stddev:2543.68 (40.5%) stddev-sans-first:2535.76 03:40:14 INFO - 2015-12-21 03:40:14,456 DEBUG : BROWSER_OUTPUT: Values: 1246.1 1658.8 1699.5 1720.1 1739.1 5827.6 6969.9 7145.4 7153.1 7180.3 6996.9 7054.9 7058.6 7136.3 7139.3 2019.3 2056.5 2058.1 2059.4 2059.5 2065.1 2089.7 2091.8 2095.0 2107.3 2028.5 2051.0 2074.9 2075.0 2075.2 2011.0 2034.9 2035.6 2037.1 2039.9 2038.8 2065.3 2067.0 2070.0 2075.2 7083.4 7151.7 7153.8 7154.3 7165.5 4117.4 4157.5 4177.5 4180.8 4183.1 2745.0 2757.2 2770.2 2827.5 2831.5 908.4 917.6 927.6 936.3 955.4 9354.8 9371.1 9371.6 9384.4 9390.8 3755.9 3770.8 3820.0 3838.7 3857.2 8195.1 8195.8 8198.3 8200.0 8203.6 4190.8 4205.5 4224.4 4228.6 4228.7 3194.4 3298.2 3605.4 3857.5 3858.6 3427.2 3441.4 3453.2 3473.8 3480.7 1057.1 1067.4 1067.7 1068.8 1074.9 770.3 798.4 908.4 928.9 1080.4 6376.0 6507.5 6520.5 6525.5 6525.8 992.1 1004.4 1031.1 1037.8 1057.3 5158.7 5184.9 5227.1 5232.3 5239.5 8248.0 8428.2 8451.3 8521.8 8643.1 8504.7 8513.3 8528.3 8586.4 8588.5 6459.9 6462.0 6490.4 6521.9 6569.5 6484.9 6510.2 6526.5 6540.5 6555.7 7508.8 7581.2 7625.2 7721.0 7760.6 7739.7 7821.3 7869.7 7925.6 8005.3 6278.0 6296.9 6329.7 6333.7 6347.6 6705.9 6717.1 6722.2 6723.1 6774.5 6390.3 6440.6 6478.8 6598.6 6605.1 5221.6 5553.5 6212.1 6270.1 6359.2 6250.2 6340.9 6343.3 6347.7 6350.9 5829.9 5863.9 5864.1 5867.6 5868.6 5948.8 6049.8 6052.7 6053.6 6054.9 03:40:14 INFO - 2015-12-21 03:40:14,456 DEBUG : BROWSER_OUTPUT: 03:40:14 INFO - 2015-12-21 03:40:14,456 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:4650.75 Median:5273.95 stddev:1352.58 (25.6%) stddev-sans-first:1316.17 03:40:14 INFO - 2015-12-21 03:40:14,456 DEBUG : BROWSER_OUTPUT: Values: 289.7 298.8 299.2 306.9 307.3 5259.3 5290.3 5309.3 5426.9 5458.7 5156.9 5288.6 5297.6 5309.7 5323.8 3973.3 4159.4 4164.0 4164.1 4172.1 4055.0 4066.3 4168.4 4177.9 4182.9 4115.2 4136.0 4136.3 4139.5 4143.5 3930.4 4018.9 4026.6 4146.5 4147.9 3669.7 3674.3 3678.6 3679.0 3681.6 5066.4 5113.8 5116.3 5129.5 5130.3 4695.3 4723.2 4757.6 4758.6 4763.2 5457.4 5566.7 5569.2 5573.4 5576.5 3935.8 3967.1 3976.8 3984.1 3992.7 5772.6 5853.5 5854.7 5856.9 5861.3 4080.5 4095.6 4099.6 4104.8 4106.6 3857.9 3880.9 4159.0 4166.1 4166.1 4620.3 4704.7 4714.4 4725.7 4728.1 5584.0 5590.5 5593.8 5594.3 5603.8 1450.4 1461.1 1468.5 1473.7 1474.5 996.8 1002.2 1005.1 1006.4 1020.2 4877.8 4932.2 4933.9 4939.6 4943.2 5803.7 5807.8 5813.2 5814.1 5818.7 4927.5 4930.8 4932.8 4934.8 4935.4 3044.9 3091.4 3126.3 3128.4 3134.3 5462.3 5463.9 5470.1 5473.3 5475.3 5936.1 5942.0 5951.4 5951.8 5951.9 5461.2 5465.3 5465.3 5469.7 5472.3 5623.9 5788.4 5794.8 5796.7 5799.7 5621.5 5632.5 5637.6 5641.3 5644.7 5454.3 5460.3 5465.8 5468.5 5470.2 4020.2 4114.5 4115.5 4117.2 4121.7 5559.4 5679.9 5713.2 5750.1 5796.2 5504.9 5635.0 5646.5 5650.6 5663.9 5621.7 5629.8 5633.9 5639.4 5645.8 5383.5 5514.3 5524.0 5528.5 5528.8 5660.2 5670.4 5674.7 5680.5 5680.9 5516.9 5522.4 5523.9 5528.3 5536.1 03:40:14 INFO - 2015-12-21 03:40:14,457 DEBUG : BROWSER_OUTPUT: 03:40:14 INFO - 2015-12-21 03:40:14,457 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:12080.68 Median:48455.27 stddev:13885.67 (28.7%) stddev-sans-first:13898.24 03:40:14 INFO - 2015-12-21 03:40:14,457 DEBUG : BROWSER_OUTPUT: Values: 681.2 725.0 772.5 801.7 814.7 10802.3 12572.5 12701.4 12747.0 12754.4 13150.0 13221.0 13238.3 13239.7 13269.7 797.5 807.6 812.5 812.6 813.5 637.3 647.2 780.0 790.5 808.7 841.0 844.2 850.4 851.1 851.3 648.4 839.8 839.9 840.6 840.8 487.9 608.9 614.8 616.1 616.9 11387.7 11443.3 11473.5 11494.8 11496.4 10620.5 10716.6 10881.4 11149.1 11671.4 8787.7 8986.2 9057.0 9290.8 9492.0 3156.1 3187.2 3213.5 3250.5 3257.4 40890.6 41120.8 41560.2 41675.4 41776.4 8494.3 8575.6 8599.1 8608.2 8723.7 15914.1 15985.6 15994.0 16003.6 16003.9 6215.4 6384.1 6417.0 6439.8 6468.5 3356.9 3512.7 3629.2 3637.6 3657.9 2536.1 2565.7 2574.9 2575.2 2579.1 447.2 453.8 457.0 465.1 467.1 432.6 538.3 554.0 563.5 581.2 6890.2 6926.4 6972.2 7125.0 7252.4 482.3 520.8 524.5 551.5 585.6 3129.5 3366.6 3420.4 3425.1 3494.2 48611.3 48820.3 48838.0 48909.3 48934.5 43912.6 44237.6 46960.8 48299.3 48667.8 39828.8 41055.2 41085.8 41130.6 41301.4 7037.7 7635.8 7645.8 7729.8 7813.0 29347.7 30024.5 30744.4 30751.1 31314.0 37611.6 37884.0 38198.6 38605.8 39055.2 9794.4 10085.4 10143.1 10189.8 10191.1 10747.5 10824.1 10842.7 10849.4 10880.5 9693.2 9957.5 10028.6 10147.0 10165.2 9822.2 9843.9 9947.6 9965.9 10120.2 9807.2 9866.2 9926.6 10159.6 10174.3 7941.2 8269.8 8300.3 8532.8 8574.5 7955.8 7967.9 8033.5 8040.0 8235.8 03:40:14 INFO - 2015-12-21 03:40:14,457 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 03:40:14 INFO - 2015-12-21 03:40:14,457 DEBUG : BROWSER_OUTPUT: 03:40:15 INFO - 2015-12-21 03:40:15,207 INFO : Browser exited with error code: 0 03:40:15 INFO - 2015-12-21 03:40:15,225 INFO : Completed test dromaeo_css (00:18:36) 03:40:15 INFO - 2015-12-21 03:40:15,225 INFO : Starting test kraken 03:40:15 INFO - 2015-12-21 03:40:15,226 DEBUG : operating with platform_type : linux_ 03:40:15 INFO - 2015-12-21 03:40:15,226 INFO : Initialising browser for kraken test... 03:40:15 INFO - 2015-12-21 03:40:15,232 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp5fesBS/profile http://localhost:53114/getInfo.html 03:40:19 INFO - 2015-12-21 03:40:19,234 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 03:40:19 INFO - 2015-12-21 03:40:19,234 DEBUG : BROWSER_OUTPUT: colorDepth:24 03:40:19 INFO - 2015-12-21 03:40:19,234 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 03:40:19 INFO - 2015-12-21 03:40:19,234 DEBUG : BROWSER_OUTPUT: __metrics 03:40:19 INFO - 2015-12-21 03:40:19,318 DEBUG : BROWSER_OUTPUT: JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 03:40:19 INFO - 2015-12-21 03:40:19,399 DEBUG : BROWSER_OUTPUT: JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 03:40:20 INFO - 2015-12-21 03:40:20,401 INFO : Browser initialized. 03:40:20 INFO - 2015-12-21 03:40:20,401 INFO : Running cycle 1/1 for kraken test... 03:40:20 INFO - 2015-12-21 03:40:20,401 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp5fesBS/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 03:40:32 INFO - 2015-12-21 03:40:32,350 DEBUG : BROWSER_OUTPUT: RSS: Main: 150253568 03:40:32 INFO - 2015-12-21 03:40:32,350 DEBUG : BROWSER_OUTPUT: 03:40:34 INFO - 2015-12-21 03:40:34,905 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:53114/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:53114/tests/kraken/driver.html?testName=audio-beat-detection) 03:40:35 INFO - 2015-12-21 03:40:35,491 DEBUG : BROWSER_OUTPUT: RSS: Main: 186933248 03:40:35 INFO - 2015-12-21 03:40:35,491 DEBUG : BROWSER_OUTPUT: 03:40:38 INFO - 2015-12-21 03:40:38,234 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:53114/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:53114/tests/kraken/driver.html?testName=audio-dft) 03:40:38 INFO - 2015-12-21 03:40:38,807 DEBUG : BROWSER_OUTPUT: RSS: Main: 176713728 03:40:38 INFO - 2015-12-21 03:40:38,807 DEBUG : BROWSER_OUTPUT: 03:40:41 INFO - 2015-12-21 03:40:41,771 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:53114/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:53114/tests/kraken/driver.html?testName=audio-fft) 03:40:42 INFO - 2015-12-21 03:40:42,337 DEBUG : BROWSER_OUTPUT: RSS: Main: 161845248 03:40:42 INFO - 2015-12-21 03:40:42,337 DEBUG : BROWSER_OUTPUT: 03:40:44 INFO - 2015-12-21 03:40:44,353 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:53114/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:53114/tests/kraken/driver.html?testName=audio-oscillator) 03:40:44 INFO - 2015-12-21 03:40:44,922 DEBUG : BROWSER_OUTPUT: RSS: Main: 164020224 03:40:44 INFO - 2015-12-21 03:40:44,922 DEBUG : BROWSER_OUTPUT: 03:40:47 INFO - 2015-12-21 03:40:47,196 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:53114/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:53114/tests/kraken/driver.html?testName=imaging-gaussian-blur) 03:40:47 INFO - 2015-12-21 03:40:47,769 DEBUG : BROWSER_OUTPUT: RSS: Main: 164986880 03:40:47 INFO - 2015-12-21 03:40:47,770 DEBUG : BROWSER_OUTPUT: 03:40:50 INFO - 2015-12-21 03:40:50,749 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:53114/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:53114/tests/kraken/driver.html?testName=imaging-darkroom) 03:40:51 INFO - 2015-12-21 03:40:51,330 DEBUG : BROWSER_OUTPUT: RSS: Main: 164376576 03:40:51 INFO - 2015-12-21 03:40:51,330 DEBUG : BROWSER_OUTPUT: 03:40:54 INFO - 2015-12-21 03:40:54,799 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:53114/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:53114/tests/kraken/driver.html?testName=imaging-desaturate) 03:40:55 INFO - 2015-12-21 03:40:55,380 DEBUG : BROWSER_OUTPUT: RSS: Main: 167026688 03:40:55 INFO - 2015-12-21 03:40:55,381 DEBUG : BROWSER_OUTPUT: 03:40:58 INFO - 2015-12-21 03:40:58,231 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:53114/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:53114/tests/kraken/driver.html?testName=json-parse-financial) 03:40:58 INFO - 2015-12-21 03:40:58,812 DEBUG : BROWSER_OUTPUT: RSS: Main: 165990400 03:40:58 INFO - 2015-12-21 03:40:58,813 DEBUG : BROWSER_OUTPUT: 03:41:00 INFO - 2015-12-21 03:41:00,604 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:53114/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:53114/tests/kraken/driver.html?testName=json-stringify-tinderbox) 03:41:01 INFO - 2015-12-21 03:41:01,171 DEBUG : BROWSER_OUTPUT: RSS: Main: 175013888 03:41:01 INFO - 2015-12-21 03:41:01,171 DEBUG : BROWSER_OUTPUT: 03:41:03 INFO - 2015-12-21 03:41:03,061 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:53114/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:53114/tests/kraken/driver.html?testName=stanford-crypto-aes) 03:41:03 INFO - 2015-12-21 03:41:03,655 DEBUG : BROWSER_OUTPUT: RSS: Main: 171528192 03:41:03 INFO - 2015-12-21 03:41:03,655 DEBUG : BROWSER_OUTPUT: 03:41:05 INFO - 2015-12-21 03:41:05,807 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:53114/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:53114/tests/kraken/driver.html?testName=stanford-crypto-ccm) 03:41:06 INFO - 2015-12-21 03:41:06,388 DEBUG : BROWSER_OUTPUT: RSS: Main: 187011072 03:41:06 INFO - 2015-12-21 03:41:06,388 DEBUG : BROWSER_OUTPUT: 03:41:08 INFO - 2015-12-21 03:41:08,915 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:53114/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:53114/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 03:41:09 INFO - 2015-12-21 03:41:09,501 DEBUG : BROWSER_OUTPUT: RSS: Main: 190672896 03:41:09 INFO - 2015-12-21 03:41:09,501 DEBUG : BROWSER_OUTPUT: 03:41:12 INFO - 2015-12-21 03:41:12,096 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:53114/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:53114/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 03:41:12 INFO - 2015-12-21 03:41:12,669 DEBUG : BROWSER_OUTPUT: RSS: Main: 189550592 03:41:12 INFO - 2015-12-21 03:41:12,669 DEBUG : BROWSER_OUTPUT: 03:41:14 INFO - 2015-12-21 03:41:14,446 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:53114/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:53114/tests/kraken/driver.html?testName=ai-astar) 03:41:14 INFO - 2015-12-21 03:41:14,696 DEBUG : BROWSER_OUTPUT: RSS: Main: 247136256 03:41:14 INFO - 2015-12-21 03:41:14,696 DEBUG : BROWSER_OUTPUT: 03:41:14 INFO - 2015-12-21 03:41:14,699 DEBUG : BROWSER_OUTPUT: __start_tp_report 03:41:14 INFO - 2015-12-21 03:41:14,700 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 03:41:14 INFO - 2015-12-21 03:41:14,700 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 03:41:14 INFO - 2015-12-21 03:41:14,700 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 03:41:14 INFO - 2015-12-21 03:41:14,700 DEBUG : BROWSER_OUTPUT: |0;ai-astar;110;112;107;111;111;112;101;111;111;118 03:41:14 INFO - 2015-12-21 03:41:14,700 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;156;139;160;161;136;161;158;132;166;128 03:41:14 INFO - 2015-12-21 03:41:14,700 DEBUG : BROWSER_OUTPUT: |2;audio-dft;159;160;159;158;160;160;160;161;163;162 03:41:14 INFO - 2015-12-21 03:41:14,700 DEBUG : BROWSER_OUTPUT: |3;audio-fft;72;72;80;101;74;73;72;102;89;73 03:41:14 INFO - 2015-12-21 03:41:14,701 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;95;95;141;94;95;94;134;95;96;128 03:41:14 INFO - 2015-12-21 03:41:14,701 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;109;109;110;109;111;110;109;109;109;110 03:41:14 INFO - 2015-12-21 03:41:14,701 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;148;145;146;147;146;147;147;147;146;146 03:41:14 INFO - 2015-12-21 03:41:14,701 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;95;95;96;96;95;96;95;95;95;95 03:41:14 INFO - 2015-12-21 03:41:14,701 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;70;71;71;72;71;72;71;80;77;69 03:41:14 INFO - 2015-12-21 03:41:14,701 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;67;67;67;67;67;68;68;68;68;68 03:41:14 INFO - 2015-12-21 03:41:14,701 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;85;86;84;85;84;94;85;86;88;86 03:41:14 INFO - 2015-12-21 03:41:14,701 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;126;129;117;126;116;125;122;127;126;125 03:41:14 INFO - 2015-12-21 03:41:14,702 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;155;138;148;147;147;137;141;139;147;153 03:41:14 INFO - 2015-12-21 03:41:14,702 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;70;70;71;70;69;72;69;69;72;71 03:41:14 INFO - 2015-12-21 03:41:14,702 DEBUG : BROWSER_OUTPUT: __end_tp_report 03:41:14 INFO - 2015-12-21 03:41:14,702 DEBUG : BROWSER_OUTPUT: __start_cc_report 03:41:14 INFO - 2015-12-21 03:41:14,702 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,984 03:41:14 INFO - 2015-12-21 03:41:14,702 DEBUG : BROWSER_OUTPUT: __end_cc_report 03:41:14 INFO - 2015-12-21 03:41:14,702 DEBUG : BROWSER_OUTPUT: __startTimestamp1450698074697__endTimestamp 03:41:14 INFO - 2015-12-21 03:41:14,702 DEBUG : BROWSER_OUTPUT: 03:41:14 INFO - 2015-12-21 03:41:14,706 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 03:41:14 INFO - 2015-12-21 03:41:14,706 DEBUG : BROWSER_OUTPUT: Number of tests: 14 03:41:14 INFO - 2015-12-21 03:41:14,706 DEBUG : BROWSER_OUTPUT: 03:41:14 INFO - 2015-12-21 03:41:14,706 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:110.40 Median:111.00 stddev:4.27 (3.9%) stddev-sans-first:4.53 03:41:14 INFO - 2015-12-21 03:41:14,706 DEBUG : BROWSER_OUTPUT: Values: 110.0 112.0 107.0 111.0 111.0 112.0 101.0 111.0 111.0 118.0 03:41:14 INFO - 2015-12-21 03:41:14,706 DEBUG : BROWSER_OUTPUT: 03:41:14 INFO - 2015-12-21 03:41:14,706 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:149.70 Median:159.00 stddev:14.23 (8.9%) stddev-sans-first:14.91 03:41:14 INFO - 2015-12-21 03:41:14,706 DEBUG : BROWSER_OUTPUT: Values: 156.0 139.0 160.0 161.0 136.0 161.0 158.0 132.0 166.0 128.0 03:41:14 INFO - 2015-12-21 03:41:14,706 DEBUG : BROWSER_OUTPUT: 03:41:14 INFO - 2015-12-21 03:41:14,706 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:160.20 Median:160.00 stddev:1.48 (0.9%) stddev-sans-first:1.50 03:41:14 INFO - 2015-12-21 03:41:14,706 DEBUG : BROWSER_OUTPUT: Values: 159.0 160.0 159.0 158.0 160.0 160.0 160.0 161.0 163.0 162.0 03:41:14 INFO - 2015-12-21 03:41:14,706 DEBUG : BROWSER_OUTPUT: 03:41:14 INFO - 2015-12-21 03:41:14,707 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:80.80 Median:73.00 stddev:12.14 (16.6%) stddev-sans-first:12.45 03:41:14 INFO - 2015-12-21 03:41:14,707 DEBUG : BROWSER_OUTPUT: Values: 72.0 72.0 80.0 101.0 74.0 73.0 72.0 102.0 89.0 73.0 03:41:14 INFO - 2015-12-21 03:41:14,707 DEBUG : BROWSER_OUTPUT: 03:41:14 INFO - 2015-12-21 03:41:14,707 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:106.70 Median:95.00 stddev:19.32 (20.3%) stddev-sans-first:20.02 03:41:14 INFO - 2015-12-21 03:41:14,707 DEBUG : BROWSER_OUTPUT: Values: 95.0 95.0 141.0 94.0 95.0 94.0 134.0 95.0 96.0 128.0 03:41:14 INFO - 2015-12-21 03:41:14,707 DEBUG : BROWSER_OUTPUT: 03:41:14 INFO - 2015-12-21 03:41:14,707 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:109.50 Median:109.50 stddev:0.71 (0.6%) stddev-sans-first:0.73 03:41:14 INFO - 2015-12-21 03:41:14,707 DEBUG : BROWSER_OUTPUT: Values: 109.0 109.0 110.0 109.0 111.0 110.0 109.0 109.0 109.0 110.0 03:41:14 INFO - 2015-12-21 03:41:14,707 DEBUG : BROWSER_OUTPUT: 03:41:14 INFO - 2015-12-21 03:41:14,707 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:146.50 Median:147.00 stddev:0.85 (0.6%) stddev-sans-first:0.71 03:41:14 INFO - 2015-12-21 03:41:14,707 DEBUG : BROWSER_OUTPUT: Values: 148.0 145.0 146.0 147.0 146.0 147.0 147.0 147.0 146.0 146.0 03:41:14 INFO - 2015-12-21 03:41:14,707 DEBUG : BROWSER_OUTPUT: 03:41:14 INFO - 2015-12-21 03:41:14,707 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:95.30 Median:95.00 stddev:0.48 (0.5%) stddev-sans-first:0.50 03:41:14 INFO - 2015-12-21 03:41:14,707 DEBUG : BROWSER_OUTPUT: Values: 95.0 95.0 96.0 96.0 95.0 96.0 95.0 95.0 95.0 95.0 03:41:14 INFO - 2015-12-21 03:41:14,707 DEBUG : BROWSER_OUTPUT: 03:41:14 INFO - 2015-12-21 03:41:14,708 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:72.40 Median:71.50 stddev:3.41 (4.8%) stddev-sans-first:3.50 03:41:14 INFO - 2015-12-21 03:41:14,708 DEBUG : BROWSER_OUTPUT: Values: 70.0 71.0 71.0 72.0 71.0 72.0 71.0 80.0 77.0 69.0 03:41:14 INFO - 2015-12-21 03:41:14,708 DEBUG : BROWSER_OUTPUT: 03:41:14 INFO - 2015-12-21 03:41:14,708 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:67.50 Median:68.00 stddev:0.53 (0.8%) stddev-sans-first:0.53 03:41:14 INFO - 2015-12-21 03:41:14,708 DEBUG : BROWSER_OUTPUT: Values: 67.0 67.0 67.0 67.0 67.0 68.0 68.0 68.0 68.0 68.0 03:41:14 INFO - 2015-12-21 03:41:14,708 DEBUG : BROWSER_OUTPUT: 03:41:14 INFO - 2015-12-21 03:41:14,708 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:86.30 Median:86.00 stddev:2.95 (3.4%) stddev-sans-first:3.09 03:41:14 INFO - 2015-12-21 03:41:14,709 DEBUG : BROWSER_OUTPUT: Values: 85.0 86.0 84.0 85.0 84.0 94.0 85.0 86.0 88.0 86.0 03:41:14 INFO - 2015-12-21 03:41:14,709 DEBUG : BROWSER_OUTPUT: 03:41:14 INFO - 2015-12-21 03:41:14,709 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:123.90 Median:126.00 stddev:4.28 (3.4%) stddev-sans-first:4.47 03:41:14 INFO - 2015-12-21 03:41:14,709 DEBUG : BROWSER_OUTPUT: Values: 126.0 129.0 117.0 126.0 116.0 125.0 122.0 127.0 126.0 125.0 03:41:14 INFO - 2015-12-21 03:41:14,709 DEBUG : BROWSER_OUTPUT: 03:41:14 INFO - 2015-12-21 03:41:14,709 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:145.20 Median:147.00 stddev:6.23 (4.2%) stddev-sans-first:5.51 03:41:14 INFO - 2015-12-21 03:41:14,709 DEBUG : BROWSER_OUTPUT: Values: 155.0 138.0 148.0 147.0 147.0 137.0 141.0 139.0 147.0 153.0 03:41:14 INFO - 2015-12-21 03:41:14,709 DEBUG : BROWSER_OUTPUT: 03:41:14 INFO - 2015-12-21 03:41:14,710 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:70.30 Median:70.50 stddev:1.16 (1.6%) stddev-sans-first:1.22 03:41:14 INFO - 2015-12-21 03:41:14,710 DEBUG : BROWSER_OUTPUT: Values: 70.0 70.0 71.0 70.0 69.0 72.0 69.0 69.0 72.0 71.0 03:41:14 INFO - 2015-12-21 03:41:14,710 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 03:41:14 INFO - 2015-12-21 03:41:14,710 DEBUG : BROWSER_OUTPUT: 03:41:15 INFO - 2015-12-21 03:41:15,623 INFO : Browser exited with error code: 0 03:41:15 INFO - 2015-12-21 03:41:15,676 INFO : Completed test kraken (00:01:00) 03:41:15 INFO - 2015-12-21 03:41:15,676 INFO : Starting test v8_7 03:41:15 INFO - 2015-12-21 03:41:15,676 DEBUG : operating with platform_type : linux_ 03:41:15 INFO - 2015-12-21 03:41:15,676 INFO : Initialising browser for v8_7 test... 03:41:15 INFO - 2015-12-21 03:41:15,682 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpmKnnWk/profile http://localhost:53114/getInfo.html 03:41:19 INFO - 2015-12-21 03:41:19,943 DEBUG : BROWSER_OUTPUT: JavaScript error: resource://app/modules/BrowserUITelemetry.jsm, line 538: ReferenceError: assignment to undeclared variable item 03:41:19 INFO - 2015-12-21 03:41:19,971 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 03:41:19 INFO - 2015-12-21 03:41:19,971 DEBUG : BROWSER_OUTPUT: colorDepth:24 03:41:19 INFO - 2015-12-21 03:41:19,971 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 03:41:19 INFO - 2015-12-21 03:41:19,972 DEBUG : BROWSER_OUTPUT: __metrics 03:41:20 INFO - 2015-12-21 03:41:20,088 DEBUG : BROWSER_OUTPUT: JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 03:41:20 INFO - 2015-12-21 03:41:20,136 DEBUG : BROWSER_OUTPUT: JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 03:41:20 ERROR - 2015-12-21 03:41:20,152 DEBUG : BROWSER_OUTPUT: JavaScript error: chrome://browser/content/tab-content.js, line 408: TypeError: content is null 03:41:21 INFO - 2015-12-21 03:41:21,001 INFO : Browser initialized. 03:41:21 INFO - 2015-12-21 03:41:21,002 INFO : Running cycle 1/1 for v8_7 test... 03:41:21 INFO - 2015-12-21 03:41:21,002 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpmKnnWk/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 03:41:32 INFO - 2015-12-21 03:41:32,963 DEBUG : BROWSER_OUTPUT: RSS: Main: 149762048 03:41:32 INFO - 2015-12-21 03:41:32,963 DEBUG : BROWSER_OUTPUT: 03:41:54 INFO - 2015-12-21 03:41:54,388 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:53114/tests/v8_7/run.html (next: http://localhost:53114/tests/v8_7/run.html) 03:41:54 INFO - 2015-12-21 03:41:54,646 DEBUG : BROWSER_OUTPUT: RSS: Main: 451088384 03:41:54 INFO - 2015-12-21 03:41:54,647 DEBUG : BROWSER_OUTPUT: 03:41:54 INFO - 2015-12-21 03:41:54,647 DEBUG : BROWSER_OUTPUT: __start_tp_report 03:41:54 INFO - 2015-12-21 03:41:54,647 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 03:41:54 INFO - 2015-12-21 03:41:54,647 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 03:41:54 INFO - 2015-12-21 03:41:54,647 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 03:41:54 INFO - 2015-12-21 03:41:54,648 DEBUG : BROWSER_OUTPUT: |0;Richards;165.6726308813784 03:41:54 INFO - 2015-12-21 03:41:54,648 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;185.7700167193015 03:41:54 INFO - 2015-12-21 03:41:54,648 DEBUG : BROWSER_OUTPUT: |2;Encrypt;282.2466836014677 03:41:54 INFO - 2015-12-21 03:41:54,648 DEBUG : BROWSER_OUTPUT: |3;Decrypt;5128.205128205128 03:41:54 INFO - 2015-12-21 03:41:54,649 DEBUG : BROWSER_OUTPUT: |4;RayTrace;2006.0120240480962 03:41:54 INFO - 2015-12-21 03:41:54,649 DEBUG : BROWSER_OUTPUT: |5;Earley;799.3605115907275 03:41:54 INFO - 2015-12-21 03:41:54,649 DEBUG : BROWSER_OUTPUT: |6;Boyer;12144.578313253012 03:41:54 INFO - 2015-12-21 03:41:54,649 DEBUG : BROWSER_OUTPUT: |7;RegExp;26657.894736842107 03:41:54 INFO - 2015-12-21 03:41:54,650 DEBUG : BROWSER_OUTPUT: |8;Splay;606.060606060606 03:41:54 INFO - 2015-12-21 03:41:54,650 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;4840.579710144928 03:41:54 INFO - 2015-12-21 03:41:54,650 DEBUG : BROWSER_OUTPUT: __end_tp_report 03:41:54 INFO - 2015-12-21 03:41:54,650 DEBUG : BROWSER_OUTPUT: __startTimestamp1450698114640__endTimestamp 03:41:54 INFO - 2015-12-21 03:41:54,650 DEBUG : BROWSER_OUTPUT: 03:41:54 INFO - 2015-12-21 03:41:54,651 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 03:41:54 INFO - 2015-12-21 03:41:54,651 DEBUG : BROWSER_OUTPUT: Number of tests: 10 03:41:54 INFO - 2015-12-21 03:41:54,651 DEBUG : BROWSER_OUTPUT: 03:41:54 INFO - 2015-12-21 03:41:54,651 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:165.67 Median:165.67 stddev:0.00 (0.0%) 03:41:54 INFO - 2015-12-21 03:41:54,652 DEBUG : BROWSER_OUTPUT: Values: 165.7 03:41:54 INFO - 2015-12-21 03:41:54,652 DEBUG : BROWSER_OUTPUT: 03:41:54 INFO - 2015-12-21 03:41:54,652 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:185.77 Median:185.77 stddev:0.00 (0.0%) 03:41:54 INFO - 2015-12-21 03:41:54,652 DEBUG : BROWSER_OUTPUT: Values: 185.8 03:41:54 INFO - 2015-12-21 03:41:54,652 DEBUG : BROWSER_OUTPUT: 03:41:54 INFO - 2015-12-21 03:41:54,653 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:282.25 Median:282.25 stddev:0.00 (0.0%) 03:41:54 INFO - 2015-12-21 03:41:54,653 DEBUG : BROWSER_OUTPUT: Values: 282.2 03:41:54 INFO - 2015-12-21 03:41:54,653 DEBUG : BROWSER_OUTPUT: 03:41:54 INFO - 2015-12-21 03:41:54,653 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:5128.21 Median:5128.21 stddev:0.00 (0.0%) 03:41:54 INFO - 2015-12-21 03:41:54,653 DEBUG : BROWSER_OUTPUT: Values: 5128.2 03:41:54 INFO - 2015-12-21 03:41:54,654 DEBUG : BROWSER_OUTPUT: 03:41:54 INFO - 2015-12-21 03:41:54,654 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:2006.01 Median:2006.01 stddev:0.00 (0.0%) 03:41:54 INFO - 2015-12-21 03:41:54,654 DEBUG : BROWSER_OUTPUT: Values: 2006.0 03:41:54 INFO - 2015-12-21 03:41:54,654 DEBUG : BROWSER_OUTPUT: 03:41:54 INFO - 2015-12-21 03:41:54,655 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:799.36 Median:799.36 stddev:0.00 (0.0%) 03:41:54 INFO - 2015-12-21 03:41:54,655 DEBUG : BROWSER_OUTPUT: Values: 799.4 03:41:54 INFO - 2015-12-21 03:41:54,655 DEBUG : BROWSER_OUTPUT: 03:41:54 INFO - 2015-12-21 03:41:54,655 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:12144.58 Median:12144.58 stddev:0.00 (0.0%) 03:41:54 INFO - 2015-12-21 03:41:54,656 DEBUG : BROWSER_OUTPUT: Values: 12144.6 03:41:54 INFO - 2015-12-21 03:41:54,656 DEBUG : BROWSER_OUTPUT: 03:41:54 INFO - 2015-12-21 03:41:54,656 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:26657.89 Median:26657.89 stddev:0.00 (0.0%) 03:41:54 INFO - 2015-12-21 03:41:54,656 DEBUG : BROWSER_OUTPUT: Values: 26657.9 03:41:54 INFO - 2015-12-21 03:41:54,656 DEBUG : BROWSER_OUTPUT: 03:41:54 INFO - 2015-12-21 03:41:54,657 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:606.06 Median:606.06 stddev:0.00 (0.0%) 03:41:54 INFO - 2015-12-21 03:41:54,657 DEBUG : BROWSER_OUTPUT: Values: 606.1 03:41:54 INFO - 2015-12-21 03:41:54,657 DEBUG : BROWSER_OUTPUT: 03:41:54 INFO - 2015-12-21 03:41:54,657 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:4840.58 Median:4840.58 stddev:0.00 (0.0%) 03:41:54 INFO - 2015-12-21 03:41:54,658 DEBUG : BROWSER_OUTPUT: Values: 4840.6 03:41:54 INFO - 2015-12-21 03:41:54,658 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 03:41:54 INFO - 2015-12-21 03:41:54,658 DEBUG : BROWSER_OUTPUT: 03:41:55 INFO - 2015-12-21 03:41:55,571 INFO : Browser exited with error code: 0 03:41:55 INFO - 2015-12-21 03:41:55,588 INFO : Completed test v8_7 (00:00:39) 03:41:55 INFO - 2015-12-21 03:41:55,636 INFO : Completed test suite (00:20:17) 03:41:55 INFO - 2015-12-21 03:41:55,637 DEBUG : Working with test: dromaeo_css 03:41:55 INFO - 2015-12-21 03:41:55,637 DEBUG : Generating results file: dromaeo_css 03:41:55 INFO - 2015-12-21 03:41:55,638 DEBUG : Working with test: kraken 03:41:55 INFO - 2015-12-21 03:41:55,638 DEBUG : Generating results file: kraken 03:41:55 INFO - 2015-12-21 03:41:55,638 INFO : javascript benchmark 03:41:55 INFO - 2015-12-21 03:41:55,638 DEBUG : Working with test: v8_7 03:41:55 INFO - 2015-12-21 03:41:55,638 DEBUG : Generating results file: v8_7 03:41:55 INFO - 2015-12-21 03:41:55,639 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 03:41:55 INFO - 2015-12-21 03:41:55,691 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,132,35]] 03:41:55 INFO - 2015-12-21 03:41:55,691 DEBUG : process_Request line: dromaeo_css 6341.76 graph.html#tests=[[72,132,35]] 03:41:55 INFO - 2015-12-21 03:41:55,691 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 03:41:55 INFO - 2015-12-21 03:41:55,727 DEBUG : process_Request line: kraken 1524.70 graph.html#tests=[[232,132,35]] 03:41:55 INFO - 2015-12-21 03:41:55,727 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 03:41:55 INFO - 2015-12-21 03:41:55,758 DEBUG : process_Request line: v8_7 19781.46 graph.html#tests=[[230,132,35]] 03:41:55 INFO - 2015-12-21 03:41:55,759 INFO : javascript benchmark 03:41:55 INFO - 2015-12-21 03:41:55,763 INFO : PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [2562.2441379792963, 2621.0957219759175, 2621.4757048590277, 2643.973560264398, 2647.47050589882, 4243.448351714273, 4374.803133858976, 4399.960163330348, 4414.977925110374, 4439.7780110994445, 4378.584034516716, 4401.889952751183, 4440.222960981823, 4470.75410852403, 4482.731036137834, 4183.937240941388, 4206.158768246348, 4215.515215750182, 4232.640225580829, 4234.555371685975, 3952.071263253133, 4265.997490589709, 4300.032492689135, 4328.502222244435, 4330.242207613671, 4050.1494686115952, 4138.586141385867, 4231.555686652919, 4256.021115143503, 4264.33902745075, 4150.128473020669, 4152.065785198336, 4153.06556024895, 4193.496780386343, 4198.160367926427, 3944.0337117406134, 4115.382692596135, 4163.958360416387, 4170.082581831992, 4193.412922190896, 4397.252467080604, 4400.515943246241, 4488.214562451558, 4492.034212644265, 4512.706674066175, 4777.474477807438, 4869.975650121763, 4875.829345972874, 4878.146324393252, 4897.33885925399, 4628.953710462886, 4741.762911854394, 4880.780364883589, 4907.214845624683, 4915.5821755150855, 4405.8237670493145, 4417.2269852775635, 4466.062126953311, 4472.306792447111, 4504.932426013613, 4869.610431165498, 4875.8049678012485, 4882.7314497702255, 4909.5090490950615, 4916.434610019894, 4499.662525310615, 4603.769811509411, 4701.083288758728, 4708.717476951326, 4743.430788305425, 4669.39297891272, 4715.033418149271, 4743.857684269477, 4768.189407800683, 4815.446223684251, 4725.787339569728, 4734.455537613149, 4737.549932756383, 4738.976305118521, 4786.928196077061, 4516.751578663139, 4622.907541849144, 4778.546038126373, 4781.402324709411, 4806.49531799156, 3911.765294082364, 3985.720999530005, 4044.8786536403954, 4075.7554546727292, 4086.366613174963, 3565.536480257602, 3567.0369000370274, 3576.8569257229938, 3606.4770608261656, 3611.0250232437097, 3961.504811898513, 4057.188562287495, 4183.1215444756945, 4191.7484950903045, 4217.683673724483, 4689.179393606105, 4717.95282047182, 4761.619070474354, 4787.186178349689, 4797.592204662573, 4165.687573432005, 4203.747775133502, 4214.599613036757, 4230.344296634026, 4242.44848169736, 4035.455213546192, 4314.460692413449, 4326.351047342924, 4355.1725172217175, 4369.126174764996, 4411.823527058882, 4416.470023597189, 4433.423654924839, 4503.234450143418, 4552.840650577214, 4836.685615434985, 4897.167481528078, 4904.386951631046, 4908.82819101344, 4947.381577302837, 4374.956250437455, 4614.815407383667, 4644.117617652635, 4645.977884865324, 4678.883027924329, 4672.182368085503, 4681.438227412732, 4686.343911852276, 4749.382580264543, 4793.712377257376, 4802.639802014793, 4846.345743324606, 4852.393450818648, 4859.052484765437, 4886.218205087169, 4518.932216016697, 4697.718136911796, 4704.9529504704515, 4720.740359280135, 4756.025014871874, 4627.167109920112, 4641.698289611165, 4653.302004699187, 4706.411698537683, 4768.332433459388, 4583.747893865736, 4610.769461526843, 4614.561616646413, 4625.560571745679, 4648.953510464852, 4533.229351010402, 4719.1977363847545, 4723.102610503994, 4733.0, 4764.309175169512, 4502.099580083931, 4512.548745125461, 4616.192166370939, 4685.01614660925, 4714.7406892619865], "unit": "score", "name": "dojo.html", "value": 4411.131249588744}, {"lowerIsBetter": false, "replicates": [571.0206995003568, 578.2049681687678, 580.3210244014502, 582.8164128299585, 593.9970300148501, 27175.320616984583, 27713.861430692843, 27731.306717332078, 35090.47364289531, 35994.640053599454, 39551.80224098883, 40108.79945600268, 40124.39813402794, 40225.396619050734, 40233.396499052535, 7847.686092556305, 8004.63979120941, 8014.198580141998, 8017.559034253114, 8017.799555011113, 7016.193137789143, 7155.4633402494765, 10066.0, 10294.639687610936, 10319.380837149758, 10044.397336159816, 10141.594336226543, 10142.442165680885, 10155.339902906288, 10163.796724065514, 7009.474289428263, 7169.462290328246, 9949.60201591939, 10044.296899217057, 10059.295849290553, 6879.449644028466, 7005.0893383859775, 10115.49422528878, 10352.327098738559, 10354.482275886176, 36543.269134617425, 37002.62997370019, 37129.628703712886, 37141.62858371409, 37195.62804371976, 2839.304370429237, 2872.755815755663, 2882.3658795065053, 3494.5107684924133, 3579.6778289954027, 26797.196084117506, 26881.0, 26913.0, 27236.59145112825, 27970.720292797014, 3386.3904497190497, 3415.573053368329, 3434.708049815769, 3470.5661792275964, 3562.0, 199840.0, 200783.0, 201188.0, 202137.989310054, 202328.0, 46470.30294545584, 47496.28755568669, 59353.0, 61155.0, 61204.0, 54497.0, 54517.0, 54603.0, 54667.45332546703, 54741.726291368286, 13752.381142848395, 13954.511592094228, 13959.371828267753, 13984.580462586138, 14008.509702160376, 10449.634262800766, 10569.894301056891, 10618.203634727426, 10755.78488430227, 10779.730506737395, 18885.52786180329, 19183.0, 19193.424197274104, 19240.326588569333, 19264.0, 7521.135069466972, 7822.843543129219, 7832.177621349791, 7924.167962363984, 7971.72098976533, 838.6310023589601, 864.9620455453481, 867.2021739999216, 904.692404582432, 946.1673727120091, 25409.49181016406, 29458.263543411158, 30459.390812183632, 31266.687333126833, 31355.216119597193, 900.0864122915247, 926.6525053105086, 956.2111258212003, 995.4972738767021, 1003.1824063388315, 13638.386272617756, 13807.17156970585, 13874.375653095634, 13938.0, 15123.848761512465, 322827.0, 326934.0, 327278.0, 327454.0, 328725.0, 47362.289565656545, 47839.0, 47981.280280795814, 48027.75986120047, 48146.27780583224, 1160.489384670742, 1177.1995043370418, 1183.177691504396, 1209.2442223610244, 1210.0803389424102, 26511.602325965512, 27286.0, 27491.587626186025, 27794.861025694743, 27864.16407507778, 39240.0, 39685.801570991964, 39790.40314395229, 39803.40294895521, 39828.60171398249, 231060.0, 234651.0, 236627.0, 240691.0, 241169.0, 26881.462370752866, 27010.189694309203, 27048.1885543434, 27052.188434347, 27078.45843083088, 36824.0, 44478.3328250083, 45569.0, 45963.54036459592, 46730.53269467262, 32526.10353570648, 32530.0, 33165.50251746274, 33305.0, 33693.66306336905, 32305.35389292154, 32772.46233366387, 32908.0, 33107.33785324328, 33156.50265246072, 32618.51072233871, 33333.33333333271, 33437.0, 33449.0, 33639.663603364635, 29237.41525169527, 29508.262293441978, 30542.84728576343, 30558.84720576383, 30576.0, 23648.645270321304, 23724.169654062025, 23784.610191702297, 24032.279031629078, 24115.0], "unit": "score", "name": "ext.html", "value": 17217.265043430907}, {"lowerIsBetter": false, "replicates": [313.5985937999359, 318.78163458031236, 331.9460712238642, 333.52472726364937, 334.01798711787353, 12688.61934141975, 13112.606621801337, 15094.24528773561, 15548.45580404686, 15773.44792932249, 14486.782698259509, 14957.401703931857, 15493.380264789395, 16036.118013509253, 16068.27692753826, 5527.695976721278, 5566.304211973514, 5658.7170641467965, 5669.291338582677, 5670.036093864053, 4089.0, 4204.97897510512, 5575.832725018236, 6482.416582507573, 6737.98930160475, 6508.511861610375, 6585.506087043467, 6645.30224326446, 6691.93308066918, 6699.330066993286, 6578.210614726216, 6629.171353580802, 6632.801015969529, 6634.469242460592, 6635.037919501645, 6203.348648391899, 6333.334999824998, 6343.14367560378, 6408.327125651833, 6415.454686351665, 21219.0, 21278.680819787714, 21652.675209871864, 21671.34985950424, 21709.240176593903, 1800.207908520247, 1907.5898681783344, 1924.9615007699908, 1967.3409407848387, 2034.5625690476618, 13373.130746501447, 13435.529756458476, 13437.193768373929, 13504.662383440394, 13752.724945501033, 1794.9910250448663, 1862.748528948588, 1880.5110671225443, 1906.90465476727, 1914.6936490161647, 56013.0, 58183.12725309082, 59781.40218597802, 59813.0, 60585.69707151524, 14625.92687036558, 15063.322150503254, 15099.698006039818, 15125.621859453602, 15176.165310907785, 22861.885690571442, 22923.770762292497, 23176.65235021476, 23243.53512929732, 23248.65127023096, 8353.540555269397, 8453.393855167498, 8489.405741598152, 8525.786855328666, 8588.484690918565, 6848.863022739517, 6848.863022739617, 6897.896531552031, 7154.534955227893, 7188.029616001772, 7391.8152046199275, 7434.25657434263, 7454.627268636546, 7481.962590187123, 7490.213527579525, 2252.695886055394, 2820.873060712273, 2825.6044153818484, 2843.1186332236657, 2883.4665586866076, 820.5979070255531, 870.8301881133245, 905.8595917632778, 929.693201243588, 993.5578667492896, 13098.738025239441, 14858.182799946107, 14871.851281487263, 15640.2179891005, 15681.607959801097, 835.143977423134, 854.2354592639552, 886.7472770260445, 919.8226270373932, 929.4748467116058, 6663.5335526513645, 8631.741047768577, 8808.911910880937, 8944.463332200088, 9191.264698824078, 502279.0, 508583.0, 542678.0, 543716.0, 548768.5615719198, 69910.30089699037, 73611.63194184101, 74272.62863685648, 74378.0, 74587.62706186542, 1040.6513817870946, 1064.8615679961556, 1069.9786004280027, 1074.9731256718644, 1075.9892401076045, 13587.932060339635, 14371.856281437053, 14405.495807646683, 14583.0, 14596.197209153599, 31486.0, 31544.842275788473, 31831.204219894687, 32996.50505242375, 33413.16467088342, 36644.45033324556, 37406.812965934994, 37862.0, 38264.0, 39270.803645981585, 7520.511166774142, 8487.0, 8918.420302680304, 9139.908600914172, 9162.175404213653, 9472.905270947478, 11176.664700059011, 11754.529818807152, 12161.69595760113, 13797.448102076207, 11911.583094591648, 11943.343116128697, 11978.58074967372, 12392.75214495723, 12404.0, 12563.434645440795, 12710.555130570385, 12850.164739291917, 13234.735305294033, 13510.662233444242, 12697.0, 12933.353332333534, 13192.208467491597, 13214.27321497327, 13542.932285338511, 8711.39020268575, 8759.518226497605, 8915.910840891507, 8943.105689431004, 8944.5080520572, 9354.345195836226, 9409.0, 9431.669891553762, 13663.248521331423, 13782.104163229358], "unit": "score", "name": "jquery.html", "value": 9012.629532207919}, {"lowerIsBetter": false, "replicates": [1246.0965799795144, 1658.7511873219016, 1699.5156380431579, 1720.1141412172726, 1739.0956702514688, 5827.621204621697, 6969.860602787941, 7145.428365730742, 7153.07010088689, 7180.281971802817, 6996.930030699691, 7054.929450705491, 7058.611776352299, 7136.250693677167, 7139.250378710239, 2019.3336199054277, 2056.5064384547677, 2058.053295484079, 2059.4336557446672, 2059.536604264036, 2065.122323012721, 2089.665653495441, 2091.759447663523, 2094.979050209494, 2107.3151225851584, 2028.4928767808049, 2050.9692354614695, 2074.917003319873, 2075.0454790796252, 2075.1699320271937, 2010.9698354524621, 2034.8575599708026, 2035.5827055453597, 2037.1443993522755, 2039.9388018359473, 2038.8063134002246, 2065.2565076572423, 2067.018166370977, 2070.0167420475304, 2075.201047596671, 7083.362497375209, 7151.713931442736, 7153.785386438415, 7154.284571542856, 7165.534240274365, 4117.382392641128, 4157.521884983235, 4177.519585247705, 4180.770057646828, 4183.058811767328, 2744.972550274492, 2757.2279761666764, 2770.1827960751625, 2827.4910516107093, 2831.490331740286, 908.4095338030334, 917.5595714057223, 927.5779520318306, 936.3445588088365, 955.3885513271512, 9354.766130846716, 9371.062893710643, 9371.578278977462, 9384.390014649027, 9390.765230869214, 3755.9061023474087, 3770.830312635938, 3820.0, 3838.7120965927666, 3857.228554289153, 8195.057568379712, 8195.836083278302, 8198.344132469389, 8200.0, 8203.630836612247, 4190.811413486339, 4205.495340559152, 4224.387463817729, 4228.5982831630945, 4228.682848786353, 3194.425003499346, 3298.175456135966, 3605.369060414417, 3857.4792403025795, 3858.6141385861188, 3427.211741299515, 3441.4149594568985, 3453.2230248193955, 3473.774204676688, 3480.651934806499, 1057.0909018244304, 1067.4449286371043, 1067.7437415020495, 1068.8183008888507, 1074.8817630060687, 770.2720928722304, 798.3573223555094, 908.3641450984337, 928.9024652411534, 1080.3895798873612, 6375.968120159369, 6507.511936604774, 6520.47836173105, 6525.543211975211, 6525.804225873231, 992.1219720547223, 1004.3572113847143, 1031.128696251666, 1037.7716902281486, 1057.3074636113358, 5158.690478571298, 5184.8963020739375, 5227.059129356752, 5232.2674825524455, 5239.528442440199, 8247.95876020616, 8428.199321064612, 8451.32389408858, 8521.786955326166, 8643.135686431306, 8504.702335418355, 8513.318934485227, 8528.275096616733, 8586.441881277697, 8588.52763098023, 6459.870802583922, 6461.967690161519, 6490.415862572391, 6521.8695626088165, 6569.474442044625, 6484.870302594016, 6510.18622672166, 6526.477881769352, 6540.542162048801, 6555.672216389257, 7508.812279693051, 7581.166071731995, 7625.161232264558, 7720.996270484801, 7760.611969401394, 7739.729109481141, 7821.335186509211, 7869.724559640385, 7925.564093974886, 8005.319547838266, 6278.0, 6296.905546416899, 6329.7468101275435, 6333.746650133943, 6347.619142851444, 6705.932940670726, 6717.059611654275, 6722.226943901318, 6723.125993620798, 6774.4580433564215, 6390.297067322498, 6440.6135631862235, 6478.805635830932, 6598.60408375499, 6605.141331626858, 5221.6344855859725, 5553.500184983371, 6212.06818977157, 6270.059491076375, 6359.236891573041, 6250.218722659668, 6340.873182536416, 6343.302236754045, 6347.68261586928, 6350.936490635035, 5829.883402332014, 5863.912041319469, 5864.120381942572, 5867.559933005127, 5868.589198756046, 5948.821535353946, 6049.848753781191, 6052.727627256696, 6053.606515576474, 6054.9091763624465], "unit": "score", "name": "mootools.html", "value": 4053.229859269405}, {"lowerIsBetter": false, "replicates": [289.7030543692715, 298.7938322557435, 299.23396105968715, 306.8588449313314, 307.271765914782, 5259.263703081562, 5290.2593636890815, 5309.283246761691, 5426.8914621707545, 5458.6724796512235, 5156.871078223037, 5288.629795914278, 5297.576193904488, 5309.681419114856, 5323.840284791462, 3973.324534829086, 4159.355299928501, 4164.0, 4164.083901541663, 4172.123853990651, 4055.0, 4066.32905570582, 4168.353905144708, 4177.916441671165, 4182.874513764592, 4115.176964607075, 4136.0, 4136.31750761124, 4139.482564679415, 4143.482064741907, 3930.390789427643, 4018.8794336169963, 4026.617471340218, 4146.543880173179, 4147.854825081123, 3669.743117981716, 3674.2651469706166, 3678.6137455567314, 3679.0434487033294, 3681.576618688858, 5066.442691303953, 5113.795448182068, 5116.258142569307, 5129.512696293846, 5130.281760553526, 4695.272232803921, 4723.220668589679, 4757.595604373632, 4758.571728544413, 4763.190257656172, 5457.399686034572, 5566.721663916828, 5569.248151499536, 5573.442655734435, 5576.470235327637, 3935.8425662973445, 3967.1272320089533, 3976.840926362971, 3984.063745019918, 3992.740471869319, 5772.595918285721, 5853.5317174625925, 5854.677992710399, 5856.882862342729, 5861.325947516048, 4080.510338759368, 4095.6313931746286, 4099.590040995877, 4104.774237416911, 4106.630403263721, 3857.9421308680394, 3880.941785873214, 4159.043420013414, 4166.1251137261515, 4166.145940082337, 4620.306953956866, 4704.741239231875, 4714.4342678878065, 4725.692829966041, 4728.05438912219, 5584.0, 5590.468905453975, 5593.790452771133, 5594.300712410949, 5603.831885043455, 1450.4415799917108, 1461.101422625078, 1468.5153899213235, 1473.6684246044554, 1474.5281509916724, 996.7906739584769, 1002.1682003936716, 1005.0903931941605, 1006.3659894266711, 1020.1991436722137, 4877.804887804448, 4932.235503496964, 4933.901321973541, 4939.629527785431, 4943.184374578226, 5803.7388317524965, 5807.796727114531, 5813.157092221604, 5814.098814683731, 5818.738156782871, 4927.507249275044, 4930.802767889316, 4932.778024988884, 4934.802607895644, 4935.432425271139, 3044.8782048718244, 3091.397177550356, 3126.2965832687464, 3128.3899639570063, 3134.2634480896972, 5462.289902312674, 5463.890722185534, 5470.070088085035, 5473.28847249855, 5475.342958844964, 5936.1095835625, 5942.049272116441, 5951.434613711691, 5951.82144535656, 5951.880962380815, 5461.1808228766, 5465.289512363367, 5465.289512363367, 5469.671819690831, 5472.315960504937, 5623.915641265303, 5788.363280039108, 5794.768209271582, 5796.652200867961, 5799.710014499174, 5621.5221706155435, 5632.5493960482245, 5637.605367624391, 5641.266635337544, 5644.717764111861, 5454.318210223722, 5460.290162278879, 5465.808696695596, 5468.535174510212, 5470.152126420411, 4020.2160578688045, 4114.485689288839, 4115.506139263308, 4117.155983023413, 4121.711480196357, 5559.388467268678, 5679.858003549944, 5713.1715901193265, 5750.108733146369, 5796.188533605383, 5504.889902202013, 5634.971825140848, 5646.463585959327, 5650.576206784425, 5663.943360566342, 5621.718914054362, 5629.802956896489, 5633.915491267552, 5639.351474580476, 5645.830625081254, 5383.461653834585, 5514.283143191359, 5524.005678977823, 5528.502434780889, 5528.778848846001, 5660.150977353265, 5670.404607516151, 5674.659520428788, 5680.460356266148, 5680.886382272414, 5516.91724624139, 5522.370900584257, 5523.861903452445, 5528.253685752372, 5536.0865457200725], "unit": "score", "name": "prototype.html", "value": 4216.529415481649}, {"lowerIsBetter": false, "replicates": [681.1689738519005, 724.9669221359563, 772.5403384985933, 801.6873419366448, 814.6659869453525, 10802.297850639703, 12572.497100115996, 12701.428435720392, 12747.0, 12754.426050827724, 13150.0, 13221.0, 13238.33808309583, 13239.735205295889, 13269.668258293548, 797.4617133434951, 807.64059993303, 812.5246730662569, 812.5612169428531, 813.4590497319275, 637.3212528656989, 647.2200997797667, 779.9688012479494, 790.4506368074191, 808.7007807111377, 840.9747707568752, 844.1937949258444, 850.3962186847315, 851.059579165023, 851.29342645604, 648.4229036157823, 839.7648658375665, 839.937004724642, 840.6385254340631, 840.8024114333158, 487.91705410080374, 608.8873558391667, 614.7633161232912, 616.0851136062943, 616.9321374648785, 11387.715307117305, 11443.313401195872, 11473.541058357656, 11494.770104597861, 11496.367699776509, 10620.522076506575, 10716.571337146504, 10881.401522916236, 11149.058932581209, 11671.416429178593, 8787.692430764893, 8986.19124278818, 9057.0, 9290.814183716355, 9491.952540237324, 3156.068959656907, 3187.1834748973106, 3213.501907204387, 3250.463673493871, 3257.4136655402017, 40890.59109408897, 41120.79439602783, 41560.1687966242, 41675.37486937668, 41776.37335439971, 8494.320454363637, 8575.61409736551, 8599.05410404855, 8608.225259726654, 8723.694670686495, 15914.124723140338, 15985.60035999086, 15994.040357578582, 16003.59991000211, 16003.919980400024, 6215.409536094064, 6384.138141350951, 6417.0, 6439.774607888701, 6468.482521398277, 3356.8992930212135, 3512.7365447591533, 3629.2378600494194, 3637.5634923808784, 3657.8719744809337, 2536.112360673749, 2565.7177710451833, 2574.884130214145, 2575.163072001607, 2579.097315939444, 447.17942575373905, 453.79619883621734, 457.03793514651846, 465.0977104417419, 467.10549298094446, 432.56311125763204, 538.302897747418, 553.9806106786324, 563.456264704562, 581.1892410087904, 6890.173179218526, 6926.441470871317, 6972.2330543640155, 7125.0, 7252.3835473984245, 482.3343785575953, 520.7994921954999, 524.5462674786359, 551.4871169812033, 585.648610833505, 3129.5149251865996, 3366.61029041257, 3420.4356281213322, 3425.07522968802, 3494.1963348429495, 48611.27083093757, 48820.26769598459, 48838.0, 48909.266361004615, 48934.51065489371, 43912.560874391485, 44237.557624423345, 46960.7651961738, 48299.27551086737, 48667.75666121647, 39828.80513584597, 41055.1788964219, 41085.794571026956, 41130.588694112674, 41301.380479292835, 7037.683304251219, 7635.847283054419, 7645.847083058419, 7729.768106956801, 7812.960935195515, 29347.7065229345, 30024.549631755104, 30744.385112297183, 30751.077467676005, 31314.0, 37611.62388376081, 37884.0, 38198.618013819505, 38605.806970964964, 39055.2188956225, 9794.412335259907, 10085.445300508543, 10143.137833283958, 10189.796204076025, 10191.082802547806, 10747.462626868783, 10824.134069274596, 10842.674719758419, 10849.403282819521, 10880.455977201267, 9693.176080033276, 9957.452340121363, 10028.64899728506, 10147.0, 10165.18678505703, 9822.165115965223, 9843.852342215016, 9947.602095916081, 9965.900340996497, 10120.190384769348, 9807.215422766305, 9866.161376283097, 9926.602935882484, 10159.644412445528, 10174.287799853939, 7941.205879412244, 8269.83460330778, 8300.252977232078, 8532.786680333042, 8574.52840093776, 7955.761327160194, 7967.880481792894, 8033.477823941425, 8039.959800200962, 8235.83528329418], "unit": "score", "name": "yui.html", "value": 5560.149993303725}], "name": "dromaeo_css", "value": 6341.75742207608}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [110.0, 112.0, 107.0, 111.0, 111.0, 112.0, 101.0, 111.0, 111.0, 118.0], "unit": "score", "name": "ai-astar", "value": 110.4}, {"lowerIsBetter": true, "replicates": [156.0, 139.0, 160.0, 161.0, 136.0, 161.0, 158.0, 132.0, 166.0, 128.0], "unit": "score", "name": "audio-beat-detection", "value": 149.7}, {"lowerIsBetter": true, "replicates": [159.0, 160.0, 159.0, 158.0, 160.0, 160.0, 160.0, 161.0, 163.0, 162.0], "unit": "score", "name": "audio-dft", "value": 160.2}, {"lowerIsBetter": true, "replicates": [72.0, 72.0, 80.0, 101.0, 74.0, 73.0, 72.0, 102.0, 89.0, 73.0], "unit": "score", "name": "audio-fft", "value": 80.8}, {"lowerIsBetter": true, "replicates": [95.0, 95.0, 141.0, 94.0, 95.0, 94.0, 134.0, 95.0, 96.0, 128.0], "unit": "score", "name": "audio-oscillator", "value": 106.7}, {"lowerIsBetter": true, "replicates": [109.0, 109.0, 110.0, 109.0, 111.0, 110.0, 109.0, 109.0, 109.0, 110.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 109.5}, {"lowerIsBetter": true, "replicates": [148.0, 145.0, 146.0, 147.0, 146.0, 147.0, 147.0, 147.0, 146.0, 146.0], "unit": "score", "name": "imaging-darkroom", "value": 146.5}, {"lowerIsBetter": true, "replicates": [95.0, 95.0, 96.0, 96.0, 95.0, 96.0, 95.0, 95.0, 95.0, 95.0], "unit": "score", "name": "imaging-desaturate", "value": 95.3}, {"lowerIsBetter": true, "replicates": [70.0, 71.0, 71.0, 72.0, 71.0, 72.0, 71.0, 80.0, 77.0, 69.0], "unit": "score", "name": "json-parse-financial", "value": 72.4}, {"lowerIsBetter": true, "replicates": [67.0, 67.0, 67.0, 67.0, 67.0, 68.0, 68.0, 68.0, 68.0, 68.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 67.5}, {"lowerIsBetter": true, "replicates": [85.0, 86.0, 84.0, 85.0, 84.0, 94.0, 85.0, 86.0, 88.0, 86.0], "unit": "score", "name": "stanford-crypto-aes", "value": 86.3}, {"lowerIsBetter": true, "replicates": [126.0, 129.0, 117.0, 126.0, 116.0, 125.0, 122.0, 127.0, 126.0, 125.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 123.9}, {"lowerIsBetter": true, "replicates": [155.0, 138.0, 148.0, 147.0, 147.0, 137.0, 141.0, 139.0, 147.0, 153.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 145.2}, {"lowerIsBetter": true, "replicates": [70.0, 70.0, 71.0, 70.0, 69.0, 72.0, 69.0, 69.0, 72.0, 71.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 70.3}], "name": "kraken", "value": 1524.7}, {"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [165.6726308813784], "unit": "score", "name": "Richards", "value": 213.0828719999999}, {"lowerIsBetter": false, "replicates": [185.7700167193015], "unit": "score", "name": "DeltaBlue", "value": 355.9131939999999}, {"lowerIsBetter": false, "replicates": [282.2466836014677], "unit": "score", "name": "Encrypt", "value": 943.0792829999996}, {"lowerIsBetter": false, "replicates": [5128.205128205128], "unit": "score", "name": "Decrypt", "value": 51.90529499999997}, {"lowerIsBetter": false, "replicates": [2006.0120240480962], "unit": "score", "name": "RayTrace", "value": 368.8856253746253}, {"lowerIsBetter": false, "replicates": [799.3605115907275], "unit": "score", "name": "Earley", "value": 833.7452129999997}, {"lowerIsBetter": false, "replicates": [12144.578313253012], "unit": "score", "name": "Boyer", "value": 54.87740972222223}, {"lowerIsBetter": false, "replicates": [26657.894736842107], "unit": "score", "name": "RegExp", "value": 34.173178677196454}, {"lowerIsBetter": false, "replicates": [606.060606060606], "unit": "score", "name": "Splay", "value": 134.46015000000003}, {"lowerIsBetter": false, "replicates": [4840.579710144928], "unit": "score", "name": "NavierStokes", "value": 306.5748502994012}], "name": "v8_7", "value": 19781.464778726844}]} 03:41:55 INFO - RETURN: dromaeo_css: 6341.76 03:41:55 INFO - RETURN: kraken: 1524.70 03:41:55 INFO - RETURN: v8_7: 19781.46 03:41:55 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,132,35]]", "result": "19781.46"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,132,35]]", "result": "1524.70"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,132,35]]", "result": "6341.76"}}} 03:41:55 INFO - Return code: 0 03:41:55 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 03:41:55 ERROR - # TBPL SUCCESS # 03:41:55 INFO - Running post-action listener: _resource_record_post_action 03:41:55 INFO - Running post-run listener: _resource_record_post_run 03:41:56 INFO - Total resource usage - Wall time: 1234s; CPU: 13.0%; Read bytes: 0; Write bytes: 558284800; Read time: 0; Write time: 526964 03:41:56 INFO - install - Wall time: 16s; CPU: 14.0%; Read bytes: 0; Write bytes: 219697152; Read time: 0; Write time: 290088 03:41:57 INFO - run-tests - Wall time: 1219s; CPU: 13.0%; Read bytes: 0; Write bytes: 320004096; Read time: 0; Write time: 231600 03:41:57 INFO - Running post-run listener: _upload_blobber_files 03:41:57 INFO - Blob upload gear active. 03:41:57 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 03:41:57 INFO - Copying logs to upload dir... 03:41:57 INFO - mkdir: /builds/slave/test/build/upload/logs program finished with exit code 0 elapsedTime=1273.461763 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 13 secs) (at 2015-12-21 03:41:56.240263) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2015-12-21 03:41:56.243620) ========= 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=6b42339bb4b96cfc3b1ae7e5000001a3-1450696377.733355-1385016550 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False build_url:https://queue.taskcluster.net/v1/task/cbGO6asBRYiIn6eCmUh3iA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.010113 build_url: 'https://queue.taskcluster.net/v1/task/cbGO6asBRYiIn6eCmUh3iA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2' ========= master_lag: 0.04 ========= ========= Finished set props: build_url (results: 0, elapsed: 0 secs) (at 2015-12-21 03:41:56.295852) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-12-21 03:41:56.296239) ========= 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=6b42339bb4b96cfc3b1ae7e5000001a3-1450696377.733355-1385016550 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004455 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-12-21 03:41:56.347504) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-12-21 03:41:56.347850) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-12-21 03:41:56.348203) ========= ========= Total master_lag: 0.28 =========