builder: fx-team_ubuntu64_hw_test-dromaeojs slave: talos-linux64-ix-022 starttime: 1459521356.33 results: success (0) buildid: 20160401065453 builduid: 08930ce0a6b24aabbd26464e00b99ea3 revision: f82243c637f027297dfa2b79545aeeed34088d8d ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-04-01 07:35:56.333307) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-04-01 07:35:56.333694) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-04-01 07:35:56.334285) ========= 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=9c43b49b387003dc8f5b4e5c000001c4-1459521038.882658-1739113132 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test program finished with exit code 0 elapsedTime=0.006501 basedir: '/builds/slave/test' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-04-01 07:35:56.359518) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-01 07:35:56.359803) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-01 07:35:56.382174) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-01 07:35:56.382455) ========= 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=9c43b49b387003dc8f5b4e5c000001c4-1459521038.882658-1739113132 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004600 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-01 07:35:56.432075) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-04-01 07:35:56.432354) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-04-01 07:35:56.432673) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-01 07:35:56.432957) ========= 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=9c43b49b387003dc8f5b4e5c000001c4-1459521038.882658-1739113132 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-04-01 07:35:56-- 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% 97.7M=0s 2016-04-01 07:35:57 (97.7 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.639451 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-01 07:35:57.084204) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-01 07:35:57.084481) ========= 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=9c43b49b387003dc8f5b4e5c000001c4-1459521038.882658-1739113132 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.016205 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-01 07:35:57.135233) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 2 secs) (at 2016-04-01 07:35:57.135573) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev f82243c637f027297dfa2b79545aeeed34088d8d --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 f82243c637f027297dfa2b79545aeeed34088d8d --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=9c43b49b387003dc8f5b4e5c000001c4-1459521038.882658-1739113132 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-04-01 07:35:57,278 truncating revision to first 12 chars 2016-04-01 07:35:57,278 Setting DEBUG logging. 2016-04-01 07:35:57,278 attempt 1/10 2016-04-01 07:35:57,278 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/f82243c637f0?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-04-01 07:35:58,771 unpacking tar archive at: fx-team-f82243c637f0/testing/mozharness/ program finished with exit code 0 elapsedTime=2.587343 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 2 secs) (at 2016-04-01 07:35:59.736188) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-01 07:35:59.736588) ========= echo f82243c637f027297dfa2b79545aeeed34088d8d in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'f82243c637f027297dfa2b79545aeeed34088d8d'] 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=9c43b49b387003dc8f5b4e5c000001c4-1459521038.882658-1739113132 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False f82243c637f027297dfa2b79545aeeed34088d8d program finished with exit code 0 elapsedTime=0.004697 script_repo_revision: 'f82243c637f027297dfa2b79545aeeed34088d8d' ========= master_lag: 0.05 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-01 07:35:59.787142) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-01 07:35:59.787488) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-01 07:35:59.798333) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 22 secs) (at 2016-04-01 07:35:59.798665) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team-Non-PGO'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=9c43b49b387003dc8f5b4e5c000001c4-1459521038.882658-1739113132 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 07:36:00 INFO - MultiFileLogger online at 20160401 07:36:00 in /builds/slave/test 07:36:00 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO 07:36:00 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 07:36:00 INFO - {'append_to_log': False, 07:36:00 INFO - 'base_work_dir': '/builds/slave/test', 07:36:00 INFO - 'blob_upload_branch': 'Fx-Team-Non-PGO', 07:36:00 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 07:36:00 INFO - 'branch': 'Fx-Team-Non-PGO', 07:36:00 INFO - 'buildbot_json_path': 'buildprops.json', 07:36:00 INFO - 'config_files': ('talos/linux_config.py',), 07:36:00 INFO - 'default_actions': ('clobber', 07:36:00 INFO - 'read-buildbot-config', 07:36:00 INFO - 'download-and-extract', 07:36:00 INFO - 'populate-webroot', 07:36:00 INFO - 'create-virtualenv', 07:36:00 INFO - 'install', 07:36:00 INFO - 'run-tests'), 07:36:00 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 07:36:00 INFO - 'download_minidump_stackwalk': True, 07:36:00 INFO - 'download_symbols': 'ondemand', 07:36:00 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 07:36:00 INFO - 'tooltool.py': '/tools/tooltool.py', 07:36:00 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 07:36:00 INFO - '/tools/misc-python/virtualenv.py')}, 07:36:00 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 07:36:00 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 07:36:00 INFO - 'installer_path': 'installer.exe', 07:36:00 INFO - 'log_level': 'info', 07:36:00 INFO - 'log_name': 'talos', 07:36:00 INFO - 'log_to_console': True, 07:36:00 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 07:36:00 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 07:36:00 INFO - 'opt_config_files': (), 07:36:00 INFO - 'pip_index': False, 07:36:00 INFO - 'sps_profile': False, 07:36:00 INFO - 'sps_profile_interval': 0, 07:36:00 INFO - 'suite': 'dromaeojs', 07:36:00 INFO - 'system_bits': '32', 07:36:00 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 07:36:00 INFO - 'title': 'talos-linux64-ix-022', 07:36:00 INFO - 'tooltool_cache': '/builds/tooltool_cache', 07:36:00 INFO - 'use_talos_json': True, 07:36:00 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 07:36:00 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 07:36:00 INFO - 'work_dir': 'build'} 07:36:00 INFO - ##### 07:36:00 INFO - ##### Running clobber step. 07:36:00 INFO - ##### 07:36:00 INFO - Running pre-action listener: _resource_record_pre_action 07:36:00 INFO - Running main action method: clobber 07:36:00 INFO - rmtree: /builds/slave/test/build 07:36:00 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 07:36:01 INFO - Running post-action listener: _resource_record_post_action 07:36:01 INFO - ##### 07:36:01 INFO - ##### Running read-buildbot-config step. 07:36:01 INFO - ##### 07:36:01 INFO - Running pre-action listener: _resource_record_pre_action 07:36:01 INFO - Running main action method: read_buildbot_config 07:36:01 INFO - Using buildbot properties: 07:36:01 INFO - { 07:36:01 INFO - "project": "", 07:36:01 INFO - "product": "firefox", 07:36:01 INFO - "script_repo_revision": "production", 07:36:01 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs", 07:36:01 INFO - "repository": "", 07:36:01 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team talos dromaeojs", 07:36:01 INFO - "buildid": "20160401065453", 07:36:01 INFO - "pgo_build": "False", 07:36:01 INFO - "basedir": "/builds/slave/test", 07:36:01 INFO - "buildnumber": 1588, 07:36:01 INFO - "slavename": "talos-linux64-ix-022", 07:36:01 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 07:36:01 INFO - "platform": "ubuntu64_hw", 07:36:01 INFO - "scheduler": "tests-fx-team-linux64-talos", 07:36:01 INFO - "branch": "fx-team", 07:36:01 INFO - "repo_path": "integration/fx-team", 07:36:01 INFO - "revision": "f82243c637f027297dfa2b79545aeeed34088d8d", 07:36:01 INFO - "stage_platform": "linux64", 07:36:01 INFO - "builduid": "08930ce0a6b24aabbd26464e00b99ea3", 07:36:01 INFO - "slavebuilddir": "test" 07:36:01 INFO - } 07:36:01 INFO - Found installer url https://queue.taskcluster.net/v1/task/FDmwgmkSTwu_rQq4LRc-oA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2. 07:36:01 INFO - Running post-action listener: _resource_record_post_action 07:36:01 INFO - ##### 07:36:01 INFO - ##### Running download-and-extract step. 07:36:01 INFO - ##### 07:36:01 INFO - Running pre-action listener: _resource_record_pre_action 07:36:01 INFO - Running main action method: download_and_extract 07:36:01 INFO - mkdir: /builds/slave/test/build/tests 07:36: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')]} 07:36:01 INFO - https://queue.taskcluster.net/v1/task/FDmwgmkSTwu_rQq4LRc-oA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 07:36:01 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FDmwgmkSTwu_rQq4LRc-oA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 07:36:01 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FDmwgmkSTwu_rQq4LRc-oA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 07:36:01 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FDmwgmkSTwu_rQq4LRc-oA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 07:36:01 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FDmwgmkSTwu_rQq4LRc-oA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 07:36:09 INFO - Downloaded 1361 bytes. 07:36:09 INFO - Reading from file /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 07:36:09 INFO - Using the following test package requirements: 07:36:09 INFO - {u'common': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'], 07:36:09 INFO - u'cppunittest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 07:36:09 INFO - u'firefox-48.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 07:36:09 INFO - u'gtest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 07:36:09 INFO - u'firefox-48.0a1.en-US.linux-x86_64.gtest.tests.zip'], 07:36:09 INFO - u'jittest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 07:36:09 INFO - u'jsshell-linux-x86_64.zip'], 07:36:09 INFO - u'mochitest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 07:36:09 INFO - u'firefox-48.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 07:36:09 INFO - u'mozbase': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'], 07:36:09 INFO - u'reftest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 07:36:09 INFO - u'firefox-48.0a1.en-US.linux-x86_64.reftest.tests.zip'], 07:36:09 INFO - u'talos': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 07:36:09 INFO - u'firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'], 07:36:09 INFO - u'web-platform': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 07:36:09 INFO - u'firefox-48.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 07:36:09 INFO - u'xpcshell': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 07:36:09 INFO - u'firefox-48.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 07:36:09 INFO - Downloading packages: [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 07:36: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')]} 07:36:09 INFO - https://queue.taskcluster.net/v1/task/FDmwgmkSTwu_rQq4LRc-oA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 07:36:09 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FDmwgmkSTwu_rQq4LRc-oA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 07:36:09 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FDmwgmkSTwu_rQq4LRc-oA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 07:36:09 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FDmwgmkSTwu_rQq4LRc-oA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 07:36:09 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FDmwgmkSTwu_rQq4LRc-oA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 07:36:12 INFO - Downloaded 22112056 bytes. 07:36:12 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 07:36:12 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 07:36:13 INFO - Return code: 0 07:36:13 INFO - Downloading packages: [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 07:36:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:36:13 INFO - https://queue.taskcluster.net/v1/task/FDmwgmkSTwu_rQq4LRc-oA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 07:36:13 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FDmwgmkSTwu_rQq4LRc-oA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 07:36:13 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FDmwgmkSTwu_rQq4LRc-oA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 07:36:13 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FDmwgmkSTwu_rQq4LRc-oA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 07:36:13 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FDmwgmkSTwu_rQq4LRc-oA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 07:36:24 INFO - Downloaded 22112056 bytes. 07:36:24 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 07:36:24 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 07:36:25 INFO - Return code: 0 07:36:25 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')]} 07:36:25 INFO - https://queue.taskcluster.net/v1/task/FDmwgmkSTwu_rQq4LRc-oA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 07:36:25 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FDmwgmkSTwu_rQq4LRc-oA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 07:36:25 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FDmwgmkSTwu_rQq4LRc-oA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 07:36:25 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FDmwgmkSTwu_rQq4LRc-oA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 07:36:25 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FDmwgmkSTwu_rQq4LRc-oA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 07:36:33 INFO - Downloaded 10847534 bytes. 07:36:33 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 07:36:33 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 07:36:33 INFO - Return code: 0 07:36:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:36:33 INFO - https://queue.taskcluster.net/v1/task/FDmwgmkSTwu_rQq4LRc-oA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 07:36:33 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FDmwgmkSTwu_rQq4LRc-oA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 07:36:33 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FDmwgmkSTwu_rQq4LRc-oA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 07:36:33 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FDmwgmkSTwu_rQq4LRc-oA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 07:36:33 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FDmwgmkSTwu_rQq4LRc-oA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 07:36:37 INFO - Downloaded 54224432 bytes. 07:36:37 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/FDmwgmkSTwu_rQq4LRc-oA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 07:36:37 INFO - mkdir: /builds/slave/test/properties 07:36:37 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 07:36:37 INFO - Writing to file /builds/slave/test/properties/build_url 07:36:37 INFO - Contents: 07:36:37 INFO - build_url:https://queue.taskcluster.net/v1/task/FDmwgmkSTwu_rQq4LRc-oA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 07:36:39 INFO - Running post-action listener: _resource_record_post_action 07:36:39 INFO - Running post-action listener: set_extra_try_arguments 07:36:39 INFO - ##### 07:36:39 INFO - ##### Running populate-webroot step. 07:36:39 INFO - ##### 07:36:39 INFO - Running pre-action listener: _resource_record_pre_action 07:36:39 INFO - Running main action method: populate_webroot 07:36:39 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 07:36:39 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 07:36:39 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 07:36:39 INFO - '--tppagecycles', 07:36:39 INFO - '7'], 07:36:39 INFO - 'tests': ['tsvgm']}}, 07:36:39 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 07:36:39 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 07:36:39 INFO - 'tests': ['tresize', 'tcanvasmark']}, 07:36:39 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 07:36:39 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 07:36:39 INFO - 'tests': ['dromaeo_css', 'kraken']}, 07:36:39 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:36:39 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 07:36:39 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:36:39 INFO - 'talos_options': ['--e10s'], 07:36:39 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 07:36:39 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:36:39 INFO - 'tests': ['damp', 'tps']}, 07:36:39 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:36:39 INFO - 'talos_options': ['--e10s'], 07:36:39 INFO - 'tests': ['damp', 'tps']}, 07:36:39 INFO - 'g3': {'tests': ['dromaeo_dom']}, 07:36:39 INFO - 'g3-e10s': {'talos_options': ['--e10s'], 07:36:39 INFO - 'tests': ['dromaeo_dom']}, 07:36:39 INFO - 'other': {'tests': ['a11yr', 07:36:39 INFO - 'ts_paint', 07:36:39 INFO - 'tpaint', 07:36:39 INFO - 'sessionrestore', 07:36:39 INFO - 'sessionrestore_no_auto_restore', 07:36:39 INFO - 'tabpaint']}, 07:36:39 INFO - 'other-e10s': {'talos_options': ['--e10s'], 07:36:39 INFO - 'tests': ['a11yr', 07:36:39 INFO - 'ts_paint', 07:36:39 INFO - 'tpaint', 07:36:39 INFO - 'sessionrestore', 07:36:39 INFO - 'sessionrestore_no_auto_restore', 07:36:39 INFO - 'tabpaint']}, 07:36:39 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 07:36:39 INFO - 'tests': ['a11yr', 07:36:39 INFO - 'ts_paint', 07:36:39 INFO - 'tpaint', 07:36:39 INFO - 'sessionrestore', 07:36:39 INFO - 'sessionrestore_no_auto_restore', 07:36:39 INFO - 'tabpaint']}, 07:36:39 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 07:36:39 INFO - 'tests': ['a11yr', 07:36:39 INFO - 'ts_paint', 07:36:39 INFO - 'tpaint', 07:36:39 INFO - 'sessionrestore', 07:36:39 INFO - 'sessionrestore_no_auto_restore', 07:36:39 INFO - 'tabpaint']}, 07:36:39 INFO - 'other_l64': {'tests': ['a11yr', 07:36:39 INFO - 'ts_paint', 07:36:39 INFO - 'tpaint', 07:36:39 INFO - 'sessionrestore', 07:36:39 INFO - 'sessionrestore_no_auto_restore', 07:36:39 INFO - 'tabpaint']}, 07:36:39 INFO - 'other_nol64': {'tests': ['a11yr', 07:36:39 INFO - 'ts_paint', 07:36:39 INFO - 'tpaint', 07:36:39 INFO - 'sessionrestore', 07:36:39 INFO - 'sessionrestore_no_auto_restore', 07:36:39 INFO - 'tabpaint']}, 07:36:39 INFO - 'svgr': {'tests': ['tsvgx', 07:36:39 INFO - 'tsvgr_opacity', 07:36:39 INFO - 'tart', 07:36:39 INFO - 'tscrollx', 07:36:39 INFO - 'cart']}, 07:36:39 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 07:36:39 INFO - 'tests': ['tsvgx', 07:36:39 INFO - 'tsvgr_opacity', 07:36:39 INFO - 'tart', 07:36:39 INFO - 'tscrollx', 07:36:39 INFO - 'cart']}, 07:36:39 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:36:39 INFO - 'tests': ['tp5o']}, 07:36:39 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:36:39 INFO - 'talos_options': ['--e10s'], 07:36:39 INFO - 'tests': ['tp5o']}, 07:36:39 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:36:39 INFO - 'talos_options': ['--xperf_path', 07:36:39 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 07:36:39 INFO - 'tests': ['tp5n']}, 07:36:39 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:36:39 INFO - 'talos_options': ['--e10s', 07:36:39 INFO - '--xperf_path', 07:36:39 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 07:36:39 INFO - 'tests': ['tp5n']}}, 07:36:39 INFO - 'talos.zip': {'path': '', 07:36:39 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 07:36:39 INFO - Running post-action listener: _resource_record_post_action 07:36:39 INFO - ##### 07:36:39 INFO - ##### Running create-virtualenv step. 07:36:39 INFO - ##### 07:36:39 INFO - Running pre-action listener: _resource_record_pre_action 07:36:39 INFO - Running main action method: create_virtualenv 07:36:39 INFO - Creating virtualenv /builds/slave/test/build/venv 07:36:39 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 07:36:39 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 07:36:39 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 07:36:39 INFO - Using real prefix '/usr' 07:36:39 INFO - New python executable in /builds/slave/test/build/venv/bin/python 07:36:40 INFO - Installing distribute.............................................................................................................................................................................................done. 07:36:41 INFO - Installing pip.................done. 07:36:41 INFO - Return code: 0 07:36:41 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 07:36:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:36:41 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:36:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:36:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:36:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:36:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:36:42 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f82c05e5f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28848a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x294f5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29de410>, '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 0x29df310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29df7a0>, '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': '9c43b49b387003dc8f5b4e5c000001c4-1459521038.882658-1739113132', '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 07:36:42 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 07:36:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 07:36:42 INFO - Using env: {'DISPLAY': ':0', 07:36:42 INFO - 'HOME': '/home/cltbld', 07:36:42 INFO - 'LANG': 'en_US.UTF-8', 07:36:42 INFO - 'LANGUAGE': 'en_US:en', 07:36:42 INFO - 'LOGNAME': 'cltbld', 07:36:42 INFO - 'MAIL': '/var/mail/cltbld', 07:36:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:36:42 INFO - 'MOZ_NO_REMOTE': '1', 07:36:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:36:42 INFO - 'NO_EM_RESTART': '1', 07:36:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:36:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:36:42 INFO - 'PWD': '/builds/slave/test', 07:36:42 INFO - 'SHELL': '/bin/bash', 07:36:42 INFO - 'SHLVL': '1', 07:36:42 INFO - 'TERM': 'linux', 07:36:42 INFO - 'TMOUT': '86400', 07:36:42 INFO - 'USER': 'cltbld', 07:36:42 INFO - 'XDG_SESSION_COOKIE': '9c43b49b387003dc8f5b4e5c000001c4-1459521038.882658-1739113132', 07:36:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:36:42 INFO - '_': '/tools/buildbot/bin/python'} 07:36:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:36:42 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 07:36:42 INFO - Cleaning up... 07:36:42 INFO - Return code: 0 07:36:42 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 07:36:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:36:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:36:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:36:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:36:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:36:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:36:42 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7f82c05e5f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28848a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x294f5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29de410>, '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 0x29df310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29df7a0>, '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': '9c43b49b387003dc8f5b4e5c000001c4-1459521038.882658-1739113132', '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 07:36:42 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test/build 07:36:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 07:36:42 INFO - Using env: {'DISPLAY': ':0', 07:36:42 INFO - 'HOME': '/home/cltbld', 07:36:42 INFO - 'LANG': 'en_US.UTF-8', 07:36:42 INFO - 'LANGUAGE': 'en_US:en', 07:36:42 INFO - 'LOGNAME': 'cltbld', 07:36:42 INFO - 'MAIL': '/var/mail/cltbld', 07:36:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:36:42 INFO - 'MOZ_NO_REMOTE': '1', 07:36:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:36:42 INFO - 'NO_EM_RESTART': '1', 07:36:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:36:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:36:42 INFO - 'PWD': '/builds/slave/test', 07:36:42 INFO - 'SHELL': '/bin/bash', 07:36:42 INFO - 'SHLVL': '1', 07:36:42 INFO - 'TERM': 'linux', 07:36:42 INFO - 'TMOUT': '86400', 07:36:42 INFO - 'USER': 'cltbld', 07:36:42 INFO - 'XDG_SESSION_COOKIE': '9c43b49b387003dc8f5b4e5c000001c4-1459521038.882658-1739113132', 07:36:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:36:42 INFO - '_': '/tools/buildbot/bin/python'} 07:36:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:36:42 INFO - Downloading/unpacking psutil>=0.7.1 07:36:42 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:36:42 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:36:42 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:36:42 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:36:42 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:36:42 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:36:47 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 07:36:47 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 07:36:47 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 07:36:47 INFO - Installing collected packages: psutil 07:36:47 INFO - Running setup.py install for psutil 07:36:47 INFO - building 'psutil._psutil_linux' extension 07:36:47 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 07:36:47 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 07:36:47 INFO - building 'psutil._psutil_posix' extension 07:36:47 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 07:36:47 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 07:36:47 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 07:36:47 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 07:36:47 INFO - Successfully installed psutil 07:36:47 INFO - Cleaning up... 07:36:47 INFO - Return code: 0 07:36:47 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 07:36:47 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')]} 07:36:47 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:36:47 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:36:47 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')]} 07:36:47 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:36:47 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:36:47 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f82c05e5f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28848a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x294f5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29de410>, '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 0x29df310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29df7a0>, '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': '9c43b49b387003dc8f5b4e5c000001c4-1459521038.882658-1739113132', '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 07:36:47 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test/build 07:36:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 07:36:47 INFO - Using env: {'DISPLAY': ':0', 07:36:47 INFO - 'HOME': '/home/cltbld', 07:36:47 INFO - 'LANG': 'en_US.UTF-8', 07:36:47 INFO - 'LANGUAGE': 'en_US:en', 07:36:47 INFO - 'LOGNAME': 'cltbld', 07:36:47 INFO - 'MAIL': '/var/mail/cltbld', 07:36:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:36:47 INFO - 'MOZ_NO_REMOTE': '1', 07:36:47 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:36:47 INFO - 'NO_EM_RESTART': '1', 07:36:47 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:36:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:36:47 INFO - 'PWD': '/builds/slave/test', 07:36:47 INFO - 'SHELL': '/bin/bash', 07:36:47 INFO - 'SHLVL': '1', 07:36:47 INFO - 'TERM': 'linux', 07:36:47 INFO - 'TMOUT': '86400', 07:36:47 INFO - 'USER': 'cltbld', 07:36:47 INFO - 'XDG_SESSION_COOKIE': '9c43b49b387003dc8f5b4e5c000001c4-1459521038.882658-1739113132', 07:36:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:36:47 INFO - '_': '/tools/buildbot/bin/python'} 07:36:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:36:48 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 07:36:48 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 07:36:48 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 07:36:48 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 07:36:48 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 07:36:48 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 07:36:48 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 07:36:53 INFO - Downloading mozsystemmonitor-0.0.tar.gz 07:36:53 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 07:36:53 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 07:36:53 INFO - Installing collected packages: mozsystemmonitor 07:36:53 INFO - Running setup.py install for mozsystemmonitor 07:36:53 INFO - Successfully installed mozsystemmonitor 07:36:53 INFO - Cleaning up... 07:36:53 INFO - Return code: 0 07:36:53 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 07:36: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')]} 07:36:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:36:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:36: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')]} 07:36:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:36:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:36:53 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f82c05e5f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28848a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x294f5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29de410>, '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 0x29df310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29df7a0>, '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': '9c43b49b387003dc8f5b4e5c000001c4-1459521038.882658-1739113132', '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 07:36:53 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 07:36:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 07:36:53 INFO - Using env: {'DISPLAY': ':0', 07:36:53 INFO - 'HOME': '/home/cltbld', 07:36:53 INFO - 'LANG': 'en_US.UTF-8', 07:36:53 INFO - 'LANGUAGE': 'en_US:en', 07:36:53 INFO - 'LOGNAME': 'cltbld', 07:36:53 INFO - 'MAIL': '/var/mail/cltbld', 07:36:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:36:53 INFO - 'MOZ_NO_REMOTE': '1', 07:36:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:36:53 INFO - 'NO_EM_RESTART': '1', 07:36:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:36:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:36:53 INFO - 'PWD': '/builds/slave/test', 07:36:53 INFO - 'SHELL': '/bin/bash', 07:36:53 INFO - 'SHLVL': '1', 07:36:53 INFO - 'TERM': 'linux', 07:36:53 INFO - 'TMOUT': '86400', 07:36:53 INFO - 'USER': 'cltbld', 07:36:53 INFO - 'XDG_SESSION_COOKIE': '9c43b49b387003dc8f5b4e5c000001c4-1459521038.882658-1739113132', 07:36:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:36:53 INFO - '_': '/tools/buildbot/bin/python'} 07:36:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:36:54 INFO - Downloading/unpacking blobuploader==1.2.4 07:36:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:36:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:36:54 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:36:54 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:36:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:36:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:36:56 INFO - Downloading blobuploader-1.2.4.tar.gz 07:36:56 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 07:36:57 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 07:36:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:36:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:36:57 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:36:57 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:36:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:36:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:36:57 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 07:36:57 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 07:36:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:36:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:36:57 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:36:57 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:36:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:36:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:36:57 INFO - Downloading docopt-0.6.1.tar.gz 07:36:57 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 07:36:57 INFO - Installing collected packages: blobuploader, requests, docopt 07:36:57 INFO - Running setup.py install for blobuploader 07:36:57 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 07:36:57 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 07:36:57 INFO - Running setup.py install for requests 07:36:58 INFO - Running setup.py install for docopt 07:36:58 INFO - Successfully installed blobuploader requests docopt 07:36:58 INFO - Cleaning up... 07:36:58 INFO - Return code: 0 07:36:58 INFO - Installing None into virtualenv /builds/slave/test/build/venv 07:36:58 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')]} 07:36:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:36:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:36:58 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')]} 07:36:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:36:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:36:58 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f82c05e5f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28848a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x294f5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29de410>, '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 0x29df310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29df7a0>, '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': '9c43b49b387003dc8f5b4e5c000001c4-1459521038.882658-1739113132', '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 07:36:58 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 07:36:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 07:36:58 INFO - Using env: {'DISPLAY': ':0', 07:36:58 INFO - 'HOME': '/home/cltbld', 07:36:58 INFO - 'LANG': 'en_US.UTF-8', 07:36:58 INFO - 'LANGUAGE': 'en_US:en', 07:36:58 INFO - 'LOGNAME': 'cltbld', 07:36:58 INFO - 'MAIL': '/var/mail/cltbld', 07:36:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:36:58 INFO - 'MOZ_NO_REMOTE': '1', 07:36:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:36:58 INFO - 'NO_EM_RESTART': '1', 07:36:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:36:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:36:58 INFO - 'PWD': '/builds/slave/test', 07:36:58 INFO - 'SHELL': '/bin/bash', 07:36:58 INFO - 'SHLVL': '1', 07:36:58 INFO - 'TERM': 'linux', 07:36:58 INFO - 'TMOUT': '86400', 07:36:58 INFO - 'USER': 'cltbld', 07:36:58 INFO - 'XDG_SESSION_COOKIE': '9c43b49b387003dc8f5b4e5c000001c4-1459521038.882658-1739113132', 07:36:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:36:58 INFO - '_': '/tools/buildbot/bin/python'} 07:36:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:36:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 07:36:58 INFO - Running setup.py (path:/tmp/pip-WXICYp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 07:36:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 07:36:58 INFO - Running setup.py (path:/tmp/pip-oyj5NA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 07:36:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 07:36:58 INFO - Running setup.py (path:/tmp/pip-gocHqU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 07:36:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 07:36:58 INFO - Running setup.py (path:/tmp/pip-riQveJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 07:36:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 07:36:58 INFO - Running setup.py (path:/tmp/pip-YLtNXv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 07:36:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 07:36:58 INFO - Running setup.py (path:/tmp/pip-R4Z3ZU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 07:36:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 07:36:59 INFO - Running setup.py (path:/tmp/pip-4sTxiX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 07:36:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 07:36:59 INFO - Running setup.py (path:/tmp/pip-UO0ORF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 07:36:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 07:36:59 INFO - Running setup.py (path:/tmp/pip-KU0pUm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 07:36:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 07:36:59 INFO - Running setup.py (path:/tmp/pip-mp8hcm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 07:36:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 07:36:59 INFO - Running setup.py (path:/tmp/pip-KLd4ou-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 07:36:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 07:36:59 INFO - Running setup.py (path:/tmp/pip-EdBqGq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 07:36:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 07:36:59 INFO - Running setup.py (path:/tmp/pip-tb2XAA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 07:36:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 07:36:59 INFO - Running setup.py (path:/tmp/pip-jOvx7V-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 07:36:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 07:36:59 INFO - Running setup.py (path:/tmp/pip-lNIC0i-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 07:36:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 07:36:59 INFO - Running setup.py (path:/tmp/pip-yQv6WT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 07:36:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 07:36:59 INFO - Running setup.py (path:/tmp/pip-zR77NH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 07:36:59 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 07:36:59 INFO - Running setup.py install for manifestparser 07:36:59 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 07:36:59 INFO - Running setup.py install for mozcrash 07:37:00 INFO - Running setup.py install for mozdebug 07:37:00 INFO - Running setup.py install for mozdevice 07:37:00 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 07:37:00 INFO - Installing dm script to /builds/slave/test/build/venv/bin 07:37:00 INFO - Running setup.py install for mozfile 07:37:00 INFO - Running setup.py install for mozhttpd 07:37:00 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 07:37:00 INFO - Running setup.py install for mozinfo 07:37:00 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 07:37:00 INFO - Running setup.py install for mozInstall 07:37:00 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 07:37:00 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 07:37:00 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 07:37:00 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 07:37:00 INFO - Running setup.py install for mozleak 07:37:00 INFO - Running setup.py install for mozlog 07:37:00 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 07:37:00 INFO - Running setup.py install for moznetwork 07:37:00 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 07:37:00 INFO - Running setup.py install for mozprocess 07:37:01 INFO - Running setup.py install for mozprofile 07:37:01 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 07:37:01 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 07:37:01 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 07:37:01 INFO - Running setup.py install for mozrunner 07:37:01 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 07:37:01 INFO - Running setup.py install for mozscreenshot 07:37:01 INFO - Running setup.py install for moztest 07:37:01 INFO - Running setup.py install for mozversion 07:37:01 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 07:37:01 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 07:37:01 INFO - Cleaning up... 07:37:01 INFO - Return code: 0 07:37:01 INFO - Installing None into virtualenv /builds/slave/test/build/venv 07:37: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')]} 07:37:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:37:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:37: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')]} 07:37:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:37:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:37:01 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f82c05e5f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28848a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x294f5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29de410>, '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 0x29df310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29df7a0>, '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': '9c43b49b387003dc8f5b4e5c000001c4-1459521038.882658-1739113132', '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 07:37:01 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 07:37:01 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 07:37:01 INFO - Using env: {'DISPLAY': ':0', 07:37:01 INFO - 'HOME': '/home/cltbld', 07:37:01 INFO - 'LANG': 'en_US.UTF-8', 07:37:01 INFO - 'LANGUAGE': 'en_US:en', 07:37:01 INFO - 'LOGNAME': 'cltbld', 07:37:01 INFO - 'MAIL': '/var/mail/cltbld', 07:37:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:37:01 INFO - 'MOZ_NO_REMOTE': '1', 07:37:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:37:01 INFO - 'NO_EM_RESTART': '1', 07:37:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:37:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:37:01 INFO - 'PWD': '/builds/slave/test', 07:37:01 INFO - 'SHELL': '/bin/bash', 07:37:01 INFO - 'SHLVL': '1', 07:37:01 INFO - 'TERM': 'linux', 07:37:01 INFO - 'TMOUT': '86400', 07:37:01 INFO - 'USER': 'cltbld', 07:37:01 INFO - 'XDG_SESSION_COOKIE': '9c43b49b387003dc8f5b4e5c000001c4-1459521038.882658-1739113132', 07:37:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:37:01 INFO - '_': '/tools/buildbot/bin/python'} 07:37:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:37:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 07:37:01 INFO - Running setup.py (path:/tmp/pip-h8wV2m-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 07:37:01 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)) 07:37:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 07:37:01 INFO - Running setup.py (path:/tmp/pip-aIb8Yf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 07:37:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 07:37:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 07:37:01 INFO - Running setup.py (path:/tmp/pip-F38MCj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 07:37:02 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)) 07:37:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 07:37:02 INFO - Running setup.py (path:/tmp/pip-xE1Nk2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 07:37:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 07:37:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 07:37:02 INFO - Running setup.py (path:/tmp/pip-0Ex34z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 07:37:02 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)) 07:37:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 07:37:02 INFO - Running setup.py (path:/tmp/pip-EvM4YY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 07:37:02 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)) 07:37:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 07:37:02 INFO - Running setup.py (path:/tmp/pip-rvwAIq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 07:37:02 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)) 07:37:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 07:37:02 INFO - Running setup.py (path:/tmp/pip-IqT6ip-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 07:37:02 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)) 07:37:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 07:37:02 INFO - Running setup.py (path:/tmp/pip-0ATBUt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 07:37:02 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)) 07:37:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 07:37:02 INFO - Running setup.py (path:/tmp/pip-w671Ud-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 07:37:02 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)) 07:37:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 07:37:02 INFO - Running setup.py (path:/tmp/pip-XAny8b-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 07:37:02 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)) 07:37:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 07:37:02 INFO - Running setup.py (path:/tmp/pip-SXPwBg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 07:37:02 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)) 07:37:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 07:37:02 INFO - Running setup.py (path:/tmp/pip-WCrY1r-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 07:37:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 07:37:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 07:37:02 INFO - Running setup.py (path:/tmp/pip-yrwG79-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 07:37:02 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)) 07:37:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 07:37:02 INFO - Running setup.py (path:/tmp/pip-z_UMVu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 07:37:02 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)) 07:37:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 07:37:02 INFO - Running setup.py (path:/tmp/pip-LRx2mG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 07:37:03 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)) 07:37:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 07:37:03 INFO - Running setup.py (path:/tmp/pip-8ZpBbq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 07:37:03 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)) 07:37:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 07:37:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 07:37:03 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)) 07:37:03 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 07:37:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 07:37:03 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 07:37:03 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 07:37:03 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 07:37:03 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 07:37:03 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 07:37:03 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 07:37:03 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 07:37:06 INFO - Downloading blessings-1.6.tar.gz 07:37:06 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 07:37:06 INFO - Installing collected packages: blessings 07:37:06 INFO - Running setup.py install for blessings 07:37:07 INFO - Successfully installed blessings 07:37:07 INFO - Cleaning up... 07:37:07 INFO - Return code: 0 07:37:07 INFO - Done creating virtualenv /builds/slave/test/build/venv. 07:37:07 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 07:37:07 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 07:37:07 INFO - Reading from file tmpfile_stdout 07:37:07 INFO - Current package versions: 07:37:07 INFO - argparse == 1.2.1 07:37:07 INFO - blessings == 1.6 07:37:07 INFO - blobuploader == 1.2.4 07:37:07 INFO - docopt == 0.6.1 07:37:07 INFO - manifestparser == 1.1 07:37:07 INFO - mozInstall == 1.12 07:37:07 INFO - mozcrash == 0.17 07:37:07 INFO - mozdebug == 0.1 07:37:07 INFO - mozdevice == 0.48 07:37:07 INFO - mozfile == 1.2 07:37:07 INFO - mozhttpd == 0.7 07:37:07 INFO - mozinfo == 0.9 07:37:07 INFO - mozleak == 0.1 07:37:07 INFO - mozlog == 3.1 07:37:07 INFO - moznetwork == 0.27 07:37:07 INFO - mozprocess == 0.22 07:37:07 INFO - mozprofile == 0.28 07:37:07 INFO - mozrunner == 6.11 07:37:07 INFO - mozscreenshot == 0.1 07:37:07 INFO - mozsystemmonitor == 0.0 07:37:07 INFO - moztest == 0.7 07:37:07 INFO - mozversion == 1.4 07:37:07 INFO - psutil == 3.1.1 07:37:07 INFO - requests == 1.2.3 07:37:07 INFO - wsgiref == 0.1.2 07:37:07 INFO - Installing None into virtualenv /builds/slave/test/build/venv 07:37:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:37:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:37:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:37:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:37:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:37:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:37:07 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f82c05e5f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28848a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x294f5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29de410>, '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 0x29df310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29df7a0>, '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': '9c43b49b387003dc8f5b4e5c000001c4-1459521038.882658-1739113132', '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 07:37:07 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 07:37:07 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 07:37:07 INFO - Using env: {'DISPLAY': ':0', 07:37:07 INFO - 'HOME': '/home/cltbld', 07:37:07 INFO - 'LANG': 'en_US.UTF-8', 07:37:07 INFO - 'LANGUAGE': 'en_US:en', 07:37:07 INFO - 'LOGNAME': 'cltbld', 07:37:07 INFO - 'MAIL': '/var/mail/cltbld', 07:37:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:37:07 INFO - 'MOZ_NO_REMOTE': '1', 07:37:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:37:07 INFO - 'NO_EM_RESTART': '1', 07:37:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:37:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:37:07 INFO - 'PWD': '/builds/slave/test', 07:37:07 INFO - 'SHELL': '/bin/bash', 07:37:07 INFO - 'SHLVL': '1', 07:37:07 INFO - 'TERM': 'linux', 07:37:07 INFO - 'TMOUT': '86400', 07:37:07 INFO - 'USER': 'cltbld', 07:37:07 INFO - 'XDG_SESSION_COOKIE': '9c43b49b387003dc8f5b4e5c000001c4-1459521038.882658-1739113132', 07:37:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:37:07 INFO - '_': '/tools/buildbot/bin/python'} 07:37:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:37:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 07:37:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 07:37:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 07:37:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 07:37:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 07:37:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 07:37:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 07:37:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 07:37:08 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 07:37:08 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 07:37:08 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 07:37:08 INFO - Cleaning up... 07:37:08 INFO - Return code: 0 07:37:08 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 07:37:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:37:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:37:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:37:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:37:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:37:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:37:08 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f82c05e5f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28848a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x294f5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29de410>, '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 0x29df310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29df7a0>, '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': '9c43b49b387003dc8f5b4e5c000001c4-1459521038.882658-1739113132', '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 07:37:08 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 07:37:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 07:37:08 INFO - Using env: {'DISPLAY': ':0', 07:37:08 INFO - 'HOME': '/home/cltbld', 07:37:08 INFO - 'LANG': 'en_US.UTF-8', 07:37:08 INFO - 'LANGUAGE': 'en_US:en', 07:37:08 INFO - 'LOGNAME': 'cltbld', 07:37:08 INFO - 'MAIL': '/var/mail/cltbld', 07:37:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:37:08 INFO - 'MOZ_NO_REMOTE': '1', 07:37:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:37:08 INFO - 'NO_EM_RESTART': '1', 07:37:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:37:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:37:08 INFO - 'PWD': '/builds/slave/test', 07:37:08 INFO - 'SHELL': '/bin/bash', 07:37:08 INFO - 'SHLVL': '1', 07:37:08 INFO - 'TERM': 'linux', 07:37:08 INFO - 'TMOUT': '86400', 07:37:08 INFO - 'USER': 'cltbld', 07:37:08 INFO - 'XDG_SESSION_COOKIE': '9c43b49b387003dc8f5b4e5c000001c4-1459521038.882658-1739113132', 07:37:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:37:08 INFO - '_': '/tools/buildbot/bin/python'} 07:37:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:37:08 INFO - Downloading/unpacking jsonschema 07:37: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 07:37: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 07:37: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 07:37: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 07:37: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 07:37: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 07:37:12 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 07:37:12 INFO - Downloading/unpacking functools32 (from jsonschema) 07:37:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:37:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:37:12 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:37:12 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:37:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:37:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:37:13 INFO - Downloading functools32-3.2.3-2.tar.gz 07:37:13 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 07:37:13 INFO - warning: no files found matching '*.txt' 07:37:13 INFO - no previously-included directories found matching 'build' 07:37:13 INFO - no previously-included directories found matching 'dist' 07:37:13 INFO - no previously-included directories found matching '.git*' 07:37:13 INFO - Installing collected packages: jsonschema, functools32 07:37:13 INFO - Running setup.py install for functools32 07:37:13 INFO - warning: no files found matching '*.txt' 07:37:13 INFO - no previously-included directories found matching 'build' 07:37:13 INFO - no previously-included directories found matching 'dist' 07:37:13 INFO - no previously-included directories found matching '.git*' 07:37:13 INFO - Successfully installed jsonschema functools32 07:37:13 INFO - Cleaning up... 07:37:13 INFO - Return code: 0 07:37:13 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 07:37:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:37:13 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:37:13 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:37:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:37:13 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:37:13 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:37:13 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f82c05e5f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28848a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x294f5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29de410>, '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 0x29df310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29df7a0>, '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': '9c43b49b387003dc8f5b4e5c000001c4-1459521038.882658-1739113132', '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 07:37:13 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8'] in /builds/slave/test/build 07:37:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub flake8 07:37:13 INFO - Using env: {'DISPLAY': ':0', 07:37:13 INFO - 'HOME': '/home/cltbld', 07:37:13 INFO - 'LANG': 'en_US.UTF-8', 07:37:13 INFO - 'LANGUAGE': 'en_US:en', 07:37:13 INFO - 'LOGNAME': 'cltbld', 07:37:13 INFO - 'MAIL': '/var/mail/cltbld', 07:37:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:37:13 INFO - 'MOZ_NO_REMOTE': '1', 07:37:13 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:37:13 INFO - 'NO_EM_RESTART': '1', 07:37:13 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:37:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:37:13 INFO - 'PWD': '/builds/slave/test', 07:37:13 INFO - 'SHELL': '/bin/bash', 07:37:13 INFO - 'SHLVL': '1', 07:37:13 INFO - 'TERM': 'linux', 07:37:13 INFO - 'TMOUT': '86400', 07:37:13 INFO - 'USER': 'cltbld', 07:37:13 INFO - 'XDG_SESSION_COOKIE': '9c43b49b387003dc8f5b4e5c000001c4-1459521038.882658-1739113132', 07:37:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:37:13 INFO - '_': '/tools/buildbot/bin/python'} 07:37:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:37:13 INFO - Downloading/unpacking flake8 07:37: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 07:37:13 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 07:37:13 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 07:37:13 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 07:37: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 07:37:13 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 07:37:17 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 07:37:18 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 07:37: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 07:37: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 07:37: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 07:37: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 07:37: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 07:37: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 07:37:18 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 07:37:18 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 07:37: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 07:37: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 07:37: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 07:37: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 07:37: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 07:37: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 07:37:19 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 07:37:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:37:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:37:19 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:37:19 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:37:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:37:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:37:19 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 07:37:19 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 07:37:19 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 07:37:19 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 07:37:19 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 07:37:19 INFO - no previously-included directories found matching 'docs/_build' 07:37:20 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 07:37:20 INFO - Running setup.py install for pep8 07:37:20 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 07:37:20 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 07:37:20 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 07:37:20 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 07:37:20 INFO - no previously-included directories found matching 'docs/_build' 07:37:20 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 07:37:20 INFO - Successfully installed flake8 mccabe pyflakes pep8 07:37:20 INFO - Cleaning up... 07:37:20 INFO - Return code: 0 07:37:20 INFO - Running post-action listener: _resource_record_post_action 07:37:20 INFO - Running post-action listener: _start_resource_monitoring 07:37:20 INFO - Starting resource monitoring. 07:37:20 INFO - ##### 07:37:20 INFO - ##### Running install step. 07:37:20 INFO - ##### 07:37:20 INFO - Running pre-action listener: _resource_record_pre_action 07:37:20 INFO - Running main action method: install 07:37:20 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 07:37:20 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 07:37:20 INFO - Reading from file tmpfile_stdout 07:37:20 INFO - Detecting whether we're running mozinstall >=1.0... 07:37:20 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 07:37:20 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 07:37:20 INFO - Reading from file tmpfile_stdout 07:37:20 INFO - Output received: 07:37:20 INFO - Usage: mozinstall [options] installer 07:37:20 INFO - Options: 07:37:20 INFO - -h, --help show this help message and exit 07:37:20 INFO - -d DEST, --destination=DEST 07:37:20 INFO - Directory to install application into. [default: 07:37:20 INFO - "/builds/slave/test"] 07:37:20 INFO - --app=APP Application being installed. [default: firefox] 07:37:20 INFO - mkdir: /builds/slave/test/build/application 07:37:20 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 07:37:20 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 07:37:36 INFO - Reading from file tmpfile_stdout 07:37:36 INFO - Output received: 07:37:36 INFO - /builds/slave/test/build/application/firefox/firefox 07:37:36 INFO - Running post-action listener: _resource_record_post_action 07:37:36 INFO - ##### 07:37:36 INFO - ##### Running run-tests step. 07:37:36 INFO - ##### 07:37:36 INFO - Running pre-action listener: _resource_record_pre_action 07:37:36 INFO - Running main action method: run_tests 07:37:36 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 07:37:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 07:37:36 INFO - Python 2.7.3 07:37:36 INFO - Return code: 0 07:37:36 INFO - grabbing minidump binary from tooltool 07:37:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:37:36 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29de410>, '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 0x29df310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29df7a0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 07:37:36 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 07:37:36 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 07:37:36 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 07:37:36 INFO - Return code: 0 07:37:36 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 07:37:36 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 07:37:36 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 07:37:36 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 07:37:36 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 07:37:36 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 07:37:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 07:37:37 INFO - Return code: 0 07:37:37 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/FDmwgmkSTwu_rQq4LRc-oA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-022', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 07:37:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team-Non-PGO --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/FDmwgmkSTwu_rQq4LRc-oA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-022 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 07:37:37 INFO - Using env: {'DISPLAY': ':0', 07:37:37 INFO - 'HOME': '/home/cltbld', 07:37:37 INFO - 'LANG': 'en_US.UTF-8', 07:37:37 INFO - 'LANGUAGE': 'en_US:en', 07:37:37 INFO - 'LOGNAME': 'cltbld', 07:37:37 INFO - 'MAIL': '/var/mail/cltbld', 07:37:37 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 07:37:37 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 07:37:37 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:37:37 INFO - 'MOZ_NO_REMOTE': '1', 07:37:37 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 07:37:37 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:37:37 INFO - 'NO_EM_RESTART': '1', 07:37:37 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:37:37 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:37:37 INFO - 'PWD': '/builds/slave/test', 07:37:37 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 07:37:37 INFO - 'SHELL': '/bin/bash', 07:37:37 INFO - 'SHLVL': '1', 07:37:37 INFO - 'TERM': 'linux', 07:37:37 INFO - 'TMOUT': '86400', 07:37:37 INFO - 'USER': 'cltbld', 07:37:37 INFO - 'XDG_SESSION_COOKIE': '9c43b49b387003dc8f5b4e5c000001c4-1459521038.882658-1739113132', 07:37:37 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:37:37 INFO - '_': '/tools/buildbot/bin/python'} 07:37:37 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/FDmwgmkSTwu_rQq4LRc-oA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-022', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 07:37:37 INFO - mozversion application_buildid: 20160401065453 07:37:37 INFO - mozversion application_changeset: f82243c637f027297dfa2b79545aeeed34088d8d 07:37:37 INFO - mozversion application_display_name: Nightly 07:37:37 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 07:37:37 INFO - mozversion application_name: Firefox 07:37:37 INFO - mozversion application_remotingname: firefox 07:37:37 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 07:37:37 INFO - mozversion application_vendor: Mozilla 07:37:37 INFO - mozversion application_version: 48.0a1 07:37:37 INFO - mozversion platform_buildid: 20160401065453 07:37:37 INFO - mozversion platform_changeset: f82243c637f027297dfa2b79545aeeed34088d8d 07:37:37 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 07:37:37 INFO - mozversion platform_version: 48.0a1 07:37:37 INFO - using testdate: 1459521457 07:37:37 INFO - actual date: 1459521457 07:37:37 INFO - starting webserver on 'localhost:55613' 07:37:37 INFO - SUITE-START | Running 2 tests 07:37:37 INFO - TEST-START | dromaeo_css 07:37:37 INFO - operating with platform_type : linux_ 07:37:37 INFO - Initialising browser for dromaeo_css test... 07:37:37 INFO - TEST-INFO | started process 23064 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmptGHjxU/profile http://localhost:55613/getInfo.html) 07:37:42 INFO - PROCESS | 23064 | __metrics Screen width/height:1600/1200 07:37:42 INFO - PROCESS | 23064 | colorDepth:24 07:37:42 INFO - PROCESS | 23064 | Browser inner width/height: 1024/697 07:37:42 INFO - PROCESS | 23064 | __metrics 07:37:43 ERROR - PROCESS | 23064 | JavaScript error: resource://app/modules/AboutNewTab.jsm, line 36: TypeError: this.pageListener is null 07:37:44 INFO - TEST-INFO | 23064: exit 0 07:37:44 INFO - Browser initialized. 07:37:44 INFO - Running cycle 1/1 for dromaeo_css test... 07:37:44 INFO - TEST-INFO | started process 23149 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmptGHjxU/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 07:37:56 INFO - PROCESS | 23149 | RSS: Main: 154775552 07:37:56 INFO - PROCESS | 23149 | 07:38:47 INFO - PROCESS | 23149 | 1459521527923 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] 07:40:59 INFO - PROCESS | 23149 | Cycle 1(1): loaded http://localhost:55613/tests/dromaeo/cssquery-dojo.html (next: http://localhost:55613/tests/dromaeo/cssquery-ext.html) 07:41:01 INFO - PROCESS | 23149 | RSS: Main: 262356992 07:41:01 INFO - PROCESS | 23149 | 07:44:03 INFO - PROCESS | 23149 | Cycle 1(1): loaded http://localhost:55613/tests/dromaeo/cssquery-ext.html (next: http://localhost:55613/tests/dromaeo/cssquery-jquery.html) 07:44:04 INFO - PROCESS | 23149 | RSS: Main: 237817856 07:44:04 INFO - PROCESS | 23149 | 07:47:06 INFO - PROCESS | 23149 | Cycle 1(1): loaded http://localhost:55613/tests/dromaeo/cssquery-jquery.html (next: http://localhost:55613/tests/dromaeo/cssquery-mootools.html) 07:47:06 INFO - PROCESS | 23149 | RSS: Main: 234729472 07:47:06 INFO - PROCESS | 23149 | 07:50:08 INFO - PROCESS | 23149 | Cycle 1(1): loaded http://localhost:55613/tests/dromaeo/cssquery-mootools.html (next: http://localhost:55613/tests/dromaeo/cssquery-prototype.html) 07:50:09 INFO - PROCESS | 23149 | RSS: Main: 223821824 07:50:09 INFO - PROCESS | 23149 | 07:53:11 INFO - PROCESS | 23149 | Cycle 1(1): loaded http://localhost:55613/tests/dromaeo/cssquery-prototype.html (next: http://localhost:55613/tests/dromaeo/cssquery-yui.html) 07:53:12 INFO - PROCESS | 23149 | RSS: Main: 200466432 07:53:12 INFO - PROCESS | 23149 | 07:56:15 INFO - PROCESS | 23149 | Cycle 1(1): loaded http://localhost:55613/tests/dromaeo/cssquery-yui.html (next: http://localhost:55613/tests/dromaeo/cssquery-dojo.html) 07:56:15 INFO - PROCESS | 23149 | RSS: Main: 278740992 07:56:15 INFO - PROCESS | 23149 | 07:56:15 INFO - PROCESS | 23149 | __start_tp_report 07:56:15 INFO - PROCESS | 23149 | _x_x_mozilla_page_load 07:56:15 INFO - PROCESS | 23149 | _x_x_mozilla_page_load_details 07:56:15 INFO - PROCESS | 23149 | |i|pagename|runs| 07:56:15 INFO - PROCESS | 23149 | |0;dojo.html;2646.179684297868;2737.8220415672968;2745.1901689001743;2751.944961100778;2764.5023895698773;4570.360149579062;4665.370175026374;4675.158471475133;4692.155412025834;4693.483716791155;4633.4208223972;4683.625309975194;4683.929741053887;4694.2723877799;4720.221163508017;4276.764777937212;4301.462317210341;4313.870583882489;4344.088601015559;4474.149911516818;4454.8663540093685;4503.932441013371;4531.660125490602;4542.4776150742755;4543.772811359436;4266.445362102938;4331.501877284121;4339.045410009793;4435.201663700533;4447.0661161156195;4285.678574106923;4343.978280108611;4344.218040752663;4380.956190438119;4405.581469760367;4283.164782867342;4285.442892423996;4298.656107511391;4319.611234988866;4327.242732521796;4452.666050046259;4494.9325760113625;4530.343100250445;4592.540745925414;4650.209464391061;5005.0990821652085;5037.395512538519;5059.595232381401;5082.974585127087;5119.539241468286;5060.165072762989;5061.949380506185;5080.79676812927;5081.7967281309075;5126.92309615356;4569.680122391401;4664.720116793003;4712.835050773207;4723.102610504062;4786.1863483207935;5098.311727916758;5117.385913690307;5117.565006974449;5124.769385377667;5152.768125434364;4906.190478571068;4910.950890491121;4913.754312284372;4918.163912134945;4961.355023846949;4933.0380575788095;4978.079055374767;5000.349954505891;5109.156989096758;5124.743762811844;4937.530934561211;4957.628177886673;4964.379452568429;4967.180415231519;5015.297858299841;4943.703377797344;4947.381577302837;4954.702717836869;4956.950430495721;4996.325496057985;4162.7502349859105;4244.617984381421;4257.3613957905945;4309.439772829574;4330.675199360061;3716.554013518395;3732.720045996561;3750.287445385368;3762.9435558466644;3800.9429858552144;4341.153475072394;4347.06538094305;4347.695661303742;4353.998580326543;4391.538888416734;4875.780589873464;5015.27278544609;5049.495050494995;5108.667936584185;5112.897742045138;4282.785860706952;4294.162638285505;4301.354796780508;4303.763293018851;4343.391925130484;4518.954810451919;4523.434570678665;4536.251518499411;4540.523245059288;4559.042601053816;4647.744374059392;4716.929246061243;4782.6173906088125;4833.3958255218095;4836.056968891033;4991.650584459053;5003.324551185543;5010.799568017239;5016.698998059982;5064.088464076354;4660.39414876064;4737.881552961204;4741.122892264942;4741.5495527924795;4787.832425865078;4935.605151587936;4971.279164521196;5042.697438153723;5043.142665746758;5055.241713742968;4961.330220420197;5003.374578177728;5008.223725322581;5017.874553136201;5043.672161309503;4788.138135135569;4855.028994201103;4859.684120532154;4860.9513904861915;4902.3872015998;4867.075255701406;4913.164761990399;4937.7531123444405;4975.378077740283;4989.351384320015;4759.76201189946;4761.547652972962;4777.068471648135;4781.211100168433;4810.7113573185725;4802.591779698765;4872.585830204473;4880.804767809248;4880.902381952412;4881.707097574157;4732.550407711262;4807.711537307773;4807.711537307773;4816.831410900601;4856.805727770849 07:56:15 INFO - PROCESS | 23149 | |1;ext.html;535.9088954877673;538.7602516879989;556.3268445181329;558.1989844573036;567.3673853653175;27277;34101.1474713132;34744.4788328175;34911.65088349116;34957.3008539829;38001.809990950074;38374.616253837456;38405.42391864117;38455;38533.99999999993;7579.734709285176;7768.028996375453;7781;7784.883226751604;7790;7615.46691731579;7738.18749031352;7741.380689544823;7742.07095148583;7846.882296765524;7873.291403773659;7960.681572737083;7981.28168464838;7983.960080199591;7985.840283194332;7856.371490280764;7938.682452701885;7943.841123177504;7952.1650226726515;7960.084590272106;7769.805754856117;7919.762407127795;7926.841463170705;7930.1276859545405;7938.483998540134;37652.81173594142;38115.42826857599;38162;38167.8091609543;38171.809140954116;3036.2561172512874;3122.9687703122904;3158.242021914747;3188.681131886816;3218.4045951498815;28426.715732842615;28799.56800647992;29083.70916290831;29461;29659.851700741576;3367.3433680432327;3388.8644454221803;3423.4351332030187;3456.9283522108226;3474.774139680913;235557;235647;236163;236434;236829.81585092135;50187.74906125446;54474;54510.45489545054;57579.42420575741;58407.70796145992;52397.214041789404;52634.21048684273;52850;53037.469625304024;53107;12549.247045177319;12594.307313097868;12702.30137342455;12705.428255728515;12706.872931270755;8298.087210406851;8537.445066070686;9439.52802359893;9557.761055973517;9899.356541824758;18077.186526606336;18140.63718725618;18235.45293641193;18267.451976440727;18279.63440731178;6786.898196527056;6950.339717726808;7192.892106618405;7199.2080871104135;7261.164966028869;880.1418616848522;916.6745805239177;923.3490389275545;933.286036182321;975.0834215837091;25585.87207063953;25980.22059338223;27309.45381092367;27345.863270683916;27383;951.3103000324709;981.6318880419842;985.7042887133831;994.9701508954743;1005.5927349423495;13885.166889986633;14079;14171.433142674177;14406.351714172888;14414.783778243334;279653;284438;285554;285711;285862;40819.7959010209;40978.59021409748;41026.79486602607;41039;41306.1738765223;1055.8785739639886;1156.0866915136949;1235.32057368447;1250.6060590913833;1255.811628255769;24202.394940125934;26504.734952650226;27078;27159.86420067887;27445.45109097847;42842.35736464018;43248.56751432571;43323.35014974715;43388.566114339716;43405.56594434142;213637;214203;214405;214953;215396;30102.24744381408;31849;32097.197570060936;32228.677713223504;32259.51610725794;40381.596184037786;41357.37963930603;41935;42144.578554215295;42209;34824.65175348315;35208.47187292244;35271.647283526836;35420.645793541735;35627.64372356243;34147.65852341445;34354.141146471535;34586.48120278248;34616.13459663529;34723;34740.826295868355;34972.65027349694;35194.64805351914;35524.64475355214;35559;30279.243018924702;30499.54250686197;30928.26460054931;31001.96676705944;31301.373972520876;22144.2249521266;22540.760258185957;22691.319260422213;23436.882815586494;23940.88029559911 07:56:15 INFO - PROCESS | 23149 | |2;jquery.html;343.4641958544672;353.40451339492955;361.49751844935525;362.1326922021758;368.123865200822;15345.616359591002;15698.901076924605;15730.134842583653;16027.83972160278;16187.83812161878;15303.617409564738;15551.766723499128;16576.336946522126;16702.415415460462;16707.081110538915;4756.524347565233;4850.951490485103;4921.040397122562;4991.126552853254;5041.873953151164;4875.58557522611;4884.877878053059;4902.338184345122;4904.779284932169;4916.459189489154;4817.686850354733;4842.031593681278;4850.12697714413;4851.975740121295;4853.247746599282;4708.293755936603;4928.975355123237;4932.482089380599;4934;4936.210206366982;4407.096545208225;4415.470143582758;4419.491758447787;4419.712718673276;4422.845200418002;18823;19756.70364944527;19816.306429274908;19954.102065407093;20004.799952000438;1949.980500194994;2082.79172082792;2091.9958419958507;2093.110428068065;2476.9133080342103;12293.56972505958;12731.172473789175;12776.552820651326;13036.86963130366;13170.143940643828;1681.428314373119;1731.37670438642;1744.2499725118194;1747.5631092226943;1803.774528183977;55953;56731.71634141844;56905.43094569084;57299.42700572983;57523.13715294274;8848.11518848123;8905.51019693923;9202.619607058994;9325.626974921062;9515.952420237854;12601.18092323996;12661.683457913627;12706.36468176606;12711.936440317739;12722;6586.407223349922;6632.104665870046;6688.765893193812;6721.1262535871;6737.258901520829;6124.785632502841;6194.721237544321;6269.404406581459;6283.905741413882;6318.8420289492215;5523.889522209533;5673.31920169574;5715.628484148517;5744.856378590485;5831.941680583224;1596.289651105247;1607.8151012633464;1619.1256721370564;1707.598714302138;1738.2525514028837;849.3035710717276;880.1286726141202;891.2780647675404;892.0098690453591;966.9516524173763;16081.758773618405;16236.51290461288;16441.91779041097;16447.588810279838;16751.162441877856;865.5109862927426;890.2388457868559;910.1308250620774;934.8036912248368;964.8552717092492;9228.215601673799;9516.33385662997;9595.42427454355;9828.16460600857;9854.359466634645;337870;340632;340816;342773;344450;59963.400365996655;60565;61648.38351616516;62165.68917155476;63417.365826342066;958.2669258017761;963.4652767713986;1016.6899095775711;1021.6781713760141;1033.4006276359694;14486.348114335091;14566.271686415848;14724.19016954035;14892.180930048951;14992.925035374754;31106.066817995496;31630.525542117346;31940.52089218617;32049.519257210693;32375.83812081019;40505.59494405136;41109.383359250234;41538.58461415347;42462;42732.78633606812;7332.340089391981;7656.387489000978;7724.691012359667;7749.41879359039;7784.532928024337;11173.162012849232;11426.94286528562;11572.18994670365;11643;11667.883321166679;7618.695252190072;7703.845923081619;7735.497192682457;7748.8450230996195;9890.109890109637;7353.301436363537;7460.515066520658;7495.250474952461;7903.114117899088;7945.245201705829;7758.844823103619;7983.281504664608;8176.264136227768;8246.917530824854;8397.244248017707;10787.838182427113;10909.727256818644;10913.836292455779;11109.555617775199;11182.88817111851;10583.629572965217;11155.051820595016;11238.943805280922;11330.943345283551;11531.596394126502 07:56:15 INFO - PROCESS | 23149 | |3;mootools.html;1288.5361269942814;1423.8932080093994;1433.6559225785816;1556.1518972160172;1777.6266983933365;6686.765963191289;7399.223081576438;7503.84992300155;7577.318041376282;7578.204288549692;7440.553566785997;7615.048118985127;7620.504667196628;7620.923790762091;7624.390048796097;1848.704207326828;1902.2200897631974;1903.8572107091954;2247.438140464884;2282.429392651837;2185.530111026137;2236.7427745809196;2238.46276893546;2240.9439764005865;2241.7870302321253;2108.325335892515;2118.639831228687;2124.54322320701;2132.4562236629636;2244.236959433792;2215.944601384962;2233.1514024670682;2236.3067449090836;2241.5516896620743;2241.5853067182543;2155.838312126581;2221.1781640792847;2222.2333295013354;2239.4849184687614;2241.4060274027397;7715.382769378492;7722.613869306569;7739.187385324516;7751.728689495897;7757.069151701832;4556.134334476472;4662.626989840838;4701.623870090384;4705.411823522059;4708.340832283483;2924.4589750896153;2985.701429857019;3034.3931213757337;3057.0370333344927;3057.8165310081245;926.703454894434;947.9052094790535;951.3150531617224;963.0658261486417;970.898055704155;10033.197344212445;10265.435401052939;10265.948670256601;10298.9485052575;10318.277720559488;4134;4164.916701665949;4229.111886503807;4255.191513612465;4294.055307832272;8385;8397.664093436317;8410.369222308229;8413.116622754646;8421.915780842113;4626.4910859805395;4633;4649.023705021983;4660.883477913011;4671.322658214608;3630.582483014487;4137.193247316744;4258.552851950562;4268.850590229327;4308.246056940023;3604.567451905788;3659.432787917877;3678.779273243614;3703.8703645372284;3736.1593641431004;1205.1563905266348;1211.4911737070452;1212.9689763700783;1222.8349172861729;1245.9252444853337;971.0726256425097;994.9900500994897;999.3254553176577;1039.2465462539599;1182.4147047211686;6900.5859648420255;6914.308569143146;6916.896246556305;6921.342472465108;6950.721971121199;469.5351601914149;996.1433167475965;1072.2387105155271;1080.8702955645215;1099.3349023840622;5545.805896793673;5592.965301419251;5657.264555607745;5668.0647693130995;5668.744906479218;8994.145556172152;9063.093690630883;9236.953815230881;9250.95374523123;9323.860142097874;9096.863547046667;9142.177204051668;9183.816323673624;9218.354715170008;9236.307276954256;6696.7656132035145;6947.895781563382;6953.061336719579;7042.190148132928;7110.431165506747;6782.287859774653;6784.559003664746;6818.420434262945;6820.7271709133065;6851.588904665736;7540.622968851426;7930.801729956797;8037.357011438954;8051.637676304464;8053.395995300493;7946.642401091849;8267.29727973129;8296.917030829856;8346.12365701617;8350.540720260444;5615.887035967182;5680.602357834912;6008.098785182257;6530.183727034121;6668.06647069401;6433;6473.935260647333;6481.287058423664;6912.343327383891;6914.101166848278;6289.339619339903;6331.683415829282;6458.063580780855;6468.902966455601;6469.191351081115;6019.157317975574;6335.334789847;6396.71214795326;6442.549021568445;6493.577917435352;6849.931500685128;6899.206591242071;6901.689423976033;6903.309669033057;6917.100776898971;6186.4741496973265;6231.813045608639;6245.18812554365;6267.843303917439;6269.780557680459;6261.7182226799;6380.521460890544;6380.712867921047;6381.904271435839;6397.488200943821 07:56:15 INFO - PROCESS | 23149 | |4;prototype.html;312.71386681186715;322.18005176824977;324.8570628923274;326.3277648045027;331.6302322909955;5221.321228240328;5302.549283310918;5331.546818520421;5332.040232758102;5332.280142180804;5220.425753167148;5224.268602395668;5233.502817232366;5234.031704134728;5241.056609810242;3907.960920390802;4036.515618125829;4082.2856000199995;4108.712390132692;4156.896077598061;4124.175164967003;4146.025683964266;4146.357314616239;4149.937750933738;4153.979230103845;4103.97948010261;4110.342345224764;4110.650594699439;4116.608922152391;4117.46472958515;3939.4681717968137;4009.518857737061;4100.0569868930015;4111.588841115865;4114.670826333886;3640.9453858192146;3642.3807952648112;3645.6172101929446;3648.7810731356203;3652.721547458395;4979.950200498021;5022.221555658879;5034.446210916796;5036.647434679574;5054.74726263689;4717.787699553528;4734.124187025412;4768.284757286435;4775.952240477585;4776.737279449629;5541.0580201365865;5544.140658197985;5550.805721799758;5560.916586251209;5561.63849349791;4016.9196616067516;4020.43713880057;4025.7383270087353;4026.355783074723;4029.207002883718;5607.439256074401;5755.68343741094;5775.335836378828;5851.3270973838125;5853.209816674737;3921.176552923918;3966.8413263469715;3975.0658595230097;3976.58245884178;3977.2244412339314;4028.4158796974275;4031.9193616127513;4035.2534781065597;4036.990752311922;4037.6366127048705;4628.930566041512;4636.049609829976;4636.884077898079;4637.582617564368;4643.698159619681;5561.110222364402;5566.972165139148;5573.721313934287;5574.414686457863;5578.609497335147;1391.0610338021997;1394.1844021247482;1394.2401391241797;1394.4770710983382;1394.5607133753037;894.2443635128307;901.4951627088851;913.0413066280512;942.34036174678;949.6676163342913;4755.762211889391;4787.712737235777;4828;4837.564619184291;4847.200211964986;5793.044147715664;5795.478406943311;5796.47831695141;5798.275215598051;5804.796832110856;4908.828191013369;4913;4914.852554423373;4918.090153321576;4920.975395123001;3049.786514943977;3091.536269559584;3096.256898344381;3097.148284221857;3103.9844800776305;5460.6996615186545;5473.0969390050195;5477.397486276506;5480.725963701799;5481.451854814487;5767.279090113736;5944.316403613553;5987.491063259585;6015.368386319461;6020.036794112921;5451.945480545223;5468.781248750085;5472.753726082256;5477.452254774491;5482.890342193214;5772.7402266898935;5790.305163380422;5797.652140871562;5797.797077102281;5804.24544809189;5648.63283886546;5655.095184770417;5656.886862262814;5658.434156584473;5664.745086471036;5458.699771512446;5463.508284254436;5464;5473.0969390050195;5475.06923822959;3874.8643797466952;4008.4187792769303;4010.3583426651594;4019.3569028955226;4029.6373326400767;5747;5757.193992840922;5762.625429347079;5763.645543297405;5764.971175144097;5573.136163894603;5574.331080270394;5578.525825304732;5580.776768929198;5584.4136365681015;5543.473370029841;5562.860928476821;5565.860853478695;5566.832995010156;5577.3028371453565;5475.479829416199;5477.945220547744;5480.588955828249;5487.067198576172;5495.862603434786;5432.158015507603;5583.916241256466;5588.385277619377;5606.747696353592;5612.719364031864;5407.242985981887;5442.482964118402;5442.619016668795;5443.891122177613;5455.1271796512365 07:56:15 INFO - PROCESS | 23149 | |5;yui.html;656.8226578823718;676.2730065179927;771.1132197972331;781.7771934998523;807.463037080342;12618;12731;12749.10756247063;12754.426050827711;12788.68028299293;11238.719032024204;11245.943770281157;11249.381284029376;11289.661310160687;11294.943525282382;644.7936660268692;781.2812212764242;808.3088958940081;811.0672726364699;813.4915677701437;800.7677773445694;809.9271065604095;810.2869474862142;810.4043528006939;811.6996711216858;856.9700060497884;859.6088779605265;862.706679728892;864.3560547392202;864.965401383947;682.3006418421108;841.9115992820726;847.4491580472711;850.9234168924795;852.846487632226;630.4231628060319;631.084926856056;631.8072987738738;632.0361448790585;632.3139393757779;12233.755324893453;12244.510219591206;12248;12275.877241227563;12295.262284262973;12067.275963442135;12598.244105353617;12695.936520317431;12702.682432939158;12856.678583035406;9752.122308992153;9913.504324783731;9914.355566888129;9919.107280344731;10122.190224782;3331.0839519132433;3357.6642335766473;3402.0984439123654;3443.5523381960434;3469.930601387983;40435.595644043475;43121;43286;43605.56394436047;43707.562924370985;9691.370060946158;9835.114839664464;9903.059209375098;9919.85921619023;9970.351927124713;16502.917485412498;16559.586010349838;16585.585360365847;16585.585360366087;16738.581535461468;6467.805965821033;6672.399484046459;6700.83247918806;6788.796336109925;7027.578345299298;3760.4735337052834;3771.73597848148;3774.226283611853;3797.1076796952693;3831.904202394907;2890.36411989362;2893.4647090287945;2894.942101157965;2896.218021134282;2913.548399998004;511.2127323921194;525.1361510315586;526.1450143516785;527.9757270894453;529.7695502456444;429.2552421548611;620.1472974659843;623.2147494157394;627.3976982097147;645.2353960556756;7907.288344049063;7933.8413231736195;8042;8063.879041814377;8211.83576328482;643.7650804706294;644.3427703742157;661.8940969444963;673.6059405247985;680.9182898052266;3524.4360902255517;3713.535808023997;3781.3760729479877;3874.786886721201;3935.980320098381;50125;50242.995140096995;50683.23975140376;51297.487025129274;51457.48542514527;44501;44943;45188.77405613017;45661.315080273824;45905;39651.603483965366;39761.40357894634;40524.3921341186;40854;40885.38671919923;7134.143902731706;7506.13679426851;7622.237776222333;7645.88531172044;7723.961380193063;29387.55918661179;29581.408371832873;30359.544606831358;30924.536131958488;30972.845135774176;35142.47286290759;35566.11084722903;35624.93125206248;38832.6116738829;39608.60391396049;10133.13868321201;10521.842172367267;10559.260851740304;10748.946255268673;10985.340879547253;11650;11833.52665893389;11845;11954.880451195724;11990.220635658654;11215.271007384821;11411.714707132389;11632.360220187971;11726.355050472306;11829.290242585472;11168.274062185932;11206.215564910379;11575.594854180063;11613.419329033684;11618.767624647291;11084.445777711244;11241.943790280997;11498.13763967689;11562.710932226762;11885.524579017088;9435.858462123211;9648.2781213702;9727.65953191635;10034;10224.948875255874;9057.550791873533;9865.901340986786;9881.901180988098;9888.456134912361;10018 07:56:15 INFO - PROCESS | 23149 | __end_tp_report 07:56:15 INFO - PROCESS | 23149 | __start_cc_report 07:56:15 INFO - PROCESS | 23149 | _x_x_mozilla_cycle_collect,1016 07:56:15 INFO - PROCESS | 23149 | __end_cc_report 07:56:15 INFO - PROCESS | 23149 | __startTimestamp1459522575379__endTimestamp 07:56:15 INFO - PROCESS | 23149 | 07:56:15 INFO - PROCESS | 23149 | ------- Summary: start ------- 07:56:15 INFO - PROCESS | 23149 | Number of tests: 6 07:56:15 INFO - PROCESS | 23149 | 07:56:15 INFO - PROCESS | 23149 | [#0] dojo.html Cycles:165 Average:4646.60 Median:4761.55 stddev:465.56 (9.8%) stddev-sans-first:439.75 07:56:15 INFO - PROCESS | 23149 | Values: 2646.2 2737.8 2745.2 2751.9 2764.5 4570.4 4665.4 4675.2 4692.2 4693.5 4633.4 4683.6 4683.9 4694.3 4720.2 4276.8 4301.5 4313.9 4344.1 4474.1 4454.9 4503.9 4531.7 4542.5 4543.8 4266.4 4331.5 4339.0 4435.2 4447.1 4285.7 4344.0 4344.2 4381.0 4405.6 4283.2 4285.4 4298.7 4319.6 4327.2 4452.7 4494.9 4530.3 4592.5 4650.2 5005.1 5037.4 5059.6 5083.0 5119.5 5060.2 5061.9 5080.8 5081.8 5126.9 4569.7 4664.7 4712.8 4723.1 4786.2 5098.3 5117.4 5117.6 5124.8 5152.8 4906.2 4911.0 4913.8 4918.2 4961.4 4933.0 4978.1 5000.3 5109.2 5124.7 4937.5 4957.6 4964.4 4967.2 5015.3 4943.7 4947.4 4954.7 4957.0 4996.3 4162.8 4244.6 4257.4 4309.4 4330.7 3716.6 3732.7 3750.3 3762.9 3800.9 4341.2 4347.1 4347.7 4354.0 4391.5 4875.8 5015.3 5049.5 5108.7 5112.9 4282.8 4294.2 4301.4 4303.8 4343.4 4519.0 4523.4 4536.3 4540.5 4559.0 4647.7 4716.9 4782.6 4833.4 4836.1 4991.7 5003.3 5010.8 5016.7 5064.1 4660.4 4737.9 4741.1 4741.5 4787.8 4935.6 4971.3 5042.7 5043.1 5055.2 4961.3 5003.4 5008.2 5017.9 5043.7 4788.1 4855.0 4859.7 4861.0 4902.4 4867.1 4913.2 4937.8 4975.4 4989.4 4759.8 4761.5 4777.1 4781.2 4810.7 4802.6 4872.6 4880.8 4880.9 4881.7 4732.6 4807.7 4807.7 4816.8 4856.8 07:56:15 INFO - PROCESS | 23149 | 07:56:15 INFO - PROCESS | 23149 | [#1] ext.html Cycles:180 Average:40601.70 Median:35240.06 stddev:64285.38 (182.4%) stddev-sans-first:64395.33 07:56:15 INFO - PROCESS | 23149 | Values: 535.9 538.8 556.3 558.2 567.4 27277.0 34101.1 34744.5 34911.7 34957.3 38001.8 38374.6 38405.4 38455.0 38534.0 7579.7 7768.0 7781.0 7784.9 7790.0 7615.5 7738.2 7741.4 7742.1 7846.9 7873.3 7960.7 7981.3 7984.0 7985.8 7856.4 7938.7 7943.8 7952.2 7960.1 7769.8 7919.8 7926.8 7930.1 7938.5 37652.8 38115.4 38162.0 38167.8 38171.8 3036.3 3123.0 3158.2 3188.7 3218.4 28426.7 28799.6 29083.7 29461.0 29659.9 3367.3 3388.9 3423.4 3456.9 3474.8 235557.0 235647.0 236163.0 236434.0 236829.8 50187.7 54474.0 54510.5 57579.4 58407.7 52397.2 52634.2 52850.0 53037.5 53107.0 12549.2 12594.3 12702.3 12705.4 12706.9 8298.1 8537.4 9439.5 9557.8 9899.4 18077.2 18140.6 18235.5 18267.5 18279.6 6786.9 6950.3 7192.9 7199.2 7261.2 880.1 916.7 923.3 933.3 975.1 25585.9 25980.2 27309.5 27345.9 27383.0 951.3 981.6 985.7 995.0 1005.6 13885.2 14079.0 14171.4 14406.4 14414.8 279653.0 284438.0 285554.0 285711.0 285862.0 40819.8 40978.6 41026.8 41039.0 41306.2 1055.9 1156.1 1235.3 1250.6 1255.8 24202.4 26504.7 27078.0 27159.9 27445.5 42842.4 43248.6 43323.4 43388.6 43405.6 213637.0 214203.0 214405.0 214953.0 215396.0 30102.2 31849.0 32097.2 32228.7 32259.5 40381.6 41357.4 41935.0 42144.6 42209.0 34824.7 35208.5 35271.6 35420.6 35627.6 34147.7 34354.1 34586.5 34616.1 34723.0 34740.8 34972.7 35194.6 35524.6 35559.0 30279.2 30499.5 30928.3 31002.0 31301.4 22144.2 22540.8 22691.3 23436.9 23940.9 07:56:15 INFO - PROCESS | 23149 | 07:56:15 INFO - PROCESS | 23149 | [#2] jquery.html Cycles:180 Average:21574.59 Median:4419.60 stddev:56000.85 (1267.1%) stddev-sans-first:56135.25 07:56:15 INFO - PROCESS | 23149 | Values: 343.5 353.4 361.5 362.1 368.1 15345.6 15698.9 15730.1 16027.8 16187.8 15303.6 15551.8 16576.3 16702.4 16707.1 4756.5 4851.0 4921.0 4991.1 5041.9 4875.6 4884.9 4902.3 4904.8 4916.5 4817.7 4842.0 4850.1 4852.0 4853.2 4708.3 4929.0 4932.5 4934.0 4936.2 4407.1 4415.5 4419.5 4419.7 4422.8 18823.0 19756.7 19816.3 19954.1 20004.8 1950.0 2082.8 2092.0 2093.1 2476.9 12293.6 12731.2 12776.6 13036.9 13170.1 1681.4 1731.4 1744.2 1747.6 1803.8 55953.0 56731.7 56905.4 57299.4 57523.1 8848.1 8905.5 9202.6 9325.6 9516.0 12601.2 12661.7 12706.4 12711.9 12722.0 6586.4 6632.1 6688.8 6721.1 6737.3 6124.8 6194.7 6269.4 6283.9 6318.8 5523.9 5673.3 5715.6 5744.9 5831.9 1596.3 1607.8 1619.1 1707.6 1738.3 849.3 880.1 891.3 892.0 967.0 16081.8 16236.5 16441.9 16447.6 16751.2 865.5 890.2 910.1 934.8 964.9 9228.2 9516.3 9595.4 9828.2 9854.4 337870.0 340632.0 340816.0 342773.0 344450.0 59963.4 60565.0 61648.4 62165.7 63417.4 958.3 963.5 1016.7 1021.7 1033.4 14486.3 14566.3 14724.2 14892.2 14992.9 31106.1 31630.5 31940.5 32049.5 32375.8 40505.6 41109.4 41538.6 42462.0 42732.8 7332.3 7656.4 7724.7 7749.4 7784.5 11173.2 11426.9 11572.2 11643.0 11667.9 7618.7 7703.8 7735.5 7748.8 9890.1 7353.3 7460.5 7495.3 7903.1 7945.2 7758.8 7983.3 8176.3 8246.9 8397.2 10787.8 10909.7 10913.8 11109.6 11182.9 10583.6 11155.1 11238.9 11330.9 11531.6 07:56:15 INFO - PROCESS | 23149 | 07:56:15 INFO - PROCESS | 23149 | [#3] mootools.html Cycles:180 Average:5221.21 Median:6279.56 stddev:2693.99 (42.9%) stddev-sans-first:2685.33 07:56:15 INFO - PROCESS | 23149 | Values: 1288.5 1423.9 1433.7 1556.2 1777.6 6686.8 7399.2 7503.8 7577.3 7578.2 7440.6 7615.0 7620.5 7620.9 7624.4 1848.7 1902.2 1903.9 2247.4 2282.4 2185.5 2236.7 2238.5 2240.9 2241.8 2108.3 2118.6 2124.5 2132.5 2244.2 2215.9 2233.2 2236.3 2241.6 2241.6 2155.8 2221.2 2222.2 2239.5 2241.4 7715.4 7722.6 7739.2 7751.7 7757.1 4556.1 4662.6 4701.6 4705.4 4708.3 2924.5 2985.7 3034.4 3057.0 3057.8 926.7 947.9 951.3 963.1 970.9 10033.2 10265.4 10265.9 10298.9 10318.3 4134.0 4164.9 4229.1 4255.2 4294.1 8385.0 8397.7 8410.4 8413.1 8421.9 4626.5 4633.0 4649.0 4660.9 4671.3 3630.6 4137.2 4258.6 4268.9 4308.2 3604.6 3659.4 3678.8 3703.9 3736.2 1205.2 1211.5 1213.0 1222.8 1245.9 971.1 995.0 999.3 1039.2 1182.4 6900.6 6914.3 6916.9 6921.3 6950.7 469.5 996.1 1072.2 1080.9 1099.3 5545.8 5593.0 5657.3 5668.1 5668.7 8994.1 9063.1 9237.0 9251.0 9323.9 9096.9 9142.2 9183.8 9218.4 9236.3 6696.8 6947.9 6953.1 7042.2 7110.4 6782.3 6784.6 6818.4 6820.7 6851.6 7540.6 7930.8 8037.4 8051.6 8053.4 7946.6 8267.3 8296.9 8346.1 8350.5 5615.9 5680.6 6008.1 6530.2 6668.1 6433.0 6473.9 6481.3 6912.3 6914.1 6289.3 6331.7 6458.1 6468.9 6469.2 6019.2 6335.3 6396.7 6442.5 6493.6 6849.9 6899.2 6901.7 6903.3 6917.1 6186.5 6231.8 6245.2 6267.8 6269.8 6261.7 6380.5 6380.7 6381.9 6397.5 07:56:15 INFO - PROCESS | 23149 | 07:56:15 INFO - PROCESS | 23149 | [#4] prototype.html Cycles:180 Average:4619.79 Median:5271.80 stddev:1357.43 (25.7%) stddev-sans-first:1322.19 07:56:15 INFO - PROCESS | 23149 | Values: 312.7 322.2 324.9 326.3 331.6 5221.3 5302.5 5331.5 5332.0 5332.3 5220.4 5224.3 5233.5 5234.0 5241.1 3908.0 4036.5 4082.3 4108.7 4156.9 4124.2 4146.0 4146.4 4149.9 4154.0 4104.0 4110.3 4110.7 4116.6 4117.5 3939.5 4009.5 4100.1 4111.6 4114.7 3640.9 3642.4 3645.6 3648.8 3652.7 4980.0 5022.2 5034.4 5036.6 5054.7 4717.8 4734.1 4768.3 4776.0 4776.7 5541.1 5544.1 5550.8 5560.9 5561.6 4016.9 4020.4 4025.7 4026.4 4029.2 5607.4 5755.7 5775.3 5851.3 5853.2 3921.2 3966.8 3975.1 3976.6 3977.2 4028.4 4031.9 4035.3 4037.0 4037.6 4628.9 4636.0 4636.9 4637.6 4643.7 5561.1 5567.0 5573.7 5574.4 5578.6 1391.1 1394.2 1394.2 1394.5 1394.6 894.2 901.5 913.0 942.3 949.7 4755.8 4787.7 4828.0 4837.6 4847.2 5793.0 5795.5 5796.5 5798.3 5804.8 4908.8 4913.0 4914.9 4918.1 4921.0 3049.8 3091.5 3096.3 3097.1 3104.0 5460.7 5473.1 5477.4 5480.7 5481.5 5767.3 5944.3 5987.5 6015.4 6020.0 5451.9 5468.8 5472.8 5477.5 5482.9 5772.7 5790.3 5797.7 5797.8 5804.2 5648.6 5655.1 5656.9 5658.4 5664.7 5458.7 5463.5 5464.0 5473.1 5475.1 3874.9 4008.4 4010.4 4019.4 4029.6 5747.0 5757.2 5762.6 5763.6 5765.0 5573.1 5574.3 5578.5 5580.8 5584.4 5543.5 5562.9 5565.9 5566.8 5577.3 5475.5 5477.9 5480.6 5487.1 5495.9 5432.2 5583.9 5588.4 5606.7 5612.7 5407.2 5442.5 5442.6 5443.9 5455.1 07:56:15 INFO - PROCESS | 23149 | 07:56:15 INFO - PROCESS | 23149 | [#5] yui.html Cycles:180 Average:12516.22 Median:21775.13 stddev:13843.20 (63.6%) stddev-sans-first:13853.38 07:56:15 INFO - PROCESS | 23149 | Values: 656.8 676.3 771.1 781.8 807.5 12618.0 12731.0 12749.1 12754.4 12788.7 11238.7 11245.9 11249.4 11289.7 11294.9 644.8 781.3 808.3 811.1 813.5 800.8 809.9 810.3 810.4 811.7 857.0 859.6 862.7 864.4 865.0 682.3 841.9 847.4 850.9 852.8 630.4 631.1 631.8 632.0 632.3 12233.8 12244.5 12248.0 12275.9 12295.3 12067.3 12598.2 12695.9 12702.7 12856.7 9752.1 9913.5 9914.4 9919.1 10122.2 3331.1 3357.7 3402.1 3443.6 3469.9 40435.6 43121.0 43286.0 43605.6 43707.6 9691.4 9835.1 9903.1 9919.9 9970.4 16502.9 16559.6 16585.6 16585.6 16738.6 6467.8 6672.4 6700.8 6788.8 7027.6 3760.5 3771.7 3774.2 3797.1 3831.9 2890.4 2893.5 2894.9 2896.2 2913.5 511.2 525.1 526.1 528.0 529.8 429.3 620.1 623.2 627.4 645.2 7907.3 7933.8 8042.0 8063.9 8211.8 643.8 644.3 661.9 673.6 680.9 3524.4 3713.5 3781.4 3874.8 3936.0 50125.0 50243.0 50683.2 51297.5 51457.5 44501.0 44943.0 45188.8 45661.3 45905.0 39651.6 39761.4 40524.4 40854.0 40885.4 7134.1 7506.1 7622.2 7645.9 7724.0 29387.6 29581.4 30359.5 30924.5 30972.8 35142.5 35566.1 35624.9 38832.6 39608.6 10133.1 10521.8 10559.3 10748.9 10985.3 11650.0 11833.5 11845.0 11954.9 11990.2 11215.3 11411.7 11632.4 11726.4 11829.3 11168.3 11206.2 11575.6 11613.4 11618.8 11084.4 11241.9 11498.1 11562.7 11885.5 9435.9 9648.3 9727.7 10034.0 10224.9 9057.6 9865.9 9881.9 9888.5 10018.0 07:56:15 INFO - PROCESS | 23149 | -------- Summary: end -------- 07:56:15 INFO - PROCESS | 23149 | 07:56:16 INFO - TEST-INFO | 23149: exit 0 07:56:16 INFO - TEST-OK | dromaeo_css | took 1118706ms 07:56:16 INFO - TEST-START | kraken 07:56:16 INFO - operating with platform_type : linux_ 07:56:16 INFO - Initialising browser for kraken test... 07:56:16 INFO - TEST-INFO | started process 23328 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpUXlais/profile http://localhost:55613/getInfo.html) 07:56:20 INFO - PROCESS | 23328 | __metrics Screen width/height:1600/1200 07:56:20 INFO - PROCESS | 23328 | colorDepth:24 07:56:20 INFO - PROCESS | 23328 | Browser inner width/height: 1024/697 07:56:20 INFO - PROCESS | 23328 | __metrics 07:56:21 ERROR - PROCESS | 23328 | JavaScript error: resource://app/modules/AboutNewTab.jsm, line 36: TypeError: this.pageListener is null 07:56:22 INFO - TEST-INFO | 23328: exit 0 07:56:22 INFO - Browser initialized. 07:56:22 INFO - Running cycle 1/1 for kraken test... 07:56:22 INFO - TEST-INFO | started process 23408 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpUXlais/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 07:56:34 INFO - PROCESS | 23408 | RSS: Main: 153845760 07:56:34 INFO - PROCESS | 23408 | 07:56:37 INFO - PROCESS | 23408 | Cycle 1(1): loaded http://localhost:55613/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:55613/tests/kraken/driver.html?testName=audio-beat-detection) 07:56:37 INFO - PROCESS | 23408 | RSS: Main: 195653632 07:56:37 INFO - PROCESS | 23408 | 07:56:40 INFO - PROCESS | 23408 | Cycle 1(1): loaded http://localhost:55613/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:55613/tests/kraken/driver.html?testName=audio-dft) 07:56:41 INFO - PROCESS | 23408 | RSS: Main: 186421248 07:56:41 INFO - PROCESS | 23408 | 07:56:44 INFO - PROCESS | 23408 | Cycle 1(1): loaded http://localhost:55613/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:55613/tests/kraken/driver.html?testName=audio-fft) 07:56:44 INFO - PROCESS | 23408 | RSS: Main: 170123264 07:56:44 INFO - PROCESS | 23408 | 07:56:46 INFO - PROCESS | 23408 | Cycle 1(1): loaded http://localhost:55613/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:55613/tests/kraken/driver.html?testName=audio-oscillator) 07:56:47 INFO - PROCESS | 23408 | RSS: Main: 172302336 07:56:47 INFO - PROCESS | 23408 | 07:56:49 INFO - PROCESS | 23408 | Cycle 1(1): loaded http://localhost:55613/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:55613/tests/kraken/driver.html?testName=imaging-gaussian-blur) 07:56:50 INFO - PROCESS | 23408 | RSS: Main: 173813760 07:56:50 INFO - PROCESS | 23408 | 07:56:53 INFO - PROCESS | 23408 | Cycle 1(1): loaded http://localhost:55613/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:55613/tests/kraken/driver.html?testName=imaging-darkroom) 07:56:54 INFO - PROCESS | 23408 | RSS: Main: 173953024 07:56:54 INFO - PROCESS | 23408 | 07:56:57 INFO - PROCESS | 23408 | Cycle 1(1): loaded http://localhost:55613/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:55613/tests/kraken/driver.html?testName=imaging-desaturate) 07:56:58 INFO - PROCESS | 23408 | RSS: Main: 174309376 07:56:58 INFO - PROCESS | 23408 | 07:57:00 INFO - PROCESS | 23408 | Cycle 1(1): loaded http://localhost:55613/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:55613/tests/kraken/driver.html?testName=json-parse-financial) 07:57:01 INFO - PROCESS | 23408 | RSS: Main: 174469120 07:57:01 INFO - PROCESS | 23408 | 07:57:03 INFO - PROCESS | 23408 | Cycle 1(1): loaded http://localhost:55613/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:55613/tests/kraken/driver.html?testName=json-stringify-tinderbox) 07:57:03 INFO - PROCESS | 23408 | RSS: Main: 185081856 07:57:03 INFO - PROCESS | 23408 | 07:57:05 INFO - PROCESS | 23408 | Cycle 1(1): loaded http://localhost:55613/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:55613/tests/kraken/driver.html?testName=stanford-crypto-aes) 07:57:06 INFO - PROCESS | 23408 | RSS: Main: 182984704 07:57:06 INFO - PROCESS | 23408 | 07:57:08 INFO - PROCESS | 23408 | Cycle 1(1): loaded http://localhost:55613/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:55613/tests/kraken/driver.html?testName=stanford-crypto-ccm) 07:57:09 INFO - PROCESS | 23408 | RSS: Main: 196452352 07:57:09 INFO - PROCESS | 23408 | 07:57:11 INFO - PROCESS | 23408 | Cycle 1(1): loaded http://localhost:55613/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:55613/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 07:57:12 INFO - PROCESS | 23408 | RSS: Main: 199626752 07:57:12 INFO - PROCESS | 23408 | 07:57:14 INFO - PROCESS | 23408 | Cycle 1(1): loaded http://localhost:55613/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:55613/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 07:57:15 INFO - PROCESS | 23408 | RSS: Main: 199389184 07:57:15 INFO - PROCESS | 23408 | 07:57:17 INFO - PROCESS | 23408 | Cycle 1(1): loaded http://localhost:55613/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:55613/tests/kraken/driver.html?testName=ai-astar) 07:57:17 INFO - PROCESS | 23408 | RSS: Main: 261906432 07:57:17 INFO - PROCESS | 23408 | 07:57:17 INFO - PROCESS | 23408 | __start_tp_report 07:57:17 INFO - PROCESS | 23408 | _x_x_mozilla_page_load 07:57:17 INFO - PROCESS | 23408 | _x_x_mozilla_page_load_details 07:57:17 INFO - PROCESS | 23408 | |i|pagename|runs| 07:57:17 INFO - PROCESS | 23408 | |0;ai-astar;110;111;106;110;112;112;101;111;110;111 07:57:17 INFO - PROCESS | 23408 | |1;audio-beat-detection;163;134;163;193;132;164;154;137;191;132 07:57:17 INFO - PROCESS | 23408 | |2;audio-dft;162;163;162;161;162;164;161;161;164;163 07:57:17 INFO - PROCESS | 23408 | |3;audio-fft;73;74;98;105;74;73;76;115;104;73 07:57:17 INFO - PROCESS | 23408 | |4;audio-oscillator;94;94;137;93;94;94;137;95;95;138 07:57:17 INFO - PROCESS | 23408 | |5;imaging-gaussian-blur;117;117;117;117;117;117;117;117;117;117 07:57:17 INFO - PROCESS | 23408 | |6;imaging-darkroom;146;148;146;146;145;145;145;146;146;146 07:57:17 INFO - PROCESS | 23408 | |7;imaging-desaturate;95;95;95;95;95;95;95;96;95;95 07:57:17 INFO - PROCESS | 23408 | |8;json-parse-financial;64;66;66;65;64;66;73;83;63;63 07:57:17 INFO - PROCESS | 23408 | |9;json-stringify-tinderbox;63;63;65;64;64;68;64;63;64;65 07:57:17 INFO - PROCESS | 23408 | |10;stanford-crypto-aes;80;82;82;85;81;83;82;82;80;82 07:57:17 INFO - PROCESS | 23408 | |11;stanford-crypto-ccm;117;128;118;119;118;127;121;121;116;115 07:57:17 INFO - PROCESS | 23408 | |12;stanford-crypto-pbkdf2;143;141;155;142;142;130;144;143;143;142 07:57:17 INFO - PROCESS | 23408 | |13;stanford-crypto-sha256-iterative;73;70;68;68;70;69;69;66;67;66 07:57:17 INFO - PROCESS | 23408 | __end_tp_report 07:57:17 INFO - PROCESS | 23408 | __start_cc_report 07:57:17 INFO - PROCESS | 23408 | _x_x_mozilla_cycle_collect,1167 07:57:17 INFO - PROCESS | 23408 | __end_cc_report 07:57:17 INFO - PROCESS | 23408 | __startTimestamp1459522637251__endTimestamp 07:57:17 INFO - PROCESS | 23408 | 07:57:17 INFO - PROCESS | 23408 | ------- Summary: start ------- 07:57:17 INFO - PROCESS | 23408 | Number of tests: 14 07:57:17 INFO - PROCESS | 23408 | 07:57:17 INFO - PROCESS | 23408 | [#0] ai-astar Cycles:10 Average:109.40 Median:111.00 stddev:3.41 (3.1%) stddev-sans-first:3.61 07:57:17 INFO - PROCESS | 23408 | Values: 110.0 111.0 106.0 110.0 112.0 112.0 101.0 111.0 110.0 111.0 07:57:17 INFO - PROCESS | 23408 | 07:57:17 INFO - PROCESS | 23408 | [#1] audio-beat-detection Cycles:10 Average:156.30 Median:163.00 stddev:22.99 (14.1%) stddev-sans-first:24.25 07:57:17 INFO - PROCESS | 23408 | Values: 163.0 134.0 163.0 193.0 132.0 164.0 154.0 137.0 191.0 132.0 07:57:17 INFO - PROCESS | 23408 | 07:57:17 INFO - PROCESS | 23408 | [#2] audio-dft Cycles:10 Average:162.30 Median:162.50 stddev:1.16 (0.7%) stddev-sans-first:1.22 07:57:17 INFO - PROCESS | 23408 | Values: 162.0 163.0 162.0 161.0 162.0 164.0 161.0 161.0 164.0 163.0 07:57:17 INFO - PROCESS | 23408 | 07:57:17 INFO - PROCESS | 23408 | [#3] audio-fft Cycles:10 Average:86.50 Median:73.50 stddev:16.87 (23.0%) stddev-sans-first:17.18 07:57:17 INFO - PROCESS | 23408 | Values: 73.0 74.0 98.0 105.0 74.0 73.0 76.0 115.0 104.0 73.0 07:57:17 INFO - PROCESS | 23408 | 07:57:17 INFO - PROCESS | 23408 | [#4] audio-oscillator Cycles:10 Average:107.10 Median:94.00 stddev:20.87 (22.2%) stddev-sans-first:21.59 07:57:17 INFO - PROCESS | 23408 | Values: 94.0 94.0 137.0 93.0 94.0 94.0 137.0 95.0 95.0 138.0 07:57:17 INFO - PROCESS | 23408 | 07:57:17 INFO - PROCESS | 23408 | [#5] imaging-gaussian-blur Cycles:10 Average:117.00 Median:117.00 stddev:0.00 (0.0%) stddev-sans-first:0.00 07:57:17 INFO - PROCESS | 23408 | Values: 117.0 117.0 117.0 117.0 117.0 117.0 117.0 117.0 117.0 117.0 07:57:17 INFO - PROCESS | 23408 | 07:57:17 INFO - PROCESS | 23408 | [#6] imaging-darkroom Cycles:10 Average:145.90 Median:146.00 stddev:0.88 (0.6%) stddev-sans-first:0.93 07:57:17 INFO - PROCESS | 23408 | Values: 146.0 148.0 146.0 146.0 145.0 145.0 145.0 146.0 146.0 146.0 07:57:17 INFO - PROCESS | 23408 | 07:57:17 INFO - PROCESS | 23408 | [#7] imaging-desaturate Cycles:10 Average:95.10 Median:95.00 stddev:0.32 (0.3%) stddev-sans-first:0.33 07:57:17 INFO - PROCESS | 23408 | Values: 95.0 95.0 95.0 95.0 95.0 95.0 95.0 96.0 95.0 95.0 07:57:17 INFO - PROCESS | 23408 | 07:57:17 INFO - PROCESS | 23408 | [#8] json-parse-financial Cycles:10 Average:67.30 Median:66.00 stddev:6.22 (9.4%) stddev-sans-first:6.48 07:57:17 INFO - PROCESS | 23408 | Values: 64.0 66.0 66.0 65.0 64.0 66.0 73.0 83.0 63.0 63.0 07:57:17 INFO - PROCESS | 23408 | 07:57:17 INFO - PROCESS | 23408 | [#9] json-stringify-tinderbox Cycles:10 Average:64.30 Median:64.00 stddev:1.49 (2.3%) stddev-sans-first:1.51 07:57:17 INFO - PROCESS | 23408 | Values: 63.0 63.0 65.0 64.0 64.0 68.0 64.0 63.0 64.0 65.0 07:57:17 INFO - PROCESS | 23408 | 07:57:17 INFO - PROCESS | 23408 | [#10] stanford-crypto-aes Cycles:10 Average:81.90 Median:82.00 stddev:1.45 (1.8%) stddev-sans-first:1.36 07:57:17 INFO - PROCESS | 23408 | Values: 80.0 82.0 82.0 85.0 81.0 83.0 82.0 82.0 80.0 82.0 07:57:17 INFO - PROCESS | 23408 | 07:57:17 INFO - PROCESS | 23408 | [#11] stanford-crypto-ccm Cycles:10 Average:120.00 Median:120.00 stddev:4.40 (3.7%) stddev-sans-first:4.53 07:57:17 INFO - PROCESS | 23408 | Values: 117.0 128.0 118.0 119.0 118.0 127.0 121.0 121.0 116.0 115.0 07:57:17 INFO - PROCESS | 23408 | 07:57:17 INFO - PROCESS | 23408 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:142.50 Median:143.00 stddev:5.95 (4.2%) stddev-sans-first:6.31 07:57:17 INFO - PROCESS | 23408 | Values: 143.0 141.0 155.0 142.0 142.0 130.0 144.0 143.0 143.0 142.0 07:57:17 INFO - PROCESS | 23408 | 07:57:17 INFO - PROCESS | 23408 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:68.60 Median:69.00 stddev:2.12 (3.1%) stddev-sans-first:1.54 07:57:17 INFO - PROCESS | 23408 | Values: 73.0 70.0 68.0 68.0 70.0 69.0 69.0 66.0 67.0 66.0 07:57:17 INFO - PROCESS | 23408 | -------- Summary: end -------- 07:57:17 INFO - PROCESS | 23408 | 07:57:18 INFO - TEST-INFO | 23408: exit 0 07:57:18 INFO - TEST-OK | kraken | took 62115ms 07:57:18 INFO - SUITE-END | took 1180s 07:57:18 INFO - Completed test suite (00:19:40) 07:57:18 INFO - javascript benchmark 07:57:18 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [2646.179684297868, 2737.8220415672968, 2745.1901689001743, 2751.944961100778, 2764.5023895698773, 4570.360149579062, 4665.370175026374, 4675.158471475133, 4692.155412025834, 4693.483716791155, 4633.4208223972, 4683.625309975194, 4683.929741053887, 4694.2723877799, 4720.221163508017, 4276.764777937212, 4301.462317210341, 4313.870583882489, 4344.088601015559, 4474.149911516818, 4454.8663540093685, 4503.932441013371, 4531.660125490602, 4542.4776150742755, 4543.772811359436, 4266.445362102938, 4331.501877284121, 4339.045410009793, 4435.201663700533, 4447.0661161156195, 4285.678574106923, 4343.978280108611, 4344.218040752663, 4380.956190438119, 4405.581469760367, 4283.164782867342, 4285.442892423996, 4298.656107511391, 4319.611234988866, 4327.242732521796, 4452.666050046259, 4494.9325760113625, 4530.343100250445, 4592.540745925414, 4650.209464391061, 5005.0990821652085, 5037.395512538519, 5059.595232381401, 5082.974585127087, 5119.539241468286, 5060.165072762989, 5061.949380506185, 5080.79676812927, 5081.7967281309075, 5126.92309615356, 4569.680122391401, 4664.720116793003, 4712.835050773207, 4723.102610504062, 4786.1863483207935, 5098.311727916758, 5117.385913690307, 5117.565006974449, 5124.769385377667, 5152.768125434364, 4906.190478571068, 4910.950890491121, 4913.754312284372, 4918.163912134945, 4961.355023846949, 4933.0380575788095, 4978.079055374767, 5000.349954505891, 5109.156989096758, 5124.743762811844, 4937.530934561211, 4957.628177886673, 4964.379452568429, 4967.180415231519, 5015.297858299841, 4943.703377797344, 4947.381577302837, 4954.702717836869, 4956.950430495721, 4996.325496057985, 4162.7502349859105, 4244.617984381421, 4257.3613957905945, 4309.439772829574, 4330.675199360061, 3716.554013518395, 3732.720045996561, 3750.287445385368, 3762.9435558466644, 3800.9429858552144, 4341.153475072394, 4347.06538094305, 4347.695661303742, 4353.998580326543, 4391.538888416734, 4875.780589873464, 5015.27278544609, 5049.495050494995, 5108.667936584185, 5112.897742045138, 4282.785860706952, 4294.162638285505, 4301.354796780508, 4303.763293018851, 4343.391925130484, 4518.954810451919, 4523.434570678665, 4536.251518499411, 4540.523245059288, 4559.042601053816, 4647.744374059392, 4716.929246061243, 4782.6173906088125, 4833.3958255218095, 4836.056968891033, 4991.650584459053, 5003.324551185543, 5010.799568017239, 5016.698998059982, 5064.088464076354, 4660.39414876064, 4737.881552961204, 4741.122892264942, 4741.5495527924795, 4787.832425865078, 4935.605151587936, 4971.279164521196, 5042.697438153723, 5043.142665746758, 5055.241713742968, 4961.330220420197, 5003.374578177728, 5008.223725322581, 5017.874553136201, 5043.672161309503, 4788.138135135569, 4855.028994201103, 4859.684120532154, 4860.9513904861915, 4902.3872015998, 4867.075255701406, 4913.164761990399, 4937.7531123444405, 4975.378077740283, 4989.351384320015, 4759.76201189946, 4761.547652972962, 4777.068471648135, 4781.211100168433, 4810.7113573185725, 4802.591779698765, 4872.585830204473, 4880.804767809248, 4880.902381952412, 4881.707097574157, 4732.550407711262, 4807.711537307773, 4807.711537307773, 4816.831410900601, 4856.805727770849], "unit": "score", "name": "dojo.html", "value": 4618.667804234667}, {"lowerIsBetter": false, "replicates": [535.9088954877673, 538.7602516879989, 556.3268445181329, 558.1989844573036, 567.3673853653175, 27277.0, 34101.1474713132, 34744.4788328175, 34911.65088349116, 34957.3008539829, 38001.809990950074, 38374.616253837456, 38405.42391864117, 38455.0, 38533.99999999993, 7579.734709285176, 7768.028996375453, 7781.0, 7784.883226751604, 7790.0, 7615.46691731579, 7738.18749031352, 7741.380689544823, 7742.07095148583, 7846.882296765524, 7873.291403773659, 7960.681572737083, 7981.28168464838, 7983.960080199591, 7985.840283194332, 7856.371490280764, 7938.682452701885, 7943.841123177504, 7952.1650226726515, 7960.084590272106, 7769.805754856117, 7919.762407127795, 7926.841463170705, 7930.1276859545405, 7938.483998540134, 37652.81173594142, 38115.42826857599, 38162.0, 38167.8091609543, 38171.809140954116, 3036.2561172512874, 3122.9687703122904, 3158.242021914747, 3188.681131886816, 3218.4045951498815, 28426.715732842615, 28799.56800647992, 29083.70916290831, 29461.0, 29659.851700741576, 3367.3433680432327, 3388.8644454221803, 3423.4351332030187, 3456.9283522108226, 3474.774139680913, 235557.0, 235647.0, 236163.0, 236434.0, 236829.81585092135, 50187.74906125446, 54474.0, 54510.45489545054, 57579.42420575741, 58407.70796145992, 52397.214041789404, 52634.21048684273, 52850.0, 53037.469625304024, 53107.0, 12549.247045177319, 12594.307313097868, 12702.30137342455, 12705.428255728515, 12706.872931270755, 8298.087210406851, 8537.445066070686, 9439.52802359893, 9557.761055973517, 9899.356541824758, 18077.186526606336, 18140.63718725618, 18235.45293641193, 18267.451976440727, 18279.63440731178, 6786.898196527056, 6950.339717726808, 7192.892106618405, 7199.2080871104135, 7261.164966028869, 880.1418616848522, 916.6745805239177, 923.3490389275545, 933.286036182321, 975.0834215837091, 25585.87207063953, 25980.22059338223, 27309.45381092367, 27345.863270683916, 27383.0, 951.3103000324709, 981.6318880419842, 985.7042887133831, 994.9701508954743, 1005.5927349423495, 13885.166889986633, 14079.0, 14171.433142674177, 14406.351714172888, 14414.783778243334, 279653.0, 284438.0, 285554.0, 285711.0, 285862.0, 40819.7959010209, 40978.59021409748, 41026.79486602607, 41039.0, 41306.1738765223, 1055.8785739639886, 1156.0866915136949, 1235.32057368447, 1250.6060590913833, 1255.811628255769, 24202.394940125934, 26504.734952650226, 27078.0, 27159.86420067887, 27445.45109097847, 42842.35736464018, 43248.56751432571, 43323.35014974715, 43388.566114339716, 43405.56594434142, 213637.0, 214203.0, 214405.0, 214953.0, 215396.0, 30102.24744381408, 31849.0, 32097.197570060936, 32228.677713223504, 32259.51610725794, 40381.596184037786, 41357.37963930603, 41935.0, 42144.578554215295, 42209.0, 34824.65175348315, 35208.47187292244, 35271.647283526836, 35420.645793541735, 35627.64372356243, 34147.65852341445, 34354.141146471535, 34586.48120278248, 34616.13459663529, 34723.0, 34740.826295868355, 34972.65027349694, 35194.64805351914, 35524.64475355214, 35559.0, 30279.243018924702, 30499.54250686197, 30928.26460054931, 31001.96676705944, 31301.373972520876, 22144.2249521266, 22540.760258185957, 22691.319260422213, 23436.882815586494, 23940.88029559911], "unit": "score", "name": "ext.html", "value": 16768.21792622614}, {"lowerIsBetter": false, "replicates": [343.4641958544672, 353.40451339492955, 361.49751844935525, 362.1326922021758, 368.123865200822, 15345.616359591002, 15698.901076924605, 15730.134842583653, 16027.83972160278, 16187.83812161878, 15303.617409564738, 15551.766723499128, 16576.336946522126, 16702.415415460462, 16707.081110538915, 4756.524347565233, 4850.951490485103, 4921.040397122562, 4991.126552853254, 5041.873953151164, 4875.58557522611, 4884.877878053059, 4902.338184345122, 4904.779284932169, 4916.459189489154, 4817.686850354733, 4842.031593681278, 4850.12697714413, 4851.975740121295, 4853.247746599282, 4708.293755936603, 4928.975355123237, 4932.482089380599, 4934.0, 4936.210206366982, 4407.096545208225, 4415.470143582758, 4419.491758447787, 4419.712718673276, 4422.845200418002, 18823.0, 19756.70364944527, 19816.306429274908, 19954.102065407093, 20004.799952000438, 1949.980500194994, 2082.79172082792, 2091.9958419958507, 2093.110428068065, 2476.9133080342103, 12293.56972505958, 12731.172473789175, 12776.552820651326, 13036.86963130366, 13170.143940643828, 1681.428314373119, 1731.37670438642, 1744.2499725118194, 1747.5631092226943, 1803.774528183977, 55953.0, 56731.71634141844, 56905.43094569084, 57299.42700572983, 57523.13715294274, 8848.11518848123, 8905.51019693923, 9202.619607058994, 9325.626974921062, 9515.952420237854, 12601.18092323996, 12661.683457913627, 12706.36468176606, 12711.936440317739, 12722.0, 6586.407223349922, 6632.104665870046, 6688.765893193812, 6721.1262535871, 6737.258901520829, 6124.785632502841, 6194.721237544321, 6269.404406581459, 6283.905741413882, 6318.8420289492215, 5523.889522209533, 5673.31920169574, 5715.628484148517, 5744.856378590485, 5831.941680583224, 1596.289651105247, 1607.8151012633464, 1619.1256721370564, 1707.598714302138, 1738.2525514028837, 849.3035710717276, 880.1286726141202, 891.2780647675404, 892.0098690453591, 966.9516524173763, 16081.758773618405, 16236.51290461288, 16441.91779041097, 16447.588810279838, 16751.162441877856, 865.5109862927426, 890.2388457868559, 910.1308250620774, 934.8036912248368, 964.8552717092492, 9228.215601673799, 9516.33385662997, 9595.42427454355, 9828.16460600857, 9854.359466634645, 337870.0, 340632.0, 340816.0, 342773.0, 344450.0, 59963.400365996655, 60565.0, 61648.38351616516, 62165.68917155476, 63417.365826342066, 958.2669258017761, 963.4652767713986, 1016.6899095775711, 1021.6781713760141, 1033.4006276359694, 14486.348114335091, 14566.271686415848, 14724.19016954035, 14892.180930048951, 14992.925035374754, 31106.066817995496, 31630.525542117346, 31940.52089218617, 32049.519257210693, 32375.83812081019, 40505.59494405136, 41109.383359250234, 41538.58461415347, 42462.0, 42732.78633606812, 7332.340089391981, 7656.387489000978, 7724.691012359667, 7749.41879359039, 7784.532928024337, 11173.162012849232, 11426.94286528562, 11572.18994670365, 11643.0, 11667.883321166679, 7618.695252190072, 7703.845923081619, 7735.497192682457, 7748.8450230996195, 9890.109890109637, 7353.301436363537, 7460.515066520658, 7495.250474952461, 7903.114117899088, 7945.245201705829, 7758.844823103619, 7983.281504664608, 8176.264136227768, 8246.917530824854, 8397.244248017707, 10787.838182427113, 10909.727256818644, 10913.836292455779, 11109.555617775199, 11182.88817111851, 10583.629572965217, 11155.051820595016, 11238.943805280922, 11330.943345283551, 11531.596394126502], "unit": "score", "name": "jquery.html", "value": 7846.128625830971}, {"lowerIsBetter": false, "replicates": [1288.5361269942814, 1423.8932080093994, 1433.6559225785816, 1556.1518972160172, 1777.6266983933365, 6686.765963191289, 7399.223081576438, 7503.84992300155, 7577.318041376282, 7578.204288549692, 7440.553566785997, 7615.048118985127, 7620.504667196628, 7620.923790762091, 7624.390048796097, 1848.704207326828, 1902.2200897631974, 1903.8572107091954, 2247.438140464884, 2282.429392651837, 2185.530111026137, 2236.7427745809196, 2238.46276893546, 2240.9439764005865, 2241.7870302321253, 2108.325335892515, 2118.639831228687, 2124.54322320701, 2132.4562236629636, 2244.236959433792, 2215.944601384962, 2233.1514024670682, 2236.3067449090836, 2241.5516896620743, 2241.5853067182543, 2155.838312126581, 2221.1781640792847, 2222.2333295013354, 2239.4849184687614, 2241.4060274027397, 7715.382769378492, 7722.613869306569, 7739.187385324516, 7751.728689495897, 7757.069151701832, 4556.134334476472, 4662.626989840838, 4701.623870090384, 4705.411823522059, 4708.340832283483, 2924.4589750896153, 2985.701429857019, 3034.3931213757337, 3057.0370333344927, 3057.8165310081245, 926.703454894434, 947.9052094790535, 951.3150531617224, 963.0658261486417, 970.898055704155, 10033.197344212445, 10265.435401052939, 10265.948670256601, 10298.9485052575, 10318.277720559488, 4134.0, 4164.916701665949, 4229.111886503807, 4255.191513612465, 4294.055307832272, 8385.0, 8397.664093436317, 8410.369222308229, 8413.116622754646, 8421.915780842113, 4626.4910859805395, 4633.0, 4649.023705021983, 4660.883477913011, 4671.322658214608, 3630.582483014487, 4137.193247316744, 4258.552851950562, 4268.850590229327, 4308.246056940023, 3604.567451905788, 3659.432787917877, 3678.779273243614, 3703.8703645372284, 3736.1593641431004, 1205.1563905266348, 1211.4911737070452, 1212.9689763700783, 1222.8349172861729, 1245.9252444853337, 971.0726256425097, 994.9900500994897, 999.3254553176577, 1039.2465462539599, 1182.4147047211686, 6900.5859648420255, 6914.308569143146, 6916.896246556305, 6921.342472465108, 6950.721971121199, 469.5351601914149, 996.1433167475965, 1072.2387105155271, 1080.8702955645215, 1099.3349023840622, 5545.805896793673, 5592.965301419251, 5657.264555607745, 5668.0647693130995, 5668.744906479218, 8994.145556172152, 9063.093690630883, 9236.953815230881, 9250.95374523123, 9323.860142097874, 9096.863547046667, 9142.177204051668, 9183.816323673624, 9218.354715170008, 9236.307276954256, 6696.7656132035145, 6947.895781563382, 6953.061336719579, 7042.190148132928, 7110.431165506747, 6782.287859774653, 6784.559003664746, 6818.420434262945, 6820.7271709133065, 6851.588904665736, 7540.622968851426, 7930.801729956797, 8037.357011438954, 8051.637676304464, 8053.395995300493, 7946.642401091849, 8267.29727973129, 8296.917030829856, 8346.12365701617, 8350.540720260444, 5615.887035967182, 5680.602357834912, 6008.098785182257, 6530.183727034121, 6668.06647069401, 6433.0, 6473.935260647333, 6481.287058423664, 6912.343327383891, 6914.101166848278, 6289.339619339903, 6331.683415829282, 6458.063580780855, 6468.902966455601, 6469.191351081115, 6019.157317975574, 6335.334789847, 6396.71214795326, 6442.549021568445, 6493.577917435352, 6849.931500685128, 6899.206591242071, 6901.689423976033, 6903.309669033057, 6917.100776898971, 6186.4741496973265, 6231.813045608639, 6245.18812554365, 6267.843303917439, 6269.780557680459, 6261.7182226799, 6380.521460890544, 6380.712867921047, 6381.904271435839, 6397.488200943821], "unit": "score", "name": "mootools.html", "value": 4288.693412158141}, {"lowerIsBetter": false, "replicates": [312.71386681186715, 322.18005176824977, 324.8570628923274, 326.3277648045027, 331.6302322909955, 5221.321228240328, 5302.549283310918, 5331.546818520421, 5332.040232758102, 5332.280142180804, 5220.425753167148, 5224.268602395668, 5233.502817232366, 5234.031704134728, 5241.056609810242, 3907.960920390802, 4036.515618125829, 4082.2856000199995, 4108.712390132692, 4156.896077598061, 4124.175164967003, 4146.025683964266, 4146.357314616239, 4149.937750933738, 4153.979230103845, 4103.97948010261, 4110.342345224764, 4110.650594699439, 4116.608922152391, 4117.46472958515, 3939.4681717968137, 4009.518857737061, 4100.0569868930015, 4111.588841115865, 4114.670826333886, 3640.9453858192146, 3642.3807952648112, 3645.6172101929446, 3648.7810731356203, 3652.721547458395, 4979.950200498021, 5022.221555658879, 5034.446210916796, 5036.647434679574, 5054.74726263689, 4717.787699553528, 4734.124187025412, 4768.284757286435, 4775.952240477585, 4776.737279449629, 5541.0580201365865, 5544.140658197985, 5550.805721799758, 5560.916586251209, 5561.63849349791, 4016.9196616067516, 4020.43713880057, 4025.7383270087353, 4026.355783074723, 4029.207002883718, 5607.439256074401, 5755.68343741094, 5775.335836378828, 5851.3270973838125, 5853.209816674737, 3921.176552923918, 3966.8413263469715, 3975.0658595230097, 3976.58245884178, 3977.2244412339314, 4028.4158796974275, 4031.9193616127513, 4035.2534781065597, 4036.990752311922, 4037.6366127048705, 4628.930566041512, 4636.049609829976, 4636.884077898079, 4637.582617564368, 4643.698159619681, 5561.110222364402, 5566.972165139148, 5573.721313934287, 5574.414686457863, 5578.609497335147, 1391.0610338021997, 1394.1844021247482, 1394.2401391241797, 1394.4770710983382, 1394.5607133753037, 894.2443635128307, 901.4951627088851, 913.0413066280512, 942.34036174678, 949.6676163342913, 4755.762211889391, 4787.712737235777, 4828.0, 4837.564619184291, 4847.200211964986, 5793.044147715664, 5795.478406943311, 5796.47831695141, 5798.275215598051, 5804.796832110856, 4908.828191013369, 4913.0, 4914.852554423373, 4918.090153321576, 4920.975395123001, 3049.786514943977, 3091.536269559584, 3096.256898344381, 3097.148284221857, 3103.9844800776305, 5460.6996615186545, 5473.0969390050195, 5477.397486276506, 5480.725963701799, 5481.451854814487, 5767.279090113736, 5944.316403613553, 5987.491063259585, 6015.368386319461, 6020.036794112921, 5451.945480545223, 5468.781248750085, 5472.753726082256, 5477.452254774491, 5482.890342193214, 5772.7402266898935, 5790.305163380422, 5797.652140871562, 5797.797077102281, 5804.24544809189, 5648.63283886546, 5655.095184770417, 5656.886862262814, 5658.434156584473, 5664.745086471036, 5458.699771512446, 5463.508284254436, 5464.0, 5473.0969390050195, 5475.06923822959, 3874.8643797466952, 4008.4187792769303, 4010.3583426651594, 4019.3569028955226, 4029.6373326400767, 5747.0, 5757.193992840922, 5762.625429347079, 5763.645543297405, 5764.971175144097, 5573.136163894603, 5574.331080270394, 5578.525825304732, 5580.776768929198, 5584.4136365681015, 5543.473370029841, 5562.860928476821, 5565.860853478695, 5566.832995010156, 5577.3028371453565, 5475.479829416199, 5477.945220547744, 5480.588955828249, 5487.067198576172, 5495.862603434786, 5432.158015507603, 5583.916241256466, 5588.385277619377, 5606.747696353592, 5612.719364031864, 5407.242985981887, 5442.482964118402, 5442.619016668795, 5443.891122177613, 5455.1271796512365], "unit": "score", "name": "prototype.html", "value": 4184.723139337617}, {"lowerIsBetter": false, "replicates": [656.8226578823718, 676.2730065179927, 771.1132197972331, 781.7771934998523, 807.463037080342, 12618.0, 12731.0, 12749.10756247063, 12754.426050827711, 12788.68028299293, 11238.719032024204, 11245.943770281157, 11249.381284029376, 11289.661310160687, 11294.943525282382, 644.7936660268692, 781.2812212764242, 808.3088958940081, 811.0672726364699, 813.4915677701437, 800.7677773445694, 809.9271065604095, 810.2869474862142, 810.4043528006939, 811.6996711216858, 856.9700060497884, 859.6088779605265, 862.706679728892, 864.3560547392202, 864.965401383947, 682.3006418421108, 841.9115992820726, 847.4491580472711, 850.9234168924795, 852.846487632226, 630.4231628060319, 631.084926856056, 631.8072987738738, 632.0361448790585, 632.3139393757779, 12233.755324893453, 12244.510219591206, 12248.0, 12275.877241227563, 12295.262284262973, 12067.275963442135, 12598.244105353617, 12695.936520317431, 12702.682432939158, 12856.678583035406, 9752.122308992153, 9913.504324783731, 9914.355566888129, 9919.107280344731, 10122.190224782, 3331.0839519132433, 3357.6642335766473, 3402.0984439123654, 3443.5523381960434, 3469.930601387983, 40435.595644043475, 43121.0, 43286.0, 43605.56394436047, 43707.562924370985, 9691.370060946158, 9835.114839664464, 9903.059209375098, 9919.85921619023, 9970.351927124713, 16502.917485412498, 16559.586010349838, 16585.585360365847, 16585.585360366087, 16738.581535461468, 6467.805965821033, 6672.399484046459, 6700.83247918806, 6788.796336109925, 7027.578345299298, 3760.4735337052834, 3771.73597848148, 3774.226283611853, 3797.1076796952693, 3831.904202394907, 2890.36411989362, 2893.4647090287945, 2894.942101157965, 2896.218021134282, 2913.548399998004, 511.2127323921194, 525.1361510315586, 526.1450143516785, 527.9757270894453, 529.7695502456444, 429.2552421548611, 620.1472974659843, 623.2147494157394, 627.3976982097147, 645.2353960556756, 7907.288344049063, 7933.8413231736195, 8042.0, 8063.879041814377, 8211.83576328482, 643.7650804706294, 644.3427703742157, 661.8940969444963, 673.6059405247985, 680.9182898052266, 3524.4360902255517, 3713.535808023997, 3781.3760729479877, 3874.786886721201, 3935.980320098381, 50125.0, 50242.995140096995, 50683.23975140376, 51297.487025129274, 51457.48542514527, 44501.0, 44943.0, 45188.77405613017, 45661.315080273824, 45905.0, 39651.603483965366, 39761.40357894634, 40524.3921341186, 40854.0, 40885.38671919923, 7134.143902731706, 7506.13679426851, 7622.237776222333, 7645.88531172044, 7723.961380193063, 29387.55918661179, 29581.408371832873, 30359.544606831358, 30924.536131958488, 30972.845135774176, 35142.47286290759, 35566.11084722903, 35624.93125206248, 38832.6116738829, 39608.60391396049, 10133.13868321201, 10521.842172367267, 10559.260851740304, 10748.946255268673, 10985.340879547253, 11650.0, 11833.52665893389, 11845.0, 11954.880451195724, 11990.220635658654, 11215.271007384821, 11411.714707132389, 11632.360220187971, 11726.355050472306, 11829.290242585472, 11168.274062185932, 11206.215564910379, 11575.594854180063, 11613.419329033684, 11618.767624647291, 11084.445777711244, 11241.943790280997, 11498.13763967689, 11562.710932226762, 11885.524579017088, 9435.858462123211, 9648.2781213702, 9727.65953191635, 10034.0, 10224.948875255874, 9057.550791873533, 9865.901340986786, 9881.901180988098, 9888.456134912361, 10018.0], "unit": "score", "name": "yui.html", "value": 5935.278441459517}], "name": "dromaeo_css", "value": 6336.591227093293}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [110.0, 111.0, 106.0, 110.0, 112.0, 112.0, 101.0, 111.0, 110.0, 111.0], "unit": "score", "name": "ai-astar", "value": 109.4}, {"lowerIsBetter": true, "replicates": [163.0, 134.0, 163.0, 193.0, 132.0, 164.0, 154.0, 137.0, 191.0, 132.0], "unit": "score", "name": "audio-beat-detection", "value": 156.3}, {"lowerIsBetter": true, "replicates": [162.0, 163.0, 162.0, 161.0, 162.0, 164.0, 161.0, 161.0, 164.0, 163.0], "unit": "score", "name": "audio-dft", "value": 162.3}, {"lowerIsBetter": true, "replicates": [73.0, 74.0, 98.0, 105.0, 74.0, 73.0, 76.0, 115.0, 104.0, 73.0], "unit": "score", "name": "audio-fft", "value": 86.5}, {"lowerIsBetter": true, "replicates": [94.0, 94.0, 137.0, 93.0, 94.0, 94.0, 137.0, 95.0, 95.0, 138.0], "unit": "score", "name": "audio-oscillator", "value": 107.1}, {"lowerIsBetter": true, "replicates": [117.0, 117.0, 117.0, 117.0, 117.0, 117.0, 117.0, 117.0, 117.0, 117.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 117.0}, {"lowerIsBetter": true, "replicates": [146.0, 148.0, 146.0, 146.0, 145.0, 145.0, 145.0, 146.0, 146.0, 146.0], "unit": "score", "name": "imaging-darkroom", "value": 145.9}, {"lowerIsBetter": true, "replicates": [95.0, 95.0, 95.0, 95.0, 95.0, 95.0, 95.0, 96.0, 95.0, 95.0], "unit": "score", "name": "imaging-desaturate", "value": 95.1}, {"lowerIsBetter": true, "replicates": [64.0, 66.0, 66.0, 65.0, 64.0, 66.0, 73.0, 83.0, 63.0, 63.0], "unit": "score", "name": "json-parse-financial", "value": 67.3}, {"lowerIsBetter": true, "replicates": [63.0, 63.0, 65.0, 64.0, 64.0, 68.0, 64.0, 63.0, 64.0, 65.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 64.3}, {"lowerIsBetter": true, "replicates": [80.0, 82.0, 82.0, 85.0, 81.0, 83.0, 82.0, 82.0, 80.0, 82.0], "unit": "score", "name": "stanford-crypto-aes", "value": 81.9}, {"lowerIsBetter": true, "replicates": [117.0, 128.0, 118.0, 119.0, 118.0, 127.0, 121.0, 121.0, 116.0, 115.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 120.0}, {"lowerIsBetter": true, "replicates": [143.0, 141.0, 155.0, 142.0, 142.0, 130.0, 144.0, 143.0, 143.0, 142.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 142.5}, {"lowerIsBetter": true, "replicates": [73.0, 70.0, 68.0, 68.0, 70.0, 69.0, 69.0, 66.0, 67.0, 66.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 68.6}], "name": "kraken", "value": 1524.2}]} 07:57:18 INFO - Return code: 0 07:57:18 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 07:57:18 ERROR - # TBPL SUCCESS # 07:57:18 INFO - Running post-action listener: _resource_record_post_action 07:57:18 INFO - Running post-run listener: _resource_record_post_run 07:57:19 INFO - Total resource usage - Wall time: 1198s; CPU: 13.0%; Read bytes: 4096; Write bytes: 282312704; Read time: 16; Write time: 211992 07:57:19 INFO - install - Wall time: 16s; CPU: 13.0%; Read bytes: 0; Write bytes: 6508544; Read time: 0; Write time: 904 07:57:19 INFO - run-tests - Wall time: 1182s; CPU: 13.0%; Read bytes: 4096; Write bytes: 275804160; Read time: 16; Write time: 211088 07:57:19 INFO - Running post-run listener: _upload_blobber_files 07:57:19 INFO - Blob upload gear active. 07:57:19 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 07:57:19 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 07:57:19 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Fx-Team-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 07:57:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Fx-Team-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 07:57:20 INFO - (blobuploader) - INFO - Open directory for files ... 07:57:20 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 07:57:20 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 07:57:20 INFO - (blobuploader) - INFO - Uploading, attempt #1. 07:57:21 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 07:57:21 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 07:57:21 INFO - (blobuploader) - INFO - Done attempting. 07:57:21 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 07:57:21 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 07:57:21 INFO - (blobuploader) - INFO - Uploading, attempt #1. 07:57:22 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 07:57:22 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 07:57:22 INFO - (blobuploader) - INFO - Done attempting. 07:57:22 INFO - (blobuploader) - INFO - Iteration through files over. 07:57:22 INFO - Return code: 0 07:57:22 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 07:57:22 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 07:57:22 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/4234341f93377811f6428faa837c05a63def3ce56546a28c94b53f3876f086577e07f3be6b29a142459d4e906358b775a070e2c039ac7cd0b7b5fe745624e690", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/8dc9dc577c1f80956b146fb0faa3e8467178f6f134157077c18066e5f25750a03d4e7352d9fa2f3ef6c7ce7b1509ff8eb0b08592783cc3dc5eb20bf086cbb84b"} 07:57:22 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 07:57:22 INFO - Writing to file /builds/slave/test/properties/blobber_files 07:57:22 INFO - Contents: 07:57:22 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/4234341f93377811f6428faa837c05a63def3ce56546a28c94b53f3876f086577e07f3be6b29a142459d4e906358b775a070e2c039ac7cd0b7b5fe745624e690", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/8dc9dc577c1f80956b146fb0faa3e8467178f6f134157077c18066e5f25750a03d4e7352d9fa2f3ef6c7ce7b1509ff8eb0b08592783cc3dc5eb20bf086cbb84b"} 07:57:22 INFO - Running post-run listener: copy_logs_to_upload_dir 07:57:22 INFO - Copying logs to upload dir... 07:57:22 INFO - mkdir: /builds/slave/test/build/upload/logs 07:57:22 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1282.331871 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 22 secs) (at 2016-04-01 07:57:22.154955) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-01 07:57:22.158706) ========= 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=9c43b49b387003dc8f5b4e5c000001c4-1459521038.882658-1739113132 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/4234341f93377811f6428faa837c05a63def3ce56546a28c94b53f3876f086577e07f3be6b29a142459d4e906358b775a070e2c039ac7cd0b7b5fe745624e690", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/8dc9dc577c1f80956b146fb0faa3e8467178f6f134157077c18066e5f25750a03d4e7352d9fa2f3ef6c7ce7b1509ff8eb0b08592783cc3dc5eb20bf086cbb84b"} build_url:https://queue.taskcluster.net/v1/task/FDmwgmkSTwu_rQq4LRc-oA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011524 build_url: 'https://queue.taskcluster.net/v1/task/FDmwgmkSTwu_rQq4LRc-oA/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/4234341f93377811f6428faa837c05a63def3ce56546a28c94b53f3876f086577e07f3be6b29a142459d4e906358b775a070e2c039ac7cd0b7b5fe745624e690", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/8dc9dc577c1f80956b146fb0faa3e8467178f6f134157077c18066e5f25750a03d4e7352d9fa2f3ef6c7ce7b1509ff8eb0b08592783cc3dc5eb20bf086cbb84b"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-01 07:57:22.185507) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-01 07:57:22.185839) ========= 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=9c43b49b387003dc8f5b4e5c000001c4-1459521038.882658-1739113132 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004431 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-01 07:57:22.271314) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-01 07:57:22.271680) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-01 07:57:22.272043) ========= ========= Total master_lag: 0.29 =========