builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-047 starttime: 1460599666.44 results: success (0) buildid: 20160413184655 builduid: e019b49d120e47129b86f5c94743fb29 revision: f6fe48816b24556b76f34e7e3ec9713a439bb191 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-04-13 19:07:46.441349) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-04-13 19:07:46.441770) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-04-13 19:07:46.442053) ========= 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=03627c79f6bb3d1578c4a402000001ba-1460594001.820813-1409371344 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test program finished with exit code 0 elapsedTime=0.006403 basedir: '/builds/slave/test' ========= master_lag: 0.03 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-04-13 19:07:46.481208) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-13 19:07:46.481504) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-13 19:07:46.526152) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-13 19:07:46.526558) ========= 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=03627c79f6bb3d1578c4a402000001ba-1460594001.820813-1409371344 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004595 ========= master_lag: 0.06 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-13 19:07:46.589991) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-04-13 19:07:46.590321) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-04-13 19:07:46.590683) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-13 19:07:46.590956) ========= 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=03627c79f6bb3d1578c4a402000001ba-1460594001.820813-1409371344 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-04-13 19:07:46-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 226M=0s 2016-04-13 19:07:46 (226 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.205785 ========= master_lag: 0.05 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-13 19:07:46.849111) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-13 19:07:46.849597) ========= 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=03627c79f6bb3d1578c4a402000001ba-1460594001.820813-1409371344 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.062247 ========= master_lag: 0.11 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-13 19:07:47.020185) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-13 19:07:47.020662) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev f6fe48816b24556b76f34e7e3ec9713a439bb191 --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 f6fe48816b24556b76f34e7e3ec9713a439bb191 --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=03627c79f6bb3d1578c4a402000001ba-1460594001.820813-1409371344 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-04-13 19:07:47,151 truncating revision to first 12 chars 2016-04-13 19:07:47,151 Setting DEBUG logging. 2016-04-13 19:07:47,151 attempt 1/10 2016-04-13 19:07:47,151 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/f6fe48816b24?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-04-13 19:07:47,672 unpacking tar archive at: fx-team-f6fe48816b24/testing/mozharness/ program finished with exit code 0 elapsedTime=0.811691 ========= master_lag: 0.04 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-13 19:07:47.871449) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-13 19:07:47.871781) ========= echo f6fe48816b24556b76f34e7e3ec9713a439bb191 in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'f6fe48816b24556b76f34e7e3ec9713a439bb191'] 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=03627c79f6bb3d1578c4a402000001ba-1460594001.820813-1409371344 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False f6fe48816b24556b76f34e7e3ec9713a439bb191 program finished with exit code 0 elapsedTime=0.004291 script_repo_revision: 'f6fe48816b24556b76f34e7e3ec9713a439bb191' ========= master_lag: 0.05 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-13 19:07:47.921742) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-13 19:07:47.922047) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-13 19:07:47.931588) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 49 secs) (at 2016-04-13 19:07:47.931866) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --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-e10s', '--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=03627c79f6bb3d1578c4a402000001ba-1460594001.820813-1409371344 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 19:07:48 INFO - MultiFileLogger online at 20160413 19:07:48 in /builds/slave/test 19:07:48 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --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 19:07:48 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 19:07:48 INFO - {'append_to_log': False, 19:07:48 INFO - 'base_work_dir': '/builds/slave/test', 19:07:48 INFO - 'blob_upload_branch': 'Fx-Team-Non-PGO', 19:07:48 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 19:07:48 INFO - 'branch': 'Fx-Team-Non-PGO', 19:07:48 INFO - 'buildbot_json_path': 'buildprops.json', 19:07:48 INFO - 'config_files': ('talos/linux_config.py',), 19:07:48 INFO - 'default_actions': ('clobber', 19:07:48 INFO - 'read-buildbot-config', 19:07:48 INFO - 'download-and-extract', 19:07:48 INFO - 'populate-webroot', 19:07:48 INFO - 'create-virtualenv', 19:07:48 INFO - 'install', 19:07:48 INFO - 'run-tests'), 19:07:48 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 19:07:48 INFO - 'download_minidump_stackwalk': True, 19:07:48 INFO - 'download_symbols': 'ondemand', 19:07:48 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 19:07:48 INFO - 'tooltool.py': '/tools/tooltool.py', 19:07:48 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 19:07:48 INFO - '/tools/misc-python/virtualenv.py')}, 19:07:48 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 19:07:48 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 19:07:48 INFO - 'installer_path': 'installer.exe', 19:07:48 INFO - 'log_level': 'info', 19:07:48 INFO - 'log_name': 'talos', 19:07:48 INFO - 'log_to_console': True, 19:07:48 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 19:07:48 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 19:07:48 INFO - 'opt_config_files': (), 19:07:48 INFO - 'pip_index': False, 19:07:48 INFO - 'sps_profile': False, 19:07:48 INFO - 'sps_profile_interval': 0, 19:07:48 INFO - 'suite': 'dromaeojs-e10s', 19:07:48 INFO - 'system_bits': '32', 19:07:48 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 19:07:48 INFO - 'title': 'talos-linux64-ix-047', 19:07:48 INFO - 'tooltool_cache': '/builds/tooltool_cache', 19:07:48 INFO - 'use_talos_json': True, 19:07:48 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 19:07:48 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 19:07:48 INFO - 'work_dir': 'build'} 19:07:48 INFO - ##### 19:07:48 INFO - ##### Running clobber step. 19:07:48 INFO - ##### 19:07:48 INFO - Running pre-action listener: _resource_record_pre_action 19:07:48 INFO - Running main action method: clobber 19:07:48 INFO - rmtree: /builds/slave/test/build 19:07:48 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 19:07:49 INFO - Running post-action listener: _resource_record_post_action 19:07:49 INFO - ##### 19:07:49 INFO - ##### Running read-buildbot-config step. 19:07:49 INFO - ##### 19:07:49 INFO - Running pre-action listener: _resource_record_pre_action 19:07:49 INFO - Running main action method: read_buildbot_config 19:07:49 INFO - Using buildbot properties: 19:07:49 INFO - { 19:07:49 INFO - "project": "", 19:07:49 INFO - "product": "firefox", 19:07:49 INFO - "script_repo_revision": "production", 19:07:49 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 19:07:49 INFO - "repository": "", 19:07:49 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team talos dromaeojs-e10s", 19:07:49 INFO - "buildid": "20160413184655", 19:07:49 INFO - "pgo_build": "False", 19:07:49 INFO - "basedir": "/builds/slave/test", 19:07:49 INFO - "buildnumber": 1140, 19:07:49 INFO - "slavename": "talos-linux64-ix-047", 19:07:49 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 19:07:49 INFO - "platform": "ubuntu64_hw", 19:07:49 INFO - "scheduler": "tests-fx-team-linux64-talos", 19:07:49 INFO - "branch": "fx-team", 19:07:49 INFO - "repo_path": "integration/fx-team", 19:07:49 INFO - "revision": "f6fe48816b24556b76f34e7e3ec9713a439bb191", 19:07:49 INFO - "stage_platform": "linux64", 19:07:49 INFO - "builduid": "e019b49d120e47129b86f5c94743fb29", 19:07:49 INFO - "slavebuilddir": "test" 19:07:49 INFO - } 19:07:49 INFO - Found installer url https://queue.taskcluster.net/v1/task/AE8TDcyfQayrCyyQaRTJSQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2. 19:07:49 INFO - Running post-action listener: _resource_record_post_action 19:07:49 INFO - ##### 19:07:49 INFO - ##### Running download-and-extract step. 19:07:49 INFO - ##### 19:07:49 INFO - Running pre-action listener: _resource_record_pre_action 19:07:49 INFO - Running main action method: download_and_extract 19:07:49 INFO - mkdir: /builds/slave/test/build/tests 19:07:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:07:49 INFO - https://queue.taskcluster.net/v1/task/AE8TDcyfQayrCyyQaRTJSQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 19:07:49 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AE8TDcyfQayrCyyQaRTJSQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 19:07:49 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AE8TDcyfQayrCyyQaRTJSQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 19:07:49 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AE8TDcyfQayrCyyQaRTJSQ/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 19:07:49 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AE8TDcyfQayrCyyQaRTJSQ/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 19:07:54 INFO - Downloaded 1361 bytes. 19:07:54 INFO - Reading from file /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 19:07:54 INFO - Using the following test package requirements: 19:07:54 INFO - {u'common': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'], 19:07:54 INFO - u'cppunittest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 19:07:54 INFO - u'firefox-48.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 19:07:54 INFO - u'gtest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 19:07:54 INFO - u'firefox-48.0a1.en-US.linux-x86_64.gtest.tests.zip'], 19:07:54 INFO - u'jittest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 19:07:54 INFO - u'jsshell-linux-x86_64.zip'], 19:07:54 INFO - u'mochitest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 19:07:54 INFO - u'firefox-48.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 19:07:54 INFO - u'mozbase': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'], 19:07:54 INFO - u'reftest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 19:07:54 INFO - u'firefox-48.0a1.en-US.linux-x86_64.reftest.tests.zip'], 19:07:54 INFO - u'talos': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 19:07:54 INFO - u'firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'], 19:07:54 INFO - u'web-platform': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 19:07:54 INFO - u'firefox-48.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 19:07:54 INFO - u'xpcshell': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 19:07:54 INFO - u'firefox-48.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 19:07:54 INFO - Downloading packages: [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 19:07:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:07:54 INFO - https://queue.taskcluster.net/v1/task/AE8TDcyfQayrCyyQaRTJSQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 19:07:54 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AE8TDcyfQayrCyyQaRTJSQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 19:07:54 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AE8TDcyfQayrCyyQaRTJSQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 19:07:54 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AE8TDcyfQayrCyyQaRTJSQ/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 19:07:54 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AE8TDcyfQayrCyyQaRTJSQ/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 19:07:58 INFO - Downloaded 22203341 bytes. 19:07:58 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'] 19:07:58 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 19:08:00 INFO - Return code: 0 19:08:00 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 19:08:00 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')]} 19:08:00 INFO - https://queue.taskcluster.net/v1/task/AE8TDcyfQayrCyyQaRTJSQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 19:08:00 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AE8TDcyfQayrCyyQaRTJSQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 19:08:00 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AE8TDcyfQayrCyyQaRTJSQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 19:08:00 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AE8TDcyfQayrCyyQaRTJSQ/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 19:08:00 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AE8TDcyfQayrCyyQaRTJSQ/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 19:08:07 INFO - Downloaded 22203341 bytes. 19:08:07 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'] 19:08:07 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 19:08:09 INFO - Return code: 0 19:08: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')]} 19:08:09 INFO - https://queue.taskcluster.net/v1/task/AE8TDcyfQayrCyyQaRTJSQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 19:08:09 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AE8TDcyfQayrCyyQaRTJSQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 19:08:09 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AE8TDcyfQayrCyyQaRTJSQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 19:08:09 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AE8TDcyfQayrCyyQaRTJSQ/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 19:08:09 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AE8TDcyfQayrCyyQaRTJSQ/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 19:08:10 INFO - Downloaded 10841076 bytes. 19:08:10 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'] 19:08:10 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 19:08:10 INFO - Return code: 0 19:08:10 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')]} 19:08:10 INFO - https://queue.taskcluster.net/v1/task/AE8TDcyfQayrCyyQaRTJSQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 19:08:10 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AE8TDcyfQayrCyyQaRTJSQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 19:08:10 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AE8TDcyfQayrCyyQaRTJSQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 19:08:10 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AE8TDcyfQayrCyyQaRTJSQ/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 19:08:10 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AE8TDcyfQayrCyyQaRTJSQ/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 19:08:11 INFO - Downloaded 54165826 bytes. 19:08:11 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/AE8TDcyfQayrCyyQaRTJSQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 19:08:11 INFO - mkdir: /builds/slave/test/properties 19:08:11 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 19:08:11 INFO - Writing to file /builds/slave/test/properties/build_url 19:08:11 INFO - Contents: 19:08:11 INFO - build_url:https://queue.taskcluster.net/v1/task/AE8TDcyfQayrCyyQaRTJSQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 19:08:12 INFO - Running post-action listener: _resource_record_post_action 19:08:12 INFO - Running post-action listener: set_extra_try_arguments 19:08:12 INFO - ##### 19:08:12 INFO - ##### Running populate-webroot step. 19:08:12 INFO - ##### 19:08:12 INFO - Running pre-action listener: _resource_record_pre_action 19:08:12 INFO - Running main action method: populate_webroot 19:08:12 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 19:08:12 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 19:08:12 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 19:08:12 INFO - '--tppagecycles', 19:08:12 INFO - '7'], 19:08:12 INFO - 'tests': ['tsvgm']}}, 19:08:12 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 19:08:12 INFO - 'tests': ['tresize', 'tcanvasmark']}, 19:08:12 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 19:08:12 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 19:08:12 INFO - 'tests': ['dromaeo_css', 'kraken']}, 19:08:12 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 19:08:12 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:08:12 INFO - 'talos_options': ['--disable-e10s'], 19:08:12 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 19:08:12 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:08:12 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 19:08:12 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:08:12 INFO - 'talos_options': ['--disable-e10s'], 19:08:12 INFO - 'tests': ['damp', 'tps']}, 19:08:12 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:08:12 INFO - 'tests': ['damp', 'tps']}, 19:08:12 INFO - 'g3': {'talos_options': ['--disable-e10s'], 19:08:12 INFO - 'tests': ['dromaeo_dom']}, 19:08:12 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 19:08:12 INFO - 'other': {'talos_options': ['--disable-e10s'], 19:08:12 INFO - 'tests': ['a11yr', 19:08:12 INFO - 'ts_paint', 19:08:12 INFO - 'tpaint', 19:08:12 INFO - 'sessionrestore', 19:08:12 INFO - 'sessionrestore_no_auto_restore', 19:08:12 INFO - 'tabpaint']}, 19:08:12 INFO - 'other-e10s': {'tests': ['a11yr', 19:08:12 INFO - 'ts_paint', 19:08:12 INFO - 'tpaint', 19:08:12 INFO - 'sessionrestore', 19:08:12 INFO - 'sessionrestore_no_auto_restore', 19:08:12 INFO - 'tabpaint']}, 19:08:12 INFO - 'other-e10s_l64': {'tests': ['a11yr', 19:08:12 INFO - 'ts_paint', 19:08:12 INFO - 'tpaint', 19:08:12 INFO - 'sessionrestore', 19:08:12 INFO - 'sessionrestore_no_auto_restore', 19:08:12 INFO - 'tabpaint']}, 19:08:12 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 19:08:12 INFO - 'ts_paint', 19:08:12 INFO - 'tpaint', 19:08:12 INFO - 'sessionrestore', 19:08:12 INFO - 'sessionrestore_no_auto_restore', 19:08:12 INFO - 'tabpaint']}, 19:08:12 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 19:08:12 INFO - 'tests': ['a11yr', 19:08:12 INFO - 'ts_paint', 19:08:12 INFO - 'tpaint', 19:08:12 INFO - 'sessionrestore', 19:08:12 INFO - 'sessionrestore_no_auto_restore', 19:08:12 INFO - 'tabpaint']}, 19:08:12 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 19:08:12 INFO - 'tests': ['a11yr', 19:08:12 INFO - 'ts_paint', 19:08:12 INFO - 'tpaint', 19:08:12 INFO - 'sessionrestore', 19:08:12 INFO - 'sessionrestore_no_auto_restore', 19:08:12 INFO - 'tabpaint']}, 19:08:12 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 19:08:12 INFO - 'tests': ['tsvgx', 19:08:12 INFO - 'tsvgr_opacity', 19:08:12 INFO - 'tart', 19:08:12 INFO - 'tscrollx', 19:08:12 INFO - 'cart']}, 19:08:12 INFO - 'svgr-e10s': {'tests': ['tsvgx', 19:08:12 INFO - 'tsvgr_opacity', 19:08:12 INFO - 'tart', 19:08:12 INFO - 'tscrollx', 19:08:12 INFO - 'cart']}, 19:08:12 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:08:12 INFO - 'talos_options': ['--disable-e10s'], 19:08:12 INFO - 'tests': ['tp5o']}, 19:08:12 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:08:12 INFO - 'tests': ['tp5o']}, 19:08:12 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:08:12 INFO - 'talos_options': ['--disable-e10s', 19:08:12 INFO - '--xperf_path', 19:08:12 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 19:08:12 INFO - 'tests': ['tp5n']}, 19:08:12 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:08:12 INFO - 'talos_options': ['--xperf_path', 19:08:12 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 19:08:12 INFO - 'tests': ['tp5n']}}, 19:08:12 INFO - 'talos.zip': {'path': '', 19:08:12 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 19:08:12 INFO - Running post-action listener: _resource_record_post_action 19:08:12 INFO - ##### 19:08:12 INFO - ##### Running create-virtualenv step. 19:08:12 INFO - ##### 19:08:12 INFO - Running pre-action listener: _resource_record_pre_action 19:08:12 INFO - Running main action method: create_virtualenv 19:08:12 INFO - Creating virtualenv /builds/slave/test/build/venv 19:08:12 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 19:08:12 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 19:08:12 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 19:08:12 INFO - Using real prefix '/usr' 19:08:12 INFO - New python executable in /builds/slave/test/build/venv/bin/python 19:08:13 INFO - Installing distribute.............................................................................................................................................................................................done. 19:08:15 INFO - Installing pip.................done. 19:08:15 INFO - Return code: 0 19:08:15 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 19:08:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:08:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:08:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:08:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:08:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:08:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:08:15 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 0x7f0bd3f5ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc4a8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd155a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xda4410>, '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 0xda5310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xda57a0>, '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': '03627c79f6bb3d1578c4a402000001ba-1460594001.820813-1409371344', '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 19:08:15 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 19:08:15 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 19:08:15 INFO - Using env: {'DISPLAY': ':0', 19:08:15 INFO - 'HOME': '/home/cltbld', 19:08:15 INFO - 'LANG': 'en_US.UTF-8', 19:08:15 INFO - 'LANGUAGE': 'en_US:en', 19:08:15 INFO - 'LOGNAME': 'cltbld', 19:08:15 INFO - 'MAIL': '/var/mail/cltbld', 19:08:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:08:15 INFO - 'MOZ_NO_REMOTE': '1', 19:08:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:08:15 INFO - 'NO_EM_RESTART': '1', 19:08:15 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:08:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:08:15 INFO - 'PWD': '/builds/slave/test', 19:08:15 INFO - 'SHELL': '/bin/bash', 19:08:15 INFO - 'SHLVL': '1', 19:08:15 INFO - 'TERM': 'linux', 19:08:15 INFO - 'TMOUT': '86400', 19:08:15 INFO - 'USER': 'cltbld', 19:08:15 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1460594001.820813-1409371344', 19:08:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:08:15 INFO - '_': '/tools/buildbot/bin/python'} 19:08:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:08:15 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 19:08:15 INFO - Cleaning up... 19:08:15 INFO - Return code: 0 19:08:15 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 19:08:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:08:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:08:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:08:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:08:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:08:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:08:15 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 0x7f0bd3f5ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc4a8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd155a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xda4410>, '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 0xda5310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xda57a0>, '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': '03627c79f6bb3d1578c4a402000001ba-1460594001.820813-1409371344', '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 19:08:15 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 19:08:15 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 19:08:15 INFO - Using env: {'DISPLAY': ':0', 19:08:15 INFO - 'HOME': '/home/cltbld', 19:08:15 INFO - 'LANG': 'en_US.UTF-8', 19:08:15 INFO - 'LANGUAGE': 'en_US:en', 19:08:15 INFO - 'LOGNAME': 'cltbld', 19:08:15 INFO - 'MAIL': '/var/mail/cltbld', 19:08:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:08:15 INFO - 'MOZ_NO_REMOTE': '1', 19:08:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:08:15 INFO - 'NO_EM_RESTART': '1', 19:08:15 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:08:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:08:15 INFO - 'PWD': '/builds/slave/test', 19:08:15 INFO - 'SHELL': '/bin/bash', 19:08:15 INFO - 'SHLVL': '1', 19:08:15 INFO - 'TERM': 'linux', 19:08:15 INFO - 'TMOUT': '86400', 19:08:15 INFO - 'USER': 'cltbld', 19:08:15 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1460594001.820813-1409371344', 19:08:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:08:15 INFO - '_': '/tools/buildbot/bin/python'} 19:08:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:08:15 INFO - Downloading/unpacking psutil>=0.7.1 19:08:15 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:08:15 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:08:15 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:08:15 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:08:15 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:08:15 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:08:17 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 19:08:17 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 19:08:17 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 19:08:17 INFO - Installing collected packages: psutil 19:08:17 INFO - Running setup.py install for psutil 19:08:17 INFO - building 'psutil._psutil_linux' extension 19:08:17 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 19:08:17 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 19:08:17 INFO - building 'psutil._psutil_posix' extension 19:08:17 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 19:08:17 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 19:08:17 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 19:08:17 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 19:08:17 INFO - Successfully installed psutil 19:08:17 INFO - Cleaning up... 19:08:18 INFO - Return code: 0 19:08:18 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 19:08:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:08:18 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:08:18 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:08:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:08:18 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:08:18 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:08:18 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 0x7f0bd3f5ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc4a8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd155a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xda4410>, '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 0xda5310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xda57a0>, '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': '03627c79f6bb3d1578c4a402000001ba-1460594001.820813-1409371344', '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 19:08:18 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 19:08:18 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 19:08:18 INFO - Using env: {'DISPLAY': ':0', 19:08:18 INFO - 'HOME': '/home/cltbld', 19:08:18 INFO - 'LANG': 'en_US.UTF-8', 19:08:18 INFO - 'LANGUAGE': 'en_US:en', 19:08:18 INFO - 'LOGNAME': 'cltbld', 19:08:18 INFO - 'MAIL': '/var/mail/cltbld', 19:08:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:08:18 INFO - 'MOZ_NO_REMOTE': '1', 19:08:18 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:08:18 INFO - 'NO_EM_RESTART': '1', 19:08:18 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:08:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:08:18 INFO - 'PWD': '/builds/slave/test', 19:08:18 INFO - 'SHELL': '/bin/bash', 19:08:18 INFO - 'SHLVL': '1', 19:08:18 INFO - 'TERM': 'linux', 19:08:18 INFO - 'TMOUT': '86400', 19:08:18 INFO - 'USER': 'cltbld', 19:08:18 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1460594001.820813-1409371344', 19:08:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:08:18 INFO - '_': '/tools/buildbot/bin/python'} 19:08:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:08:18 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 19:08: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 19:08: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 19:08: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 19:08: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 19:08: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 19:08: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 19:08:20 INFO - Downloading mozsystemmonitor-0.0.tar.gz 19:08:20 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 19:08:20 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 19:08:20 INFO - Installing collected packages: mozsystemmonitor 19:08:20 INFO - Running setup.py install for mozsystemmonitor 19:08:20 INFO - Successfully installed mozsystemmonitor 19:08:20 INFO - Cleaning up... 19:08:20 INFO - Return code: 0 19:08:20 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 19:08:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:08:20 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:08:20 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:08:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:08:20 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:08:20 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:08:20 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 0x7f0bd3f5ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc4a8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd155a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xda4410>, '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 0xda5310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xda57a0>, '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': '03627c79f6bb3d1578c4a402000001ba-1460594001.820813-1409371344', '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 19:08:20 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 19:08:20 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 19:08:20 INFO - Using env: {'DISPLAY': ':0', 19:08:20 INFO - 'HOME': '/home/cltbld', 19:08:20 INFO - 'LANG': 'en_US.UTF-8', 19:08:20 INFO - 'LANGUAGE': 'en_US:en', 19:08:20 INFO - 'LOGNAME': 'cltbld', 19:08:20 INFO - 'MAIL': '/var/mail/cltbld', 19:08:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:08:20 INFO - 'MOZ_NO_REMOTE': '1', 19:08:20 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:08:20 INFO - 'NO_EM_RESTART': '1', 19:08:20 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:08:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:08:20 INFO - 'PWD': '/builds/slave/test', 19:08:20 INFO - 'SHELL': '/bin/bash', 19:08:20 INFO - 'SHLVL': '1', 19:08:20 INFO - 'TERM': 'linux', 19:08:20 INFO - 'TMOUT': '86400', 19:08:20 INFO - 'USER': 'cltbld', 19:08:20 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1460594001.820813-1409371344', 19:08:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:08:20 INFO - '_': '/tools/buildbot/bin/python'} 19:08:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:08:20 INFO - Downloading/unpacking blobuploader==1.2.4 19:08:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:08:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:08:20 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:08:20 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:08:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:08:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:08:22 INFO - Downloading blobuploader-1.2.4.tar.gz 19:08:22 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 19:08:22 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 19:08:22 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 19:08:22 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 19:08:22 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 19:08:22 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 19:08:22 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 19:08:22 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 19:08:22 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 19:08:22 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 19:08:22 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 19:08:22 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 19:08:22 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 19:08:22 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 19:08:22 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 19:08:22 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 19:08:23 INFO - Downloading docopt-0.6.1.tar.gz 19:08:23 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 19:08:23 INFO - Installing collected packages: blobuploader, requests, docopt 19:08:23 INFO - Running setup.py install for blobuploader 19:08:23 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 19:08:23 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 19:08:23 INFO - Running setup.py install for requests 19:08:23 INFO - Running setup.py install for docopt 19:08:23 INFO - Successfully installed blobuploader requests docopt 19:08:23 INFO - Cleaning up... 19:08:23 INFO - Return code: 0 19:08:23 INFO - Installing None into virtualenv /builds/slave/test/build/venv 19:08:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:08:23 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:08:23 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:08:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:08:23 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:08:23 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:08:23 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 0x7f0bd3f5ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc4a8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd155a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xda4410>, '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 0xda5310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xda57a0>, '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': '03627c79f6bb3d1578c4a402000001ba-1460594001.820813-1409371344', '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 19:08:23 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 19:08:23 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 19:08:23 INFO - Using env: {'DISPLAY': ':0', 19:08:23 INFO - 'HOME': '/home/cltbld', 19:08:23 INFO - 'LANG': 'en_US.UTF-8', 19:08:23 INFO - 'LANGUAGE': 'en_US:en', 19:08:23 INFO - 'LOGNAME': 'cltbld', 19:08:23 INFO - 'MAIL': '/var/mail/cltbld', 19:08:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:08:23 INFO - 'MOZ_NO_REMOTE': '1', 19:08:23 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:08:23 INFO - 'NO_EM_RESTART': '1', 19:08:23 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:08:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:08:23 INFO - 'PWD': '/builds/slave/test', 19:08:23 INFO - 'SHELL': '/bin/bash', 19:08:23 INFO - 'SHLVL': '1', 19:08:23 INFO - 'TERM': 'linux', 19:08:23 INFO - 'TMOUT': '86400', 19:08:23 INFO - 'USER': 'cltbld', 19:08:23 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1460594001.820813-1409371344', 19:08:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:08:23 INFO - '_': '/tools/buildbot/bin/python'} 19:08:23 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:08:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 19:08:23 INFO - Running setup.py (path:/tmp/pip-xHcVdv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 19:08:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 19:08:24 INFO - Running setup.py (path:/tmp/pip-vYdkzq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 19:08:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 19:08:24 INFO - Running setup.py (path:/tmp/pip-KH4476-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 19:08:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 19:08:24 INFO - Running setup.py (path:/tmp/pip-wBNkf5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 19:08:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 19:08:24 INFO - Running setup.py (path:/tmp/pip-k2WIbF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 19:08:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 19:08:24 INFO - Running setup.py (path:/tmp/pip-a1FoC3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 19:08:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 19:08:24 INFO - Running setup.py (path:/tmp/pip-SWkKGR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 19:08:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 19:08:24 INFO - Running setup.py (path:/tmp/pip-x9O8oH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 19:08:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 19:08:24 INFO - Running setup.py (path:/tmp/pip-lVD4hn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 19:08:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 19:08:24 INFO - Running setup.py (path:/tmp/pip-qJuPcM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 19:08:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 19:08:24 INFO - Running setup.py (path:/tmp/pip-nsSpEi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 19:08:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 19:08:24 INFO - Running setup.py (path:/tmp/pip-UWJemL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 19:08:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 19:08:24 INFO - Running setup.py (path:/tmp/pip-WRbSFF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 19:08:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 19:08:24 INFO - Running setup.py (path:/tmp/pip-Oje7GX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 19:08:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 19:08:24 INFO - Running setup.py (path:/tmp/pip-V8vy_e-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 19:08:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 19:08:25 INFO - Running setup.py (path:/tmp/pip-neuITC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 19:08:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 19:08:25 INFO - Running setup.py (path:/tmp/pip-kwezgH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 19:08:25 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 19:08:25 INFO - Running setup.py install for manifestparser 19:08:25 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 19:08:25 INFO - Running setup.py install for mozcrash 19:08:25 INFO - Running setup.py install for mozdebug 19:08:25 INFO - Running setup.py install for mozdevice 19:08:25 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 19:08:25 INFO - Installing dm script to /builds/slave/test/build/venv/bin 19:08:25 INFO - Running setup.py install for mozfile 19:08:25 INFO - Running setup.py install for mozhttpd 19:08:25 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 19:08:25 INFO - Running setup.py install for mozinfo 19:08:25 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 19:08:25 INFO - Running setup.py install for mozInstall 19:08:25 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 19:08:25 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 19:08:25 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 19:08:25 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 19:08:25 INFO - Running setup.py install for mozleak 19:08:26 INFO - Running setup.py install for mozlog 19:08:26 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 19:08:26 INFO - Running setup.py install for moznetwork 19:08:26 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 19:08:26 INFO - Running setup.py install for mozprocess 19:08:26 INFO - Running setup.py install for mozprofile 19:08:26 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 19:08:26 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 19:08:26 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 19:08:26 INFO - Running setup.py install for mozrunner 19:08:26 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 19:08:26 INFO - Running setup.py install for mozscreenshot 19:08:26 INFO - Running setup.py install for moztest 19:08:26 INFO - Running setup.py install for mozversion 19:08:26 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 19:08:26 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 19:08:26 INFO - Cleaning up... 19:08:26 INFO - Return code: 0 19:08:26 INFO - Installing None into virtualenv /builds/slave/test/build/venv 19:08:26 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')]} 19:08:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:08:26 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:08:26 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')]} 19:08:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:08:26 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:08:26 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 0x7f0bd3f5ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc4a8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd155a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xda4410>, '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 0xda5310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xda57a0>, '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': '03627c79f6bb3d1578c4a402000001ba-1460594001.820813-1409371344', '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 19:08:26 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 19:08:26 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 19:08:26 INFO - Using env: {'DISPLAY': ':0', 19:08:26 INFO - 'HOME': '/home/cltbld', 19:08:26 INFO - 'LANG': 'en_US.UTF-8', 19:08:26 INFO - 'LANGUAGE': 'en_US:en', 19:08:26 INFO - 'LOGNAME': 'cltbld', 19:08:26 INFO - 'MAIL': '/var/mail/cltbld', 19:08:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:08:26 INFO - 'MOZ_NO_REMOTE': '1', 19:08:26 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:08:26 INFO - 'NO_EM_RESTART': '1', 19:08:26 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:08:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:08:26 INFO - 'PWD': '/builds/slave/test', 19:08:26 INFO - 'SHELL': '/bin/bash', 19:08:26 INFO - 'SHLVL': '1', 19:08:26 INFO - 'TERM': 'linux', 19:08:26 INFO - 'TMOUT': '86400', 19:08:26 INFO - 'USER': 'cltbld', 19:08:26 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1460594001.820813-1409371344', 19:08:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:08:26 INFO - '_': '/tools/buildbot/bin/python'} 19:08:27 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:08:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 19:08:27 INFO - Running setup.py (path:/tmp/pip-q9WT2p-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 19:08:27 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)) 19:08:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 19:08:27 INFO - Running setup.py (path:/tmp/pip-yDOSqO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 19:08:27 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)) 19:08:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 19:08:27 INFO - Running setup.py (path:/tmp/pip-PeEmBT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 19:08:27 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)) 19:08:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 19:08:27 INFO - Running setup.py (path:/tmp/pip-U40uBU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 19:08:27 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)) 19:08:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 19:08:27 INFO - Running setup.py (path:/tmp/pip-ydBJW0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 19:08:27 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)) 19:08:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 19:08:27 INFO - Running setup.py (path:/tmp/pip-hEYb88-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 19:08:27 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)) 19:08:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 19:08:27 INFO - Running setup.py (path:/tmp/pip-MLrGlW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 19:08:27 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)) 19:08:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 19:08:27 INFO - Running setup.py (path:/tmp/pip-XNhE4W-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 19:08:27 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)) 19:08:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 19:08:27 INFO - Running setup.py (path:/tmp/pip-Ka98lb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 19:08:27 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)) 19:08:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 19:08:27 INFO - Running setup.py (path:/tmp/pip-rbbhGZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 19:08:27 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)) 19:08:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 19:08:27 INFO - Running setup.py (path:/tmp/pip-fsuwyb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 19:08:27 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)) 19:08:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 19:08:27 INFO - Running setup.py (path:/tmp/pip-PhgCJF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 19:08:28 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)) 19:08:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 19:08:28 INFO - Running setup.py (path:/tmp/pip-B7tDLS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 19:08:28 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)) 19:08:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 19:08:28 INFO - Running setup.py (path:/tmp/pip-Lx_m83-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 19:08:28 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)) 19:08:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 19:08:28 INFO - Running setup.py (path:/tmp/pip-4Vipjt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 19:08:28 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)) 19:08:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 19:08:28 INFO - Running setup.py (path:/tmp/pip-QMGvqJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 19:08:28 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)) 19:08:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 19:08:28 INFO - Running setup.py (path:/tmp/pip-qaA50A-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 19:08:28 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)) 19:08:28 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)) 19:08:28 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)) 19:08:28 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)) 19:08:28 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)) 19:08:28 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)) 19:08:28 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 19:08:28 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 19:08:28 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 19:08:28 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 19:08:28 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 19:08:28 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 19:08:28 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 19:08:30 INFO - Downloading blessings-1.6.tar.gz 19:08:30 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 19:08:30 INFO - Installing collected packages: blessings 19:08:30 INFO - Running setup.py install for blessings 19:08:30 INFO - Successfully installed blessings 19:08:30 INFO - Cleaning up... 19:08:30 INFO - Return code: 0 19:08:30 INFO - Done creating virtualenv /builds/slave/test/build/venv. 19:08:30 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 19:08:30 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 19:08:30 INFO - Reading from file tmpfile_stdout 19:08:30 INFO - Current package versions: 19:08:30 INFO - argparse == 1.2.1 19:08:30 INFO - blessings == 1.6 19:08:30 INFO - blobuploader == 1.2.4 19:08:30 INFO - docopt == 0.6.1 19:08:30 INFO - manifestparser == 1.1 19:08:30 INFO - mozInstall == 1.12 19:08:30 INFO - mozcrash == 0.17 19:08:30 INFO - mozdebug == 0.1 19:08:30 INFO - mozdevice == 0.48 19:08:30 INFO - mozfile == 1.2 19:08:30 INFO - mozhttpd == 0.7 19:08:30 INFO - mozinfo == 0.9 19:08:30 INFO - mozleak == 0.1 19:08:30 INFO - mozlog == 3.1 19:08:30 INFO - moznetwork == 0.27 19:08:30 INFO - mozprocess == 0.22 19:08:30 INFO - mozprofile == 0.28 19:08:30 INFO - mozrunner == 6.11 19:08:30 INFO - mozscreenshot == 0.1 19:08:30 INFO - mozsystemmonitor == 0.0 19:08:30 INFO - moztest == 0.7 19:08:30 INFO - mozversion == 1.4 19:08:30 INFO - psutil == 3.1.1 19:08:30 INFO - requests == 1.2.3 19:08:30 INFO - wsgiref == 0.1.2 19:08:30 INFO - Installing None into virtualenv /builds/slave/test/build/venv 19:08:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:08:30 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:08:30 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:08:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:08:30 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:08:30 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:08:30 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 0x7f0bd3f5ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc4a8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd155a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xda4410>, '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 0xda5310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xda57a0>, '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': '03627c79f6bb3d1578c4a402000001ba-1460594001.820813-1409371344', '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 19:08:30 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 19:08:30 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 19:08:30 INFO - Using env: {'DISPLAY': ':0', 19:08:30 INFO - 'HOME': '/home/cltbld', 19:08:30 INFO - 'LANG': 'en_US.UTF-8', 19:08:30 INFO - 'LANGUAGE': 'en_US:en', 19:08:30 INFO - 'LOGNAME': 'cltbld', 19:08:30 INFO - 'MAIL': '/var/mail/cltbld', 19:08:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:08:30 INFO - 'MOZ_NO_REMOTE': '1', 19:08:30 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:08:30 INFO - 'NO_EM_RESTART': '1', 19:08:30 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:08:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:08:30 INFO - 'PWD': '/builds/slave/test', 19:08:30 INFO - 'SHELL': '/bin/bash', 19:08:30 INFO - 'SHLVL': '1', 19:08:30 INFO - 'TERM': 'linux', 19:08:30 INFO - 'TMOUT': '86400', 19:08:30 INFO - 'USER': 'cltbld', 19:08:30 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1460594001.820813-1409371344', 19:08:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:08:30 INFO - '_': '/tools/buildbot/bin/python'} 19:08:30 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:08:30 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)) 19:08:30 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)) 19:08:30 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)) 19:08:30 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)) 19:08:30 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)) 19:08:30 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)) 19:08:30 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)) 19:08:30 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)) 19:08:30 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)) 19:08:30 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)) 19:08:30 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)) 19:08:30 INFO - Cleaning up... 19:08:30 INFO - Return code: 0 19:08:30 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 19:08:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:08:30 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:08:30 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:08:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:08:30 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:08:30 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:08:30 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 0x7f0bd3f5ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc4a8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd155a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xda4410>, '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 0xda5310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xda57a0>, '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': '03627c79f6bb3d1578c4a402000001ba-1460594001.820813-1409371344', '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 19:08:30 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 19:08:30 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 19:08:30 INFO - Using env: {'DISPLAY': ':0', 19:08:30 INFO - 'HOME': '/home/cltbld', 19:08:30 INFO - 'LANG': 'en_US.UTF-8', 19:08:30 INFO - 'LANGUAGE': 'en_US:en', 19:08:30 INFO - 'LOGNAME': 'cltbld', 19:08:30 INFO - 'MAIL': '/var/mail/cltbld', 19:08:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:08:30 INFO - 'MOZ_NO_REMOTE': '1', 19:08:30 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:08:30 INFO - 'NO_EM_RESTART': '1', 19:08:30 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:08:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:08:30 INFO - 'PWD': '/builds/slave/test', 19:08:30 INFO - 'SHELL': '/bin/bash', 19:08:30 INFO - 'SHLVL': '1', 19:08:30 INFO - 'TERM': 'linux', 19:08:30 INFO - 'TMOUT': '86400', 19:08:30 INFO - 'USER': 'cltbld', 19:08:30 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1460594001.820813-1409371344', 19:08:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:08:30 INFO - '_': '/tools/buildbot/bin/python'} 19:08:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:08:31 INFO - Downloading/unpacking jsonschema 19:08:31 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 19:08:31 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 19:08:31 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 19:08:31 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 19:08:31 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 19:08:31 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 19:08:33 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 19:08:33 INFO - Downloading/unpacking functools32 (from jsonschema) 19:08:33 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 19:08:33 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 19:08:33 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 19:08:33 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 19:08:33 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 19:08:33 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 19:08:33 INFO - Downloading functools32-3.2.3-2.tar.gz 19:08:33 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 19:08:33 INFO - warning: no files found matching '*.txt' 19:08:33 INFO - no previously-included directories found matching 'build' 19:08:33 INFO - no previously-included directories found matching 'dist' 19:08:33 INFO - no previously-included directories found matching '.git*' 19:08:33 INFO - Installing collected packages: jsonschema, functools32 19:08:33 INFO - Running setup.py install for functools32 19:08:33 INFO - warning: no files found matching '*.txt' 19:08:33 INFO - no previously-included directories found matching 'build' 19:08:33 INFO - no previously-included directories found matching 'dist' 19:08:33 INFO - no previously-included directories found matching '.git*' 19:08:33 INFO - Successfully installed jsonschema functools32 19:08:33 INFO - Cleaning up... 19:08:33 INFO - Return code: 0 19:08:33 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 19:08: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')]} 19:08:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:08:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:08: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')]} 19:08:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:08:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:08:33 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 0x7f0bd3f5ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc4a8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd155a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xda4410>, '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 0xda5310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xda57a0>, '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': '03627c79f6bb3d1578c4a402000001ba-1460594001.820813-1409371344', '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 19:08:33 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 19:08:33 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 19:08:33 INFO - Using env: {'DISPLAY': ':0', 19:08:33 INFO - 'HOME': '/home/cltbld', 19:08:33 INFO - 'LANG': 'en_US.UTF-8', 19:08:33 INFO - 'LANGUAGE': 'en_US:en', 19:08:33 INFO - 'LOGNAME': 'cltbld', 19:08:33 INFO - 'MAIL': '/var/mail/cltbld', 19:08:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:08:33 INFO - 'MOZ_NO_REMOTE': '1', 19:08:33 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:08:33 INFO - 'NO_EM_RESTART': '1', 19:08:33 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:08:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:08:33 INFO - 'PWD': '/builds/slave/test', 19:08:33 INFO - 'SHELL': '/bin/bash', 19:08:33 INFO - 'SHLVL': '1', 19:08:33 INFO - 'TERM': 'linux', 19:08:33 INFO - 'TMOUT': '86400', 19:08:33 INFO - 'USER': 'cltbld', 19:08:33 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1460594001.820813-1409371344', 19:08:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:08:33 INFO - '_': '/tools/buildbot/bin/python'} 19:08:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:08:33 INFO - Downloading/unpacking flake8 19:08:33 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 19:08:33 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 19:08:33 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 19:08:33 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 19:08:33 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 19:08:33 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 19:08:35 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 19:08:35 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 19:08:35 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 19:08:35 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 19:08:35 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 19:08:35 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 19:08:35 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 19:08:35 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 19:08:35 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 19:08:35 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 19:08:35 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 19:08:35 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 19:08:35 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 19:08:35 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 19:08:35 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 19:08:35 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 19:08:35 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 19:08:35 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 19:08:35 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 19:08:35 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 19:08:36 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 19:08:36 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 19:08:36 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 19:08:36 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 19:08:36 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 19:08:36 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 19:08:36 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 19:08:36 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 19:08:36 INFO - no previously-included directories found matching 'docs/_build' 19:08:36 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 19:08:36 INFO - Running setup.py install for pep8 19:08:36 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 19:08:36 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 19:08:36 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 19:08:36 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 19:08:36 INFO - no previously-included directories found matching 'docs/_build' 19:08:36 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 19:08:36 INFO - Successfully installed flake8 mccabe pyflakes pep8 19:08:36 INFO - Cleaning up... 19:08:36 INFO - Return code: 0 19:08:36 INFO - Running post-action listener: _resource_record_post_action 19:08:36 INFO - Running post-action listener: _start_resource_monitoring 19:08:36 INFO - Starting resource monitoring. 19:08:36 INFO - ##### 19:08:36 INFO - ##### Running install step. 19:08:36 INFO - ##### 19:08:36 INFO - Running pre-action listener: _resource_record_pre_action 19:08:36 INFO - Running main action method: install 19:08:36 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 19:08:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 19:08:36 INFO - Reading from file tmpfile_stdout 19:08:36 INFO - Detecting whether we're running mozinstall >=1.0... 19:08:36 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 19:08:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 19:08:36 INFO - Reading from file tmpfile_stdout 19:08:36 INFO - Output received: 19:08:36 INFO - Usage: mozinstall [options] installer 19:08:36 INFO - Options: 19:08:36 INFO - -h, --help show this help message and exit 19:08:36 INFO - -d DEST, --destination=DEST 19:08:36 INFO - Directory to install application into. [default: 19:08:36 INFO - "/builds/slave/test"] 19:08:36 INFO - --app=APP Application being installed. [default: firefox] 19:08:36 INFO - mkdir: /builds/slave/test/build/application 19:08:36 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'] 19:08:36 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 19:08:52 INFO - Reading from file tmpfile_stdout 19:08:52 INFO - Output received: 19:08:52 INFO - /builds/slave/test/build/application/firefox/firefox 19:08:52 INFO - Running post-action listener: _resource_record_post_action 19:08:52 INFO - ##### 19:08:52 INFO - ##### Running run-tests step. 19:08:52 INFO - ##### 19:08:52 INFO - Running pre-action listener: _resource_record_pre_action 19:08:52 INFO - Running main action method: run_tests 19:08:52 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 19:08:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 19:08:52 INFO - Python 2.7.3 19:08:52 INFO - Return code: 0 19:08:52 INFO - grabbing minidump binary from tooltool 19:08:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:08:52 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 0xda4410>, '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 0xda5310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xda57a0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 19:08:52 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 19:08:52 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 19:08:52 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 19:08:52 INFO - Return code: 0 19:08:52 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 19:08:52 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 19:08:52 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 19:08:52 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 19:08:52 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 19:08:52 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 19:08:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 19:08:53 INFO - Return code: 0 19:08:53 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-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/AE8TDcyfQayrCyyQaRTJSQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-047', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 19:08:53 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-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/AE8TDcyfQayrCyyQaRTJSQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-047 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 19:08:53 INFO - Using env: {'DISPLAY': ':0', 19:08:53 INFO - 'HOME': '/home/cltbld', 19:08:53 INFO - 'LANG': 'en_US.UTF-8', 19:08:53 INFO - 'LANGUAGE': 'en_US:en', 19:08:53 INFO - 'LOGNAME': 'cltbld', 19:08:53 INFO - 'MAIL': '/var/mail/cltbld', 19:08:53 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 19:08:53 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 19:08:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:08:53 INFO - 'MOZ_NO_REMOTE': '1', 19:08:53 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 19:08:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:08:53 INFO - 'NO_EM_RESTART': '1', 19:08:53 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:08:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:08:53 INFO - 'PWD': '/builds/slave/test', 19:08:53 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 19:08:53 INFO - 'SHELL': '/bin/bash', 19:08:53 INFO - 'SHLVL': '1', 19:08:53 INFO - 'TERM': 'linux', 19:08:53 INFO - 'TMOUT': '86400', 19:08:53 INFO - 'USER': 'cltbld', 19:08:53 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1460594001.820813-1409371344', 19:08:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:08:53 INFO - '_': '/tools/buildbot/bin/python'} 19:08:53 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-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/AE8TDcyfQayrCyyQaRTJSQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-047', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 19:08:53 INFO - mozversion application_buildid: 20160413184655 19:08:53 INFO - mozversion application_changeset: f6fe48816b24556b76f34e7e3ec9713a439bb191 19:08:53 INFO - mozversion application_display_name: Nightly 19:08:53 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 19:08:53 INFO - mozversion application_name: Firefox 19:08:53 INFO - mozversion application_remotingname: firefox 19:08:53 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 19:08:53 INFO - mozversion application_vendor: Mozilla 19:08:53 INFO - mozversion application_version: 48.0a1 19:08:53 INFO - mozversion platform_buildid: 20160413184655 19:08:53 INFO - mozversion platform_changeset: f6fe48816b24556b76f34e7e3ec9713a439bb191 19:08:53 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 19:08:53 INFO - mozversion platform_version: 48.0a1 19:08:53 INFO - using testdate: 1460599733 19:08:53 INFO - actual date: 1460599733 19:08:53 INFO - starting webserver on 'localhost:59054' 19:08:53 INFO - SUITE-START | Running 2 tests 19:08:53 INFO - TEST-START | dromaeo_css 19:08:53 INFO - operating with platform_type : linux_ 19:08:53 INFO - Initialising browser for dromaeo_css test... 19:08:53 INFO - TEST-INFO | started process 12472 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpAksong/profile http://localhost:59054/getInfo.html) 19:08:57 INFO - PROCESS | 12472 | 19:08:57 INFO - PROCESS | 12472 | (process:12542): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 19:08:57 INFO - PROCESS | 12472 | JavaScript error: jar:file:///builds/slave/test/build/application/firefox/omni.ja!/components/Weave.js, line 13: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIXPCComponents_Utils.import] 19:08:58 INFO - PROCESS | 12472 | __metrics Screen width/height:1600/1200 19:08:58 INFO - PROCESS | 12472 | colorDepth:24 19:08:58 INFO - PROCESS | 12472 | Browser inner width/height: 1024/697 19:08:58 INFO - PROCESS | 12472 | __metrics 19:08:59 ERROR - PROCESS | 12472 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2936: TypeError: this.tabs is undefined 19:09:00 INFO - TEST-INFO | 12472: exit 0 19:09:00 INFO - Browser initialized. 19:09:00 INFO - Running cycle 1/1 for dromaeo_css test... 19:09:00 INFO - TEST-INFO | started process 12593 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpAksong/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 19:09:02 INFO - PROCESS | 12593 | 19:09:02 INFO - PROCESS | 12593 | (process:12652): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 19:09:12 INFO - PROCESS | 12593 | RSS: Main: 164282368 19:09:12 INFO - PROCESS | 12593 | 19:10:02 INFO - PROCESS | 12593 | 1460599802091 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] 19:12:13 INFO - PROCESS | 12593 | Cycle 1(1): loaded http://localhost:59054/tests/dromaeo/cssquery-dojo.html (next: http://localhost:59054/tests/dromaeo/cssquery-ext.html) 19:12:15 INFO - PROCESS | 12593 | RSS: Main: 169332736 19:12:15 INFO - PROCESS | 12593 | 19:15:17 INFO - PROCESS | 12593 | Cycle 1(1): loaded http://localhost:59054/tests/dromaeo/cssquery-ext.html (next: http://localhost:59054/tests/dromaeo/cssquery-jquery.html) 19:15:17 INFO - PROCESS | 12593 | RSS: Main: 165965824 19:15:17 INFO - PROCESS | 12593 | 19:18:19 INFO - PROCESS | 12593 | Cycle 1(1): loaded http://localhost:59054/tests/dromaeo/cssquery-jquery.html (next: http://localhost:59054/tests/dromaeo/cssquery-mootools.html) 19:18:20 INFO - PROCESS | 12593 | RSS: Main: 166338560 19:18:20 INFO - PROCESS | 12593 | 19:21:21 INFO - PROCESS | 12593 | Cycle 1(1): loaded http://localhost:59054/tests/dromaeo/cssquery-mootools.html (next: http://localhost:59054/tests/dromaeo/cssquery-prototype.html) 19:21:22 INFO - PROCESS | 12593 | RSS: Main: 164364288 19:21:22 INFO - PROCESS | 12593 | 19:24:25 INFO - PROCESS | 12593 | Cycle 1(1): loaded http://localhost:59054/tests/dromaeo/cssquery-prototype.html (next: http://localhost:59054/tests/dromaeo/cssquery-yui.html) 19:24:25 INFO - PROCESS | 12593 | RSS: Main: 165580800 19:24:25 INFO - PROCESS | 12593 | 19:27:28 INFO - PROCESS | 12593 | Cycle 1(1): loaded http://localhost:59054/tests/dromaeo/cssquery-yui.html (next: http://localhost:59054/tests/dromaeo/cssquery-dojo.html) 19:27:28 INFO - PROCESS | 12593 | RSS: Main: 167948288 19:27:28 INFO - PROCESS | 12593 | 19:27:28 INFO - PROCESS | 12593 | __start_tp_report 19:27:28 INFO - PROCESS | 12593 | _x_x_mozilla_page_load 19:27:28 INFO - PROCESS | 12593 | _x_x_mozilla_page_load_details 19:27:28 INFO - PROCESS | 12593 | |i|pagename|runs| 19:27:28 INFO - PROCESS | 12593 | |0;dojo.html;2652.191081720075;2703.8783254753534;2728.5225085610014;2747.1346525844356;2750.8349499030046;4716.221823399143;4744.620430365571;4753.572178503934;4780.163471392505;4836.564709176174;4733.266343716721;4790.856274311767;4801.495842936485;4813.133635945528;4815.181419158743;4317.373980772786;4380.01449673824;4417.602415782579;4469.776511174445;4531.297648864414;4462.1075784843;4489.61838243748;4509.751963641998;4526.049529598772;4548.1585906607215;4368.301071828524;4441.755703436342;4468.4414448193975;4507.639388848901;4525.615322697558;4372.715773474714;4380.9923717544825;4382.452193475816;4394.890127746832;4449.9555004450185;4323.265044942367;4337.652987760972;4340.262155433584;4375.496817865955;4388.429504164438;4582.6104781093645;4654.162250794856;4697.95302046982;4728.101660684459;4733.124371991193;5032.6477146599755;5039;5082.745862706887;5084.110280700863;5103.923441148386;5063.417706963673;5098.97450512745;5105.055564720538;5109.744512774347;5159.432462429129;4773.737444440554;4808.447028591687;4815;4829.420469543642;4845.3216549683075;5239.973800131052;5244.501772331622;5270.631055826056;5277.656952298088;5277.841664749987;4946.554810067039;4968.6025117990475;5027.899442011139;5038.193888977746;5044.445111037783;5057.747112644353;5110.4123025852505;5119.078565858182;5128;5166.380034395821;5031.119554078022;5043.747812609355;5048.848534543969;5063.518965698253;5110.412302585176;4923.852284431473;5003.349564556657;5015.097282489187;5029.4719054498755;5046.571041461517;4230.978845105755;4254.638355739735;4288.742675439484;4329.761863097497;4389.956100438954;3780.8865734028022;3832.6550610445192;3846.9038274042814;3849.9807500962315;3872.283627528916;4384.342348647665;4488.236999710057;4490.820367185276;4522.118186953512;4527.492266240868;4933.703977761345;4954.975225123923;4962.851114466572;4971.602271818246;5013.047520971004;4428.800703968329;4446.9777651111535;4457;4498.572635599613;4516.119356725473;4580.1984652686315;4590.150822097856;4600.493945665974;4624.560666736655;4680.08738296029;4899.485554016848;4957.405111386656;4970.801167953241;4972.179590367621;4984.526469985346;5137.768800403916;5171.3535808024;5182.041322355376;5190.636655434235;5234.162533994542;4794.568488836021;4876.4392094909535;4915.0415668944215;4937.407511098691;4939.407271127488;5045.899082018265;5075;5095.312132862165;5111.897762044664;5139.177731562932;5160.380754309507;5166.896662066662;5176.870578235424;5184.040952423814;5211.713355765318;4873.512648735098;4903.95096049035;4962.454130045764;5011.899762004812;5023.773930173078;4922.72924989129;4955.157623204136;4965.627577931597;4975.552200301845;5012.498750124958;4875.512448755097;4895.04546613407;4912.48418916023;4920.6801557898625;4949.678270912379;4890.266460031024;4906.92639610399;5027.321311622884;5058.443571207091;5067.898642027065;4848.321235027029;4902.60779137661;4907.901841963212;4908.312836203006;4932.432770231326 19:27:28 INFO - PROCESS | 12593 | |1;ext.html;568.6588047171695;606.3148642034502;621.4686443091155;627.4384425938784;637.6875331087768;32155.839220803922;33181.83409082954;33231.83384083079;33296.33407331858;33451.49822752661;33879;34131.14672133192;34165.82917085417;34217.828910855475;34287;7451.888221676679;7622.5426474411715;7641.694332226704;7643.61781910905;7647.885281720779;7595.696172153107;7751.22487751226;7752.534847909115;7753;7759.0689117306;7759.45683802134;7769.572673502955;7818.843623127563;7820.491668041587;7829.256220659056;7657.808554786119;7730.18833022533;7754.612269386508;7759.262870027338;7772.417068719868;7684.615769211573;7750.806229844299;7771.611419429006;7779.922200777976;7780.260875216845;31788.841055794805;34115.829420852984;34558.82720586406;34717.82641086804;35012.64987350145;2866.1688110447944;2938.750206232473;2940.926476838075;2954.6749857515656;3015.366772977677;24381.268561942994;24661.383465413328;24757.13350032758;24877.50244995108;24879.378015549573;3236.91907702307;3289.3750187464307;3323.551320571716;3325.985574399807;3347.7991320520605;152175;152378.9999999989;152621.2368938148;152766.41700748994;153151;31908.521372179435;32057;32135.678643213738;32216.83891580527;32226.83886580552;33231;33426;62575.37424625787;63575.36424635787;64246.35753642404;14112.647183820487;14331.355089021019;14336;14341.211233382264;14349.354279057468;11438.313701177956;11574.768504629861;11575.247608905394;11586.942065289788;11599.942000290113;18223.362182323555;18265.817341826412;18522.259109635463;18586.628267434848;18604.906975465037;6838.418734407532;6893.896591551131;6898.413634840995;7000.789976300617;7139.607321597362;830.0495932157646;898.3127907151035;956.9473678947725;961.8172547216006;1100.3178029621686;27304.180874573794;28190.85904570505;28401.431971360456;28436.980163150485;28510.00214992507;995.4624502768424;1014.9797004059877;1063.9148868090533;1129.9039581635489;1137.726945533066;14651.633709157144;14977.502249774936;15058.698826023417;15285.465008724641;15467.767983480257;339548.83609311195;342952;345016;347515;351427;48577.75711121422;49243.26135107976;49419.50580494221;49458.50541494611;49500.25749613759;1140.766142940695;1194.4684615346262;1201.987980120205;1214.131895694565;1220.2068655374078;26579.810422749393;27728.722712772615;27751.444971100867;27853.303667407665;28179;42512.78743606262;42544;42556.78721606372;43065.56934430741;43132.353014704175;303598;304593;305259;305823;308146;23604.29187124389;23684.171054013026;23779.64330535078;23812.404689882893;38099.238015240095;36437.63562364342;36964.63035369612;37205.6279437213;37578.812105939294;37580.43629345507;34209.486857696655;34283;34302.313953721285;34838.82580587081;36009.459858101625;34464.31071378508;34634.307313854086;34781.826090870396;34786.82606586951;34985.65014349824;31576.684233157375;34049.14877128092;35094;36629.81685091557;37241;29038.274043148245;29775.255618609706;30406.391872161992;31401.371972559962;31795.36409271848;24565.877170614032;24787.380315492257;25018.62472062957;25172.232630525134;25462.23613291604 19:27:28 INFO - PROCESS | 12593 | |2;jquery.html;385.39108209029735;388.6191532298346;388.87555982085723;397.4566689019526;397.67390739593543;12971.935140324285;15609.21953902306;15894.602634934117;16426.67146657066;16520.421785237504;16025.759613605805;16290.674186516293;16393.590160246;17595;17741.29034838605;4443.355713421552;5203.271541984125;5237.528622423981;5288.365396152448;5407.5133238008575;5254.133068043769;5273.709945952971;5297.311349524575;5313.654612450178;5314.149736042234;5025.698458092508;5252.606054545905;5262.947370526284;5276.841694749163;5284.39229488608;5199.844004679866;5200.323957885451;5226.320578324793;5234.293370394986;5236.6857988520815;4644.117617652635;4655.557722016403;4668.346431499593;4669.836555720567;4955.603551715854;12264.44809983544;12604;12606.936965315206;12749.043821713316;12776.61670149897;1792.3905872003581;1799.1813724755204;1821.9180136893872;1826.9451916442529;1845.1051240148518;9016.684416045473;9305.581248843819;9313.580888860017;9319.213915154163;9406.811863762687;1726.9126329687824;1732.8960262384298;1738.113562083334;1753.2461041752042;1765.757487990258;60229.6988515059;64210.67894660497;71594.2840571598;73475.63262183708;74939;9927.751806204902;10007.399556026661;10064.295499315123;10065.396076235449;10480.68557943263;12805.615831525069;13438.462461501626;14251;14275.85724142766;14344.426222950966;5978.790742324085;6113.32753397126;6698.966505167443;7529.887051694229;7576.166621671612;7121.608311542915;7289.2346303638415;7316.890246646304;7362.595057271795;7405.851882962311;4350.71720338177;4359.869203923888;4472.9776351118035;4510.21071312519;4515.571020753023;1819.5170935687372;1864.6736821056531;1879.1543805287674;1897.2600685732575;1916.865819392657;809.2918696140877;925.1904583489446;956.7416797464646;960.8606752020918;973.0366936732584;16332.346706131859;16919.407820726214;17140.742888856676;17185.1407429628;17237.741433878502;867.4361664917853;874.2568816505919;919.8436265834824;928.8467402878449;929.8326301265837;9401.341906066646;9548.856767148498;9580;9637.277204209571;9735.65925192629;401044;403565;411287;416048;417625;65656.67171664111;70182.59634807377;74263.62868185733;78806.21193787988;79836;960.1166926427703;980.1325826643472;997.6757553795046;1000.8098461292477;1004.8492726091145;14625.122492650475;15406.92296538555;15489.5353139406;15581.454649087227;15969.20153992319;22708;23364.415889602897;34551.65448345484;35150.29699405946;35947;44794.3280850781;45710.54289457063;49120.75439622779;49301.75349123232;49688.503114968385;7345.412367010519;7875.291223789886;8035.799105022421;8137.79655508617;8198.42611017247;8420.789480262798;10930;11072.948069933344;11618.419079046183;11852.881471185177;9840.950795245977;9961.252906031932;10116.59533618647;10204.693859184237;10227.48862556884;9316.813663726552;9479.763005924631;9636.42181469114;10005.099541041342;10245.692629221136;6916.446684265347;7364.705411783469;7551.433642476946;7804.9609751950875;9844.60621575129;10701.448289998063;10963.890361096286;11363.772724545628;11507.769844603228;11712.297262164297;7466.290702383265;10565.366078035342;10968.780624387628;11152.107831373309;11276.154288428237 19:27:28 INFO - PROCESS | 12593 | |3;mootools.html;1426.4294282287087;1442.3365251984087;1587.9603009924751;1734.947951561452;1747.7815273090864;6803.659817009142;7571.31858132768;7582.355499782519;7847.92152078479;7854.960725196381;7584.279493448127;7682.078150621919;7717.6912923483;7754.0695116586085;7780.221977802217;2247.606668832956;2311.2719493359623;2312.560613483441;2316.536692661466;2316.5830150572974;2244.786745259206;2263.671767593698;2271.5684020036224;2277.749447560767;2284.097781376355;2275.4311422144465;2282.2012295696454;2287.553926984239;2294.506681063571;2305.827062970284;2210.35899589119;2210.45843768277;2212.325240801555;2215.7562668106575;2225.054351900436;2210.115953618549;2211.292386436341;2220.4781876259067;2229.030371788277;2232.7320721513524;7887.447878648497;7900.051993760785;7937.920620793776;7954.9602251988945;7976.322012628933;4661.813527458931;4784.40194975628;4803.159447096744;4813.85558433244;4822.228443449031;2924.8683809228637;3033.9089827305215;3046.8019578727312;3073;3101.984490077558;853.607340623314;854.598338780772;858.0732808566733;862.9827403451959;868.1058509734983;10356.378617282988;10745.194110441747;10767.192460565411;10779.08377787889;10789.460526973699;4293.6779741518885;4304.289792184317;4417.712848664826;4421.602055814992;4566.611837993808;9195.816083678288;9255.953720231355;9284.071592840663;9317.953410232905;9347.766305842408;4807.6394270429855;4864.683795553277;4870.975645121752;4879.121758083508;4881.926771098437;3853.383458646659;4309.310510318334;4400.405945197422;4400.9119817604105;4429.889252768642;3795.203007368428;3797.6392242736897;3827.6746476549247;3950.4469374287046;3967.6429121379215;1232.1990706041145;1267.4866678995022;1270.7013851744832;1271.3452571925466;1279.7440511897657;867.150192811036;869.2871845087094;884.3500027479797;893.5308962794455;900.5137225898072;5550.7779688812;5573.526250268773;5629.662220266797;5756.25168728071;5830.5044071254415;887.7070566712969;935.6771913689767;947.0624082158613;951.8191543606692;980.1374790184592;3778.6221377861993;3850.133719912997;3905.9609403906165;3933.665638420709;3943.033956680574;9242.584083716249;9498.050194980447;9535.332526723201;9639.132478076866;9654.662086826927;9450.810983780424;9525.28560357976;9545.236381089497;9568;9576.90423095774;7062.823429414306;7282.599457029808;7424.406047516186;7432.814179645444;7451.85096298071;5422.6475279106735;5490.972545137249;5535.944640553543;5641.9435805641415;5673.801416950387;8932.374733768575;8957.865632015655;9014;9066.09339066088;9183.632654693738;8386.832263354821;8806.867896981423;8818.426802257833;8821.603027863634;9191.494467804336;6167.321594624677;6623.536352455282;6690.899636505359;6812.523123381316;6846.349596788297;7412.703491860265;7440.925590744023;7480;7483.289087536676;7486.775396738107;6531.248906375828;6751.291114432914;6800.52396332252;6820.556663816836;6931.826704332432;6381.649009304533;6478.708458119301;6749.493787965824;6756.324367563205;6808;6422.454091402096;6478.805635830932;6517.631297427593;6544.345565443417;6554.80335589933;4899.632527560376;4917.655764096479;4924.310596516419;5073.315102461121;5090.516400941905;4887.90224195507;4902.338184345068;4924.285978533021;4944.357233559758;5011.448740638454 19:27:28 INFO - PROCESS | 12593 | |4;prototype.html;318;325.094611506953;328.1124558070419;330.3920785754212;336.3944899181476;5224.7387630618505;5340.813071542497;5350.812721554741;5360.2763626910355;5376.838694839152;5241.9213711794355;5244;5247.501487358704;5253.842384728455;5264.210368444736;3854.092224348944;3974.9006274843214;4097.79511024449;4107.383892416146;4112.157007813391;4067.532233793122;4093.7543747375103;4098.426220329156;4099.221147981889;4118.608732170439;4059.1678705865374;4060.3503439449696;4066.4103704962763;4067.3898915162667;4091.488563929509;3838.2899163654533;4033.4958130233426;4061.472008638858;4065.0650350419273;4079.9592004079877;3492.7555071144775;3503.5970863350785;3506.8246587670515;3510.6834936898663;3521.383757842393;5045.318881950963;5047.671901326402;5049.671771334852;5049.974750126263;5052.216906379517;4475.172093162775;4546.946325745135;4612.561806628365;4628.305754136873;4635.46692130406;5505.532029777473;5512.862178445531;5530.225768392428;5531.25328080708;5553.500184983331;3831.5593706723803;3832.367659336206;3833;3852.4413959975927;3861.6524512793985;5685.5167310778215;5710.744256018849;5781.103928891029;5839.124131380285;5852.853678658025;3939.2712348215673;3964.6035396460125;3975.1652153048185;3987.7806720630642;3995.900102497461;3990.580988996114;4005.759654420744;4019.2363450944226;4025.3358195897936;4027.013381721497;4640.767961601907;4656.534346565317;4660.720356778536;4678.087772884255;4687.437507499054;5471.863203419946;5529;5569.415211402826;5602.85992850182;5609.102543593006;1365.6790654196257;1381.6183816183816;1391.2139641102744;1399.3353157250428;1401.061288936415;880.0451510111473;899.5547204133995;908.40953380302;911.589784596934;919.7056941778567;4872.9544034978135;4912.336834527365;4914.754262286871;4924.7537623119415;4933.925991110136;5670.914936275959;5686.34607020198;5691.0609749391715;5699.544036477072;5713.657180569179;4685.508021657745;4940.580050695731;4941.283513890466;4951.232558953368;4985.501449855058;3052.1759125036115;3078.107348868803;3081.337512434837;3085.2259950528537;3107.254258977829;5536.785285885598;5542.002439560918;5542.91685624716;5543.944560554342;5561.388247292794;5794.333651630117;5904.911426328608;5939.10913362999;5961.463468287875;5972.581919265696;5519.558435325164;5536.307961504812;5537.58468114893;5537.750801213874;5545.805896793673;5557.444255574572;5696.544276457957;5720.3421606515785;5746.569007324551;5767;5639.464250896158;5642.633228840113;5659.830205093689;5676.659400435987;5685.573581981451;5449.6730196188355;5479.780808767605;5509.421510741315;5522.696251706195;5528.336599608073;3684.6683798458266;3875;3924.1151260252714;3969.1664750401583;4009.2382447334912;5626.774929002794;5658.773649053992;5670.262865827416;5675.602707810413;5694.316681998187;5354.491323324278;5423.511883930465;5430.864228394322;5446.863828404322;5453.372862120907;5300.443453437488;5394;5555.0834112371;5592.133219351007;5623.493885550157;5179.834537229244;5447.4824891635235;5490.258815059916;5498.147787093007;5511.53151982086;5387.3804512481565;5587.7485513152815;5589.273394458694;5595.692236927008;5599.664020158803;5449.155380915964;5456.781728730806;5457.836264912059;5472.835814925558;5477.315335583052 19:27:28 INFO - PROCESS | 12593 | |5;yui.html;676.4284179868012;704.6617623540702;707.2997732245076;714.2714431280091;724.4096061709706;11277.943610281947;12086.939565302173;12271.325077120755;12290.262584244952;12309;12076.215046022024;12092.879071209285;12113.394330283494;12118.21231619944;12118.81821772674;609.3327806052365;775.7750252426789;788.7357735158714;795.7612716185122;795.9164287749761;791.2325044706625;793.6468271619132;798.1220657276978;799.7200979657102;802.2058162419193;839.215333663027;839.8950131233596;840.1304649687575;844.8099177685002;847.8431490174306;837.623069618668;837.945533540321;841.0538144587339;842.2167384332569;844.4553263145299;606.5784279925454;613.1722175063672;615.6890770161085;617.8856911471393;618.7215752911208;11602.361870097142;11612;11626.767464650744;11651.067914566815;11664.6500604982;12621.93689031549;12838.358082095858;12858.540169904769;12876.22742635445;12918.741625167444;9566.378185417996;9590.6643267486;9711.757206069835;9732.513374331325;9994.850077248848;3332.7333813294877;3354.2788300515263;3375.696187343151;3390.3727810355163;3391.1352605085544;47651.285230721565;48700.75649621765;49058.50941490575;49264.261036084485;49410.7529462354;9797.007434299012;9855.852162217572;9863;9945.900540994642;10130.189584833195;15576.376944922304;15626;15669;15746.76379854303;15809.920950395404;6515.674216289167;6547.345265473415;6585.604863708097;6618.205815302194;6654.201495820533;3627.6735093841153;3649.288388764219;3649.908752281214;3689.538807649044;3702.074481379655;2892.233558107061;3011.56332331815;3011.9397612047637;3017.6227971503563;3018.154916623349;546.6829239041347;555.0868820789779;555.416812347034;561.2535328013732;562.2353599105213;624.1947887225429;635.640862912453;643.6635014895897;644.0664509854493;647.3073811022161;7688.538687678757;7794.2985131338455;7988.001499812523;8004.959975200087;8241.093479717227;609.9146119543268;616.9383061693884;640.4460141977249;640.961542307463;665.1153965226238;3735.701143908481;3774.7735135891935;3810.561785394715;3853.190829925691;3880.78655673935;52292;52332.86002839842;53164.46835531595;53300.466995330324;53676;44107.55892441099;44402.77798610986;44869.775651121534;45061.324080138824;45149.322760158626;40081;41380;41802;42225.57774422278;42302.788486057376;7150.392216661434;7272.96363518179;7437.925620743723;7477.364424024019;7495.400367970658;27601.171964841087;27936.30159245954;28107;28124;28811.42377152487;33735.83132084422;36809.89570312895;36912;37013.44479832751;37240.441393378576;9364.194728149778;9468.573914174016;9509.572069257038;9818.950905245429;10414.583416663248;11607.477663505331;11667.6499705009;11779.52881884715;11809.763804723685;11811.350375729417;11402.657920262405;11666.76666466649;11861.406929653655;12000.15998880105;12078.75842483163;11429.257098288585;11457.19799614019;11476.942615286871;11549.42252887369;11602.361870097226;11123.777524449628;11125.554977800797;11170.944145279222;11377.658670239905;11494.137939654727;9546.57040433196;10017.994601619339;10084.344517606332;10287.897121028695;10297.794044119226;9411.952940235255;9708.951455242679;9750.707478775648;9772.804543909224;10033.648822291185 19:27:28 INFO - PROCESS | 12593 | __end_tp_report 19:27:28 INFO - PROCESS | 12593 | __start_cc_report 19:27:28 INFO - PROCESS | 12593 | _x_x_mozilla_cycle_collect,372 19:27:28 INFO - PROCESS | 12593 | __end_cc_report 19:27:28 INFO - PROCESS | 12593 | __startTimestamp1460600848598__endTimestamp 19:27:28 INFO - PROCESS | 12593 | 19:27:28 INFO - PROCESS | 12593 | ------- Summary: start ------- 19:27:28 INFO - PROCESS | 12593 | Number of tests: 6 19:27:28 INFO - PROCESS | 12593 | 19:27:28 INFO - PROCESS | 12593 | [#0] dojo.html Cycles:165 Average:4734.23 Median:4899.49 stddev:480.57 (9.8%) stddev-sans-first:453.44 19:27:28 INFO - PROCESS | 12593 | Values: 2652.2 2703.9 2728.5 2747.1 2750.8 4716.2 4744.6 4753.6 4780.2 4836.6 4733.3 4790.9 4801.5 4813.1 4815.2 4317.4 4380.0 4417.6 4469.8 4531.3 4462.1 4489.6 4509.8 4526.0 4548.2 4368.3 4441.8 4468.4 4507.6 4525.6 4372.7 4381.0 4382.5 4394.9 4450.0 4323.3 4337.7 4340.3 4375.5 4388.4 4582.6 4654.2 4698.0 4728.1 4733.1 5032.6 5039.0 5082.7 5084.1 5103.9 5063.4 5099.0 5105.1 5109.7 5159.4 4773.7 4808.4 4815.0 4829.4 4845.3 5240.0 5244.5 5270.6 5277.7 5277.8 4946.6 4968.6 5027.9 5038.2 5044.4 5057.7 5110.4 5119.1 5128.0 5166.4 5031.1 5043.7 5048.8 5063.5 5110.4 4923.9 5003.3 5015.1 5029.5 5046.6 4231.0 4254.6 4288.7 4329.8 4390.0 3780.9 3832.7 3846.9 3850.0 3872.3 4384.3 4488.2 4490.8 4522.1 4527.5 4933.7 4955.0 4962.9 4971.6 5013.0 4428.8 4447.0 4457.0 4498.6 4516.1 4580.2 4590.2 4600.5 4624.6 4680.1 4899.5 4957.4 4970.8 4972.2 4984.5 5137.8 5171.4 5182.0 5190.6 5234.2 4794.6 4876.4 4915.0 4937.4 4939.4 5045.9 5075.0 5095.3 5111.9 5139.2 5160.4 5166.9 5176.9 5184.0 5211.7 4873.5 4904.0 4962.5 5011.9 5023.8 4922.7 4955.2 4965.6 4975.6 5012.5 4875.5 4895.0 4912.5 4920.7 4949.7 4890.3 4906.9 5027.3 5058.4 5067.9 4848.3 4902.6 4907.9 4908.3 4932.4 19:27:28 INFO - PROCESS | 12593 | 19:27:28 INFO - PROCESS | 12593 | [#1] ext.html Cycles:180 Average:41646.68 Median:33438.75 stddev:73942.80 (221.1%) stddev-sans-first:74085.90 19:27:28 INFO - PROCESS | 12593 | Values: 568.7 606.3 621.5 627.4 637.7 32155.8 33181.8 33231.8 33296.3 33451.5 33879.0 34131.1 34165.8 34217.8 34287.0 7451.9 7622.5 7641.7 7643.6 7647.9 7595.7 7751.2 7752.5 7753.0 7759.1 7759.5 7769.6 7818.8 7820.5 7829.3 7657.8 7730.2 7754.6 7759.3 7772.4 7684.6 7750.8 7771.6 7779.9 7780.3 31788.8 34115.8 34558.8 34717.8 35012.6 2866.2 2938.8 2940.9 2954.7 3015.4 24381.3 24661.4 24757.1 24877.5 24879.4 3236.9 3289.4 3323.6 3326.0 3347.8 152175.0 152379.0 152621.2 152766.4 153151.0 31908.5 32057.0 32135.7 32216.8 32226.8 33231.0 33426.0 62575.4 63575.4 64246.4 14112.6 14331.4 14336.0 14341.2 14349.4 11438.3 11574.8 11575.2 11586.9 11599.9 18223.4 18265.8 18522.3 18586.6 18604.9 6838.4 6893.9 6898.4 7000.8 7139.6 830.0 898.3 956.9 961.8 1100.3 27304.2 28190.9 28401.4 28437.0 28510.0 995.5 1015.0 1063.9 1129.9 1137.7 14651.6 14977.5 15058.7 15285.5 15467.8 339548.8 342952.0 345016.0 347515.0 351427.0 48577.8 49243.3 49419.5 49458.5 49500.3 1140.8 1194.5 1202.0 1214.1 1220.2 26579.8 27728.7 27751.4 27853.3 28179.0 42512.8 42544.0 42556.8 43065.6 43132.4 303598.0 304593.0 305259.0 305823.0 308146.0 23604.3 23684.2 23779.6 23812.4 38099.2 36437.6 36964.6 37205.6 37578.8 37580.4 34209.5 34283.0 34302.3 34838.8 36009.5 34464.3 34634.3 34781.8 34786.8 34985.7 31576.7 34049.1 35094.0 36629.8 37241.0 29038.3 29775.3 30406.4 31401.4 31795.4 24565.9 24787.4 25018.6 25172.2 25462.2 19:27:28 INFO - PROCESS | 12593 | 19:27:28 INFO - PROCESS | 12593 | [#2] jquery.html Cycles:180 Average:24204.02 Median:25113.06 stddev:67494.03 (268.8%) stddev-sans-first:67659.67 19:27:28 INFO - PROCESS | 12593 | Values: 385.4 388.6 388.9 397.5 397.7 12971.9 15609.2 15894.6 16426.7 16520.4 16025.8 16290.7 16393.6 17595.0 17741.3 4443.4 5203.3 5237.5 5288.4 5407.5 5254.1 5273.7 5297.3 5313.7 5314.1 5025.7 5252.6 5262.9 5276.8 5284.4 5199.8 5200.3 5226.3 5234.3 5236.7 4644.1 4655.6 4668.3 4669.8 4955.6 12264.4 12604.0 12606.9 12749.0 12776.6 1792.4 1799.2 1821.9 1826.9 1845.1 9016.7 9305.6 9313.6 9319.2 9406.8 1726.9 1732.9 1738.1 1753.2 1765.8 60229.7 64210.7 71594.3 73475.6 74939.0 9927.8 10007.4 10064.3 10065.4 10480.7 12805.6 13438.5 14251.0 14275.9 14344.4 5978.8 6113.3 6699.0 7529.9 7576.2 7121.6 7289.2 7316.9 7362.6 7405.9 4350.7 4359.9 4473.0 4510.2 4515.6 1819.5 1864.7 1879.2 1897.3 1916.9 809.3 925.2 956.7 960.9 973.0 16332.3 16919.4 17140.7 17185.1 17237.7 867.4 874.3 919.8 928.8 929.8 9401.3 9548.9 9580.0 9637.3 9735.7 401044.0 403565.0 411287.0 416048.0 417625.0 65656.7 70182.6 74263.6 78806.2 79836.0 960.1 980.1 997.7 1000.8 1004.8 14625.1 15406.9 15489.5 15581.5 15969.2 22708.0 23364.4 34551.7 35150.3 35947.0 44794.3 45710.5 49120.8 49301.8 49688.5 7345.4 7875.3 8035.8 8137.8 8198.4 8420.8 10930.0 11072.9 11618.4 11852.9 9841.0 9961.3 10116.6 10204.7 10227.5 9316.8 9479.8 9636.4 10005.1 10245.7 6916.4 7364.7 7551.4 7805.0 9844.6 10701.4 10963.9 11363.8 11507.8 11712.3 7466.3 10565.4 10968.8 11152.1 11276.2 19:27:28 INFO - PROCESS | 12593 | 19:27:28 INFO - PROCESS | 12593 | [#3] mootools.html Cycles:180 Average:5233.67 Median:5635.80 stddev:2832.58 (50.3%) stddev-sans-first:2826.08 19:27:28 INFO - PROCESS | 12593 | Values: 1426.4 1442.3 1588.0 1734.9 1747.8 6803.7 7571.3 7582.4 7847.9 7855.0 7584.3 7682.1 7717.7 7754.1 7780.2 2247.6 2311.3 2312.6 2316.5 2316.6 2244.8 2263.7 2271.6 2277.7 2284.1 2275.4 2282.2 2287.6 2294.5 2305.8 2210.4 2210.5 2212.3 2215.8 2225.1 2210.1 2211.3 2220.5 2229.0 2232.7 7887.4 7900.1 7937.9 7955.0 7976.3 4661.8 4784.4 4803.2 4813.9 4822.2 2924.9 3033.9 3046.8 3073.0 3102.0 853.6 854.6 858.1 863.0 868.1 10356.4 10745.2 10767.2 10779.1 10789.5 4293.7 4304.3 4417.7 4421.6 4566.6 9195.8 9256.0 9284.1 9318.0 9347.8 4807.6 4864.7 4871.0 4879.1 4881.9 3853.4 4309.3 4400.4 4400.9 4429.9 3795.2 3797.6 3827.7 3950.4 3967.6 1232.2 1267.5 1270.7 1271.3 1279.7 867.2 869.3 884.4 893.5 900.5 5550.8 5573.5 5629.7 5756.3 5830.5 887.7 935.7 947.1 951.8 980.1 3778.6 3850.1 3906.0 3933.7 3943.0 9242.6 9498.1 9535.3 9639.1 9654.7 9450.8 9525.3 9545.2 9568.0 9576.9 7062.8 7282.6 7424.4 7432.8 7451.9 5422.6 5491.0 5535.9 5641.9 5673.8 8932.4 8957.9 9014.0 9066.1 9183.6 8386.8 8806.9 8818.4 8821.6 9191.5 6167.3 6623.5 6690.9 6812.5 6846.3 7412.7 7440.9 7480.0 7483.3 7486.8 6531.2 6751.3 6800.5 6820.6 6931.8 6381.6 6478.7 6749.5 6756.3 6808.0 6422.5 6478.8 6517.6 6544.3 6554.8 4899.6 4917.7 4924.3 5073.3 5090.5 4887.9 4902.3 4924.3 4944.4 5011.4 19:27:28 INFO - PROCESS | 12593 | 19:27:28 INFO - PROCESS | 12593 | [#4] prototype.html Cycles:180 Average:4590.15 Median:5259.03 stddev:1359.09 (25.8%) stddev-sans-first:1324.53 19:27:28 INFO - PROCESS | 12593 | Values: 318.0 325.1 328.1 330.4 336.4 5224.7 5340.8 5350.8 5360.3 5376.8 5241.9 5244.0 5247.5 5253.8 5264.2 3854.1 3974.9 4097.8 4107.4 4112.2 4067.5 4093.8 4098.4 4099.2 4118.6 4059.2 4060.4 4066.4 4067.4 4091.5 3838.3 4033.5 4061.5 4065.1 4080.0 3492.8 3503.6 3506.8 3510.7 3521.4 5045.3 5047.7 5049.7 5050.0 5052.2 4475.2 4546.9 4612.6 4628.3 4635.5 5505.5 5512.9 5530.2 5531.3 5553.5 3831.6 3832.4 3833.0 3852.4 3861.7 5685.5 5710.7 5781.1 5839.1 5852.9 3939.3 3964.6 3975.2 3987.8 3995.9 3990.6 4005.8 4019.2 4025.3 4027.0 4640.8 4656.5 4660.7 4678.1 4687.4 5471.9 5529.0 5569.4 5602.9 5609.1 1365.7 1381.6 1391.2 1399.3 1401.1 880.0 899.6 908.4 911.6 919.7 4873.0 4912.3 4914.8 4924.8 4933.9 5670.9 5686.3 5691.1 5699.5 5713.7 4685.5 4940.6 4941.3 4951.2 4985.5 3052.2 3078.1 3081.3 3085.2 3107.3 5536.8 5542.0 5542.9 5543.9 5561.4 5794.3 5904.9 5939.1 5961.5 5972.6 5519.6 5536.3 5537.6 5537.8 5545.8 5557.4 5696.5 5720.3 5746.6 5767.0 5639.5 5642.6 5659.8 5676.7 5685.6 5449.7 5479.8 5509.4 5522.7 5528.3 3684.7 3875.0 3924.1 3969.2 4009.2 5626.8 5658.8 5670.3 5675.6 5694.3 5354.5 5423.5 5430.9 5446.9 5453.4 5300.4 5394.0 5555.1 5592.1 5623.5 5179.8 5447.5 5490.3 5498.1 5511.5 5387.4 5587.7 5589.3 5595.7 5599.7 5449.2 5456.8 5457.8 5472.8 5477.3 19:27:28 INFO - PROCESS | 12593 | 19:27:28 INFO - PROCESS | 12593 | [#5] yui.html Cycles:180 Average:12620.57 Median:45105.32 stddev:14343.33 (31.8%) stddev-sans-first:14355.52 19:27:28 INFO - PROCESS | 12593 | Values: 676.4 704.7 707.3 714.3 724.4 11277.9 12086.9 12271.3 12290.3 12309.0 12076.2 12092.9 12113.4 12118.2 12118.8 609.3 775.8 788.7 795.8 795.9 791.2 793.6 798.1 799.7 802.2 839.2 839.9 840.1 844.8 847.8 837.6 837.9 841.1 842.2 844.5 606.6 613.2 615.7 617.9 618.7 11602.4 11612.0 11626.8 11651.1 11664.7 12621.9 12838.4 12858.5 12876.2 12918.7 9566.4 9590.7 9711.8 9732.5 9994.9 3332.7 3354.3 3375.7 3390.4 3391.1 47651.3 48700.8 49058.5 49264.3 49410.8 9797.0 9855.9 9863.0 9945.9 10130.2 15576.4 15626.0 15669.0 15746.8 15809.9 6515.7 6547.3 6585.6 6618.2 6654.2 3627.7 3649.3 3649.9 3689.5 3702.1 2892.2 3011.6 3011.9 3017.6 3018.2 546.7 555.1 555.4 561.3 562.2 624.2 635.6 643.7 644.1 647.3 7688.5 7794.3 7988.0 8005.0 8241.1 609.9 616.9 640.4 641.0 665.1 3735.7 3774.8 3810.6 3853.2 3880.8 52292.0 52332.9 53164.5 53300.5 53676.0 44107.6 44402.8 44869.8 45061.3 45149.3 40081.0 41380.0 41802.0 42225.6 42302.8 7150.4 7273.0 7437.9 7477.4 7495.4 27601.2 27936.3 28107.0 28124.0 28811.4 33735.8 36809.9 36912.0 37013.4 37240.4 9364.2 9468.6 9509.6 9819.0 10414.6 11607.5 11667.6 11779.5 11809.8 11811.4 11402.7 11666.8 11861.4 12000.2 12078.8 11429.3 11457.2 11476.9 11549.4 11602.4 11123.8 11125.6 11170.9 11377.7 11494.1 9546.6 10018.0 10084.3 10287.9 10297.8 9412.0 9709.0 9750.7 9772.8 10033.6 19:27:28 INFO - PROCESS | 12593 | -------- Summary: end -------- 19:27:28 INFO - PROCESS | 12593 | 19:27:29 INFO - TEST-INFO | 12593: exit 0 19:27:29 INFO - TEST-OK | dromaeo_css | took 1115598ms 19:27:29 INFO - TEST-START | kraken 19:27:29 INFO - operating with platform_type : linux_ 19:27:29 INFO - Initialising browser for kraken test... 19:27:29 INFO - TEST-INFO | started process 12830 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmphRtskG/profile http://localhost:59054/getInfo.html) 19:27:33 INFO - PROCESS | 12830 | 19:27:33 INFO - PROCESS | 12830 | (process:12898): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 19:27:33 INFO - PROCESS | 12830 | JavaScript error: jar:file:///builds/slave/test/build/application/firefox/omni.ja!/components/Weave.js, line 13: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIXPCComponents_Utils.import] 19:27:34 INFO - PROCESS | 12830 | __metrics Screen width/height:1600/1200 19:27:34 INFO - PROCESS | 12830 | colorDepth:24 19:27:34 INFO - PROCESS | 12830 | Browser inner width/height: 1024/697 19:27:34 INFO - PROCESS | 12830 | __metrics 19:27:34 ERROR - PROCESS | 12830 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2936: TypeError: this.tabs is undefined 19:27:35 INFO - TEST-INFO | 12830: exit 0 19:27:35 INFO - Browser initialized. 19:27:35 INFO - Running cycle 1/1 for kraken test... 19:27:35 INFO - TEST-INFO | started process 12949 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmphRtskG/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 19:27:37 INFO - PROCESS | 12949 | 19:27:37 INFO - PROCESS | 12949 | (process:13009): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 19:27:47 INFO - PROCESS | 12949 | RSS: Main: 164098048 19:27:47 INFO - PROCESS | 12949 | 19:27:50 INFO - PROCESS | 12949 | Cycle 1(1): loaded http://localhost:59054/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:59054/tests/kraken/driver.html?testName=audio-beat-detection) 19:27:51 INFO - PROCESS | 12949 | RSS: Main: 168493056 19:27:51 INFO - PROCESS | 12949 | 19:27:54 INFO - PROCESS | 12949 | Cycle 1(1): loaded http://localhost:59054/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:59054/tests/kraken/driver.html?testName=audio-dft) 19:27:54 INFO - PROCESS | 12949 | RSS: Main: 171696128 19:27:54 INFO - PROCESS | 12949 | 19:27:57 INFO - PROCESS | 12949 | Cycle 1(1): loaded http://localhost:59054/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:59054/tests/kraken/driver.html?testName=audio-fft) 19:27:58 INFO - PROCESS | 12949 | RSS: Main: 163794944 19:27:58 INFO - PROCESS | 12949 | 19:28:00 INFO - PROCESS | 12949 | Cycle 1(1): loaded http://localhost:59054/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:59054/tests/kraken/driver.html?testName=audio-oscillator) 19:28:01 INFO - PROCESS | 12949 | RSS: Main: 163495936 19:28:01 INFO - PROCESS | 12949 | 19:28:03 INFO - PROCESS | 12949 | Cycle 1(1): loaded http://localhost:59054/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:59054/tests/kraken/driver.html?testName=imaging-gaussian-blur) 19:28:03 INFO - PROCESS | 12949 | RSS: Main: 163926016 19:28:03 INFO - PROCESS | 12949 | 19:28:07 INFO - PROCESS | 12949 | Cycle 1(1): loaded http://localhost:59054/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:59054/tests/kraken/driver.html?testName=imaging-darkroom) 19:28:07 INFO - PROCESS | 12949 | RSS: Main: 164114432 19:28:07 INFO - PROCESS | 12949 | 19:28:11 INFO - PROCESS | 12949 | Cycle 1(1): loaded http://localhost:59054/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:59054/tests/kraken/driver.html?testName=imaging-desaturate) 19:28:11 INFO - PROCESS | 12949 | RSS: Main: 163319808 19:28:11 INFO - PROCESS | 12949 | 19:28:14 INFO - PROCESS | 12949 | Cycle 1(1): loaded http://localhost:59054/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:59054/tests/kraken/driver.html?testName=json-parse-financial) 19:28:15 INFO - PROCESS | 12949 | RSS: Main: 164036608 19:28:15 INFO - PROCESS | 12949 | 19:28:17 INFO - PROCESS | 12949 | Cycle 1(1): loaded http://localhost:59054/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:59054/tests/kraken/driver.html?testName=json-stringify-tinderbox) 19:28:17 INFO - PROCESS | 12949 | RSS: Main: 164634624 19:28:17 INFO - PROCESS | 12949 | 19:28:19 INFO - PROCESS | 12949 | Cycle 1(1): loaded http://localhost:59054/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:59054/tests/kraken/driver.html?testName=stanford-crypto-aes) 19:28:20 INFO - PROCESS | 12949 | RSS: Main: 165081088 19:28:20 INFO - PROCESS | 12949 | 19:28:22 INFO - PROCESS | 12949 | Cycle 1(1): loaded http://localhost:59054/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:59054/tests/kraken/driver.html?testName=stanford-crypto-ccm) 19:28:23 INFO - PROCESS | 12949 | RSS: Main: 165335040 19:28:23 INFO - PROCESS | 12949 | 19:28:26 INFO - PROCESS | 12949 | Cycle 1(1): loaded http://localhost:59054/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:59054/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 19:28:26 INFO - PROCESS | 12949 | RSS: Main: 165752832 19:28:26 INFO - PROCESS | 12949 | 19:28:29 INFO - PROCESS | 12949 | Cycle 1(1): loaded http://localhost:59054/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:59054/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 19:28:30 INFO - PROCESS | 12949 | RSS: Main: 165883904 19:28:30 INFO - PROCESS | 12949 | 19:28:32 INFO - PROCESS | 12949 | Cycle 1(1): loaded http://localhost:59054/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:59054/tests/kraken/driver.html?testName=ai-astar) 19:28:32 INFO - PROCESS | 12949 | RSS: Main: 166998016 19:28:32 INFO - PROCESS | 12949 | 19:28:32 INFO - PROCESS | 12949 | __start_tp_report 19:28:32 INFO - PROCESS | 12949 | _x_x_mozilla_page_load 19:28:32 INFO - PROCESS | 12949 | _x_x_mozilla_page_load_details 19:28:32 INFO - PROCESS | 12949 | |i|pagename|runs| 19:28:32 INFO - PROCESS | 12949 | |0;ai-astar;114;109;116;113;115;126;117;115;115;114 19:28:32 INFO - PROCESS | 12949 | |1;audio-beat-detection;158;133;153;196;132;171;165;143;193;131 19:28:32 INFO - PROCESS | 12949 | |2;audio-dft;162;168;166;174;165;161;163;164;166;163 19:28:32 INFO - PROCESS | 12949 | |3;audio-fft;75;76;77;170;79;73;73;77;157;77 19:28:32 INFO - PROCESS | 12949 | |4;audio-oscillator;95;96;151;95;95;94;140;98;97;142 19:28:32 INFO - PROCESS | 12949 | |5;imaging-gaussian-blur;116;117;117;118;117;118;118;121;121;118 19:28:32 INFO - PROCESS | 12949 | |6;imaging-darkroom;147;147;147;149;149;148;146;147;148;147 19:28:32 INFO - PROCESS | 12949 | |7;imaging-desaturate;95;96;96;96;96;97;97;97;97;96 19:28:32 INFO - PROCESS | 12949 | |8;json-parse-financial;66;65;66;65;67;65;69;90;64;63 19:28:32 INFO - PROCESS | 12949 | |9;json-stringify-tinderbox;65;64;64;65;64;65;63;64;64;65 19:28:32 INFO - PROCESS | 12949 | |10;stanford-crypto-aes;85;87;86;87;85;85;85;85;87;85 19:28:32 INFO - PROCESS | 12949 | |11;stanford-crypto-ccm;142;148;142;141;143;143;140;152;178;143 19:28:32 INFO - PROCESS | 12949 | |12;stanford-crypto-pbkdf2;175;176;178;173;172;173;173;174;177;179 19:28:32 INFO - PROCESS | 12949 | |13;stanford-crypto-sha256-iterative;74;73;73;73;75;74;75;73;71;72 19:28:32 INFO - PROCESS | 12949 | __end_tp_report 19:28:32 INFO - PROCESS | 12949 | __start_cc_report 19:28:32 INFO - PROCESS | 12949 | _x_x_mozilla_cycle_collect,911 19:28:32 INFO - PROCESS | 12949 | __end_cc_report 19:28:32 INFO - PROCESS | 12949 | __startTimestamp1460600912467__endTimestamp 19:28:32 INFO - PROCESS | 12949 | 19:28:32 INFO - PROCESS | 12949 | ------- Summary: start ------- 19:28:32 INFO - PROCESS | 12949 | Number of tests: 14 19:28:32 INFO - PROCESS | 12949 | 19:28:32 INFO - PROCESS | 12949 | [#0] ai-astar Cycles:10 Average:115.40 Median:115.00 stddev:4.30 (3.7%) stddev-sans-first:4.53 19:28:32 INFO - PROCESS | 12949 | Values: 114.0 109.0 116.0 113.0 115.0 126.0 117.0 115.0 115.0 114.0 19:28:32 INFO - PROCESS | 12949 | 19:28:32 INFO - PROCESS | 12949 | [#1] audio-beat-detection Cycles:10 Average:157.50 Median:161.50 stddev:23.95 (14.8%) stddev-sans-first:25.41 19:28:32 INFO - PROCESS | 12949 | Values: 158.0 133.0 153.0 196.0 132.0 171.0 165.0 143.0 193.0 131.0 19:28:32 INFO - PROCESS | 12949 | 19:28:32 INFO - PROCESS | 12949 | [#2] audio-dft Cycles:10 Average:165.20 Median:165.50 stddev:3.74 (2.3%) stddev-sans-first:3.78 19:28:32 INFO - PROCESS | 12949 | Values: 162.0 168.0 166.0 174.0 165.0 161.0 163.0 164.0 166.0 163.0 19:28:32 INFO - PROCESS | 12949 | 19:28:32 INFO - PROCESS | 12949 | [#3] audio-fft Cycles:10 Average:93.40 Median:76.50 stddev:37.12 (48.5%) stddev-sans-first:38.77 19:28:32 INFO - PROCESS | 12949 | Values: 75.0 76.0 77.0 170.0 79.0 73.0 73.0 77.0 157.0 77.0 19:28:32 INFO - PROCESS | 12949 | 19:28:32 INFO - PROCESS | 12949 | [#4] audio-oscillator Cycles:10 Average:110.30 Median:95.00 stddev:23.67 (24.9%) stddev-sans-first:24.45 19:28:32 INFO - PROCESS | 12949 | Values: 95.0 96.0 151.0 95.0 95.0 94.0 140.0 98.0 97.0 142.0 19:28:32 INFO - PROCESS | 12949 | 19:28:32 INFO - PROCESS | 12949 | [#5] imaging-gaussian-blur Cycles:10 Average:118.10 Median:118.00 stddev:1.66 (1.4%) stddev-sans-first:1.58 19:28:32 INFO - PROCESS | 12949 | Values: 116.0 117.0 117.0 118.0 117.0 118.0 118.0 121.0 121.0 118.0 19:28:32 INFO - PROCESS | 12949 | 19:28:32 INFO - PROCESS | 12949 | [#6] imaging-darkroom Cycles:10 Average:147.50 Median:147.50 stddev:0.97 (0.7%) stddev-sans-first:1.01 19:28:32 INFO - PROCESS | 12949 | Values: 147.0 147.0 147.0 149.0 149.0 148.0 146.0 147.0 148.0 147.0 19:28:32 INFO - PROCESS | 12949 | 19:28:32 INFO - PROCESS | 12949 | [#7] imaging-desaturate Cycles:10 Average:96.30 Median:96.50 stddev:0.67 (0.7%) stddev-sans-first:0.53 19:28:32 INFO - PROCESS | 12949 | Values: 95.0 96.0 96.0 96.0 96.0 97.0 97.0 97.0 97.0 96.0 19:28:32 INFO - PROCESS | 12949 | 19:28:32 INFO - PROCESS | 12949 | [#8] json-parse-financial Cycles:10 Average:68.00 Median:66.00 stddev:7.90 (12.0%) stddev-sans-first:8.35 19:28:32 INFO - PROCESS | 12949 | Values: 66.0 65.0 66.0 65.0 67.0 65.0 69.0 90.0 64.0 63.0 19:28:32 INFO - PROCESS | 12949 | 19:28:32 INFO - PROCESS | 12949 | [#9] json-stringify-tinderbox Cycles:10 Average:64.30 Median:64.50 stddev:0.67 (1.0%) stddev-sans-first:0.67 19:28:32 INFO - PROCESS | 12949 | Values: 65.0 64.0 64.0 65.0 64.0 65.0 63.0 64.0 64.0 65.0 19:28:32 INFO - PROCESS | 12949 | 19:28:32 INFO - PROCESS | 12949 | [#10] stanford-crypto-aes Cycles:10 Average:85.70 Median:85.50 stddev:0.95 (1.1%) stddev-sans-first:0.97 19:28:32 INFO - PROCESS | 12949 | Values: 85.0 87.0 86.0 87.0 85.0 85.0 85.0 85.0 87.0 85.0 19:28:32 INFO - PROCESS | 12949 | 19:28:32 INFO - PROCESS | 12949 | [#11] stanford-crypto-ccm Cycles:10 Average:147.20 Median:143.00 stddev:11.40 (8.0%) stddev-sans-first:11.94 19:28:32 INFO - PROCESS | 12949 | Values: 142.0 148.0 142.0 141.0 143.0 143.0 140.0 152.0 178.0 143.0 19:28:32 INFO - PROCESS | 12949 | 19:28:32 INFO - PROCESS | 12949 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:175.00 Median:175.50 stddev:2.40 (1.4%) stddev-sans-first:2.55 19:28:32 INFO - PROCESS | 12949 | Values: 175.0 176.0 178.0 173.0 172.0 173.0 173.0 174.0 177.0 179.0 19:28:32 INFO - PROCESS | 12949 | 19:28:32 INFO - PROCESS | 12949 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:73.30 Median:73.50 stddev:1.25 (1.7%) stddev-sans-first:1.30 19:28:32 INFO - PROCESS | 12949 | Values: 74.0 73.0 73.0 73.0 75.0 74.0 75.0 73.0 71.0 72.0 19:28:32 INFO - PROCESS | 12949 | -------- Summary: end -------- 19:28:32 INFO - PROCESS | 12949 | 19:28:33 INFO - TEST-INFO | 12949: exit 0 19:28:33 INFO - TEST-OK | kraken | took 64130ms 19:28:33 INFO - SUITE-END | took 1179s 19:28:33 INFO - Completed test suite (00:19:39) 19:28:33 INFO - javascript benchmark 19:28:33 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2652.191081720075, 2703.8783254753534, 2728.5225085610014, 2747.1346525844356, 2750.8349499030046, 4716.221823399143, 4744.620430365571, 4753.572178503934, 4780.163471392505, 4836.564709176174, 4733.266343716721, 4790.856274311767, 4801.495842936485, 4813.133635945528, 4815.181419158743, 4317.373980772786, 4380.01449673824, 4417.602415782579, 4469.776511174445, 4531.297648864414, 4462.1075784843, 4489.61838243748, 4509.751963641998, 4526.049529598772, 4548.1585906607215, 4368.301071828524, 4441.755703436342, 4468.4414448193975, 4507.639388848901, 4525.615322697558, 4372.715773474714, 4380.9923717544825, 4382.452193475816, 4394.890127746832, 4449.9555004450185, 4323.265044942367, 4337.652987760972, 4340.262155433584, 4375.496817865955, 4388.429504164438, 4582.6104781093645, 4654.162250794856, 4697.95302046982, 4728.101660684459, 4733.124371991193, 5032.6477146599755, 5039.0, 5082.745862706887, 5084.110280700863, 5103.923441148386, 5063.417706963673, 5098.97450512745, 5105.055564720538, 5109.744512774347, 5159.432462429129, 4773.737444440554, 4808.447028591687, 4815.0, 4829.420469543642, 4845.3216549683075, 5239.973800131052, 5244.501772331622, 5270.631055826056, 5277.656952298088, 5277.841664749987, 4946.554810067039, 4968.6025117990475, 5027.899442011139, 5038.193888977746, 5044.445111037783, 5057.747112644353, 5110.4123025852505, 5119.078565858182, 5128.0, 5166.380034395821, 5031.119554078022, 5043.747812609355, 5048.848534543969, 5063.518965698253, 5110.412302585176, 4923.852284431473, 5003.349564556657, 5015.097282489187, 5029.4719054498755, 5046.571041461517, 4230.978845105755, 4254.638355739735, 4288.742675439484, 4329.761863097497, 4389.956100438954, 3780.8865734028022, 3832.6550610445192, 3846.9038274042814, 3849.9807500962315, 3872.283627528916, 4384.342348647665, 4488.236999710057, 4490.820367185276, 4522.118186953512, 4527.492266240868, 4933.703977761345, 4954.975225123923, 4962.851114466572, 4971.602271818246, 5013.047520971004, 4428.800703968329, 4446.9777651111535, 4457.0, 4498.572635599613, 4516.119356725473, 4580.1984652686315, 4590.150822097856, 4600.493945665974, 4624.560666736655, 4680.08738296029, 4899.485554016848, 4957.405111386656, 4970.801167953241, 4972.179590367621, 4984.526469985346, 5137.768800403916, 5171.3535808024, 5182.041322355376, 5190.636655434235, 5234.162533994542, 4794.568488836021, 4876.4392094909535, 4915.0415668944215, 4937.407511098691, 4939.407271127488, 5045.899082018265, 5075.0, 5095.312132862165, 5111.897762044664, 5139.177731562932, 5160.380754309507, 5166.896662066662, 5176.870578235424, 5184.040952423814, 5211.713355765318, 4873.512648735098, 4903.95096049035, 4962.454130045764, 5011.899762004812, 5023.773930173078, 4922.72924989129, 4955.157623204136, 4965.627577931597, 4975.552200301845, 5012.498750124958, 4875.512448755097, 4895.04546613407, 4912.48418916023, 4920.6801557898625, 4949.678270912379, 4890.266460031024, 4906.92639610399, 5027.321311622884, 5058.443571207091, 5067.898642027065, 4848.321235027029, 4902.60779137661, 4907.901841963212, 4908.312836203006, 4932.432770231326], "value": 4704.516914116773, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [568.6588047171695, 606.3148642034502, 621.4686443091155, 627.4384425938784, 637.6875331087768, 32155.839220803922, 33181.83409082954, 33231.83384083079, 33296.33407331858, 33451.49822752661, 33879.0, 34131.14672133192, 34165.82917085417, 34217.828910855475, 34287.0, 7451.888221676679, 7622.5426474411715, 7641.694332226704, 7643.61781910905, 7647.885281720779, 7595.696172153107, 7751.22487751226, 7752.534847909115, 7753.0, 7759.0689117306, 7759.45683802134, 7769.572673502955, 7818.843623127563, 7820.491668041587, 7829.256220659056, 7657.808554786119, 7730.18833022533, 7754.612269386508, 7759.262870027338, 7772.417068719868, 7684.615769211573, 7750.806229844299, 7771.611419429006, 7779.922200777976, 7780.260875216845, 31788.841055794805, 34115.829420852984, 34558.82720586406, 34717.82641086804, 35012.64987350145, 2866.1688110447944, 2938.750206232473, 2940.926476838075, 2954.6749857515656, 3015.366772977677, 24381.268561942994, 24661.383465413328, 24757.13350032758, 24877.50244995108, 24879.378015549573, 3236.91907702307, 3289.3750187464307, 3323.551320571716, 3325.985574399807, 3347.7991320520605, 152175.0, 152378.9999999989, 152621.2368938148, 152766.41700748994, 153151.0, 31908.521372179435, 32057.0, 32135.678643213738, 32216.83891580527, 32226.83886580552, 33231.0, 33426.0, 62575.37424625787, 63575.36424635787, 64246.35753642404, 14112.647183820487, 14331.355089021019, 14336.0, 14341.211233382264, 14349.354279057468, 11438.313701177956, 11574.768504629861, 11575.247608905394, 11586.942065289788, 11599.942000290113, 18223.362182323555, 18265.817341826412, 18522.259109635463, 18586.628267434848, 18604.906975465037, 6838.418734407532, 6893.896591551131, 6898.413634840995, 7000.789976300617, 7139.607321597362, 830.0495932157646, 898.3127907151035, 956.9473678947725, 961.8172547216006, 1100.3178029621686, 27304.180874573794, 28190.85904570505, 28401.431971360456, 28436.980163150485, 28510.00214992507, 995.4624502768424, 1014.9797004059877, 1063.9148868090533, 1129.9039581635489, 1137.726945533066, 14651.633709157144, 14977.502249774936, 15058.698826023417, 15285.465008724641, 15467.767983480257, 339548.83609311195, 342952.0, 345016.0, 347515.0, 351427.0, 48577.75711121422, 49243.26135107976, 49419.50580494221, 49458.50541494611, 49500.25749613759, 1140.766142940695, 1194.4684615346262, 1201.987980120205, 1214.131895694565, 1220.2068655374078, 26579.810422749393, 27728.722712772615, 27751.444971100867, 27853.303667407665, 28179.0, 42512.78743606262, 42544.0, 42556.78721606372, 43065.56934430741, 43132.353014704175, 303598.0, 304593.0, 305259.0, 305823.0, 308146.0, 23604.29187124389, 23684.171054013026, 23779.64330535078, 23812.404689882893, 38099.238015240095, 36437.63562364342, 36964.63035369612, 37205.6279437213, 37578.812105939294, 37580.43629345507, 34209.486857696655, 34283.0, 34302.313953721285, 34838.82580587081, 36009.459858101625, 34464.31071378508, 34634.307313854086, 34781.826090870396, 34786.82606586951, 34985.65014349824, 31576.684233157375, 34049.14877128092, 35094.0, 36629.81685091557, 37241.0, 29038.274043148245, 29775.255618609706, 30406.391872161992, 31401.371972559962, 31795.36409271848, 24565.877170614032, 24787.380315492257, 25018.62472062957, 25172.232630525134, 25462.23613291604], "value": 16596.94807996203, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [385.39108209029735, 388.6191532298346, 388.87555982085723, 397.4566689019526, 397.67390739593543, 12971.935140324285, 15609.21953902306, 15894.602634934117, 16426.67146657066, 16520.421785237504, 16025.759613605805, 16290.674186516293, 16393.590160246, 17595.0, 17741.29034838605, 4443.355713421552, 5203.271541984125, 5237.528622423981, 5288.365396152448, 5407.5133238008575, 5254.133068043769, 5273.709945952971, 5297.311349524575, 5313.654612450178, 5314.149736042234, 5025.698458092508, 5252.606054545905, 5262.947370526284, 5276.841694749163, 5284.39229488608, 5199.844004679866, 5200.323957885451, 5226.320578324793, 5234.293370394986, 5236.6857988520815, 4644.117617652635, 4655.557722016403, 4668.346431499593, 4669.836555720567, 4955.603551715854, 12264.44809983544, 12604.0, 12606.936965315206, 12749.043821713316, 12776.61670149897, 1792.3905872003581, 1799.1813724755204, 1821.9180136893872, 1826.9451916442529, 1845.1051240148518, 9016.684416045473, 9305.581248843819, 9313.580888860017, 9319.213915154163, 9406.811863762687, 1726.9126329687824, 1732.8960262384298, 1738.113562083334, 1753.2461041752042, 1765.757487990258, 60229.6988515059, 64210.67894660497, 71594.2840571598, 73475.63262183708, 74939.0, 9927.751806204902, 10007.399556026661, 10064.295499315123, 10065.396076235449, 10480.68557943263, 12805.615831525069, 13438.462461501626, 14251.0, 14275.85724142766, 14344.426222950966, 5978.790742324085, 6113.32753397126, 6698.966505167443, 7529.887051694229, 7576.166621671612, 7121.608311542915, 7289.2346303638415, 7316.890246646304, 7362.595057271795, 7405.851882962311, 4350.71720338177, 4359.869203923888, 4472.9776351118035, 4510.21071312519, 4515.571020753023, 1819.5170935687372, 1864.6736821056531, 1879.1543805287674, 1897.2600685732575, 1916.865819392657, 809.2918696140877, 925.1904583489446, 956.7416797464646, 960.8606752020918, 973.0366936732584, 16332.346706131859, 16919.407820726214, 17140.742888856676, 17185.1407429628, 17237.741433878502, 867.4361664917853, 874.2568816505919, 919.8436265834824, 928.8467402878449, 929.8326301265837, 9401.341906066646, 9548.856767148498, 9580.0, 9637.277204209571, 9735.65925192629, 401044.0, 403565.0, 411287.0, 416048.0, 417625.0, 65656.67171664111, 70182.59634807377, 74263.62868185733, 78806.21193787988, 79836.0, 960.1166926427703, 980.1325826643472, 997.6757553795046, 1000.8098461292477, 1004.8492726091145, 14625.122492650475, 15406.92296538555, 15489.5353139406, 15581.454649087227, 15969.20153992319, 22708.0, 23364.415889602897, 34551.65448345484, 35150.29699405946, 35947.0, 44794.3280850781, 45710.54289457063, 49120.75439622779, 49301.75349123232, 49688.503114968385, 7345.412367010519, 7875.291223789886, 8035.799105022421, 8137.79655508617, 8198.42611017247, 8420.789480262798, 10930.0, 11072.948069933344, 11618.419079046183, 11852.881471185177, 9840.950795245977, 9961.252906031932, 10116.59533618647, 10204.693859184237, 10227.48862556884, 9316.813663726552, 9479.763005924631, 9636.42181469114, 10005.099541041342, 10245.692629221136, 6916.446684265347, 7364.705411783469, 7551.433642476946, 7804.9609751950875, 9844.60621575129, 10701.448289998063, 10963.890361096286, 11363.772724545628, 11507.769844603228, 11712.297262164297, 7466.290702383265, 10565.366078035342, 10968.780624387628, 11152.107831373309, 11276.154288428237], "value": 8025.205336936926, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1426.4294282287087, 1442.3365251984087, 1587.9603009924751, 1734.947951561452, 1747.7815273090864, 6803.659817009142, 7571.31858132768, 7582.355499782519, 7847.92152078479, 7854.960725196381, 7584.279493448127, 7682.078150621919, 7717.6912923483, 7754.0695116586085, 7780.221977802217, 2247.606668832956, 2311.2719493359623, 2312.560613483441, 2316.536692661466, 2316.5830150572974, 2244.786745259206, 2263.671767593698, 2271.5684020036224, 2277.749447560767, 2284.097781376355, 2275.4311422144465, 2282.2012295696454, 2287.553926984239, 2294.506681063571, 2305.827062970284, 2210.35899589119, 2210.45843768277, 2212.325240801555, 2215.7562668106575, 2225.054351900436, 2210.115953618549, 2211.292386436341, 2220.4781876259067, 2229.030371788277, 2232.7320721513524, 7887.447878648497, 7900.051993760785, 7937.920620793776, 7954.9602251988945, 7976.322012628933, 4661.813527458931, 4784.40194975628, 4803.159447096744, 4813.85558433244, 4822.228443449031, 2924.8683809228637, 3033.9089827305215, 3046.8019578727312, 3073.0, 3101.984490077558, 853.607340623314, 854.598338780772, 858.0732808566733, 862.9827403451959, 868.1058509734983, 10356.378617282988, 10745.194110441747, 10767.192460565411, 10779.08377787889, 10789.460526973699, 4293.6779741518885, 4304.289792184317, 4417.712848664826, 4421.602055814992, 4566.611837993808, 9195.816083678288, 9255.953720231355, 9284.071592840663, 9317.953410232905, 9347.766305842408, 4807.6394270429855, 4864.683795553277, 4870.975645121752, 4879.121758083508, 4881.926771098437, 3853.383458646659, 4309.310510318334, 4400.405945197422, 4400.9119817604105, 4429.889252768642, 3795.203007368428, 3797.6392242736897, 3827.6746476549247, 3950.4469374287046, 3967.6429121379215, 1232.1990706041145, 1267.4866678995022, 1270.7013851744832, 1271.3452571925466, 1279.7440511897657, 867.150192811036, 869.2871845087094, 884.3500027479797, 893.5308962794455, 900.5137225898072, 5550.7779688812, 5573.526250268773, 5629.662220266797, 5756.25168728071, 5830.5044071254415, 887.7070566712969, 935.6771913689767, 947.0624082158613, 951.8191543606692, 980.1374790184592, 3778.6221377861993, 3850.133719912997, 3905.9609403906165, 3933.665638420709, 3943.033956680574, 9242.584083716249, 9498.050194980447, 9535.332526723201, 9639.132478076866, 9654.662086826927, 9450.810983780424, 9525.28560357976, 9545.236381089497, 9568.0, 9576.90423095774, 7062.823429414306, 7282.599457029808, 7424.406047516186, 7432.814179645444, 7451.85096298071, 5422.6475279106735, 5490.972545137249, 5535.944640553543, 5641.9435805641415, 5673.801416950387, 8932.374733768575, 8957.865632015655, 9014.0, 9066.09339066088, 9183.632654693738, 8386.832263354821, 8806.867896981423, 8818.426802257833, 8821.603027863634, 9191.494467804336, 6167.321594624677, 6623.536352455282, 6690.899636505359, 6812.523123381316, 6846.349596788297, 7412.703491860265, 7440.925590744023, 7480.0, 7483.289087536676, 7486.775396738107, 6531.248906375828, 6751.291114432914, 6800.52396332252, 6820.556663816836, 6931.826704332432, 6381.649009304533, 6478.708458119301, 6749.493787965824, 6756.324367563205, 6808.0, 6422.454091402096, 6478.805635830932, 6517.631297427593, 6544.345565443417, 6554.80335589933, 4899.632527560376, 4917.655764096479, 4924.310596516419, 5073.315102461121, 5090.516400941905, 4887.90224195507, 4902.338184345068, 4924.285978533021, 4944.357233559758, 5011.448740638454], "value": 4259.478612486526, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [318.0, 325.094611506953, 328.1124558070419, 330.3920785754212, 336.3944899181476, 5224.7387630618505, 5340.813071542497, 5350.812721554741, 5360.2763626910355, 5376.838694839152, 5241.9213711794355, 5244.0, 5247.501487358704, 5253.842384728455, 5264.210368444736, 3854.092224348944, 3974.9006274843214, 4097.79511024449, 4107.383892416146, 4112.157007813391, 4067.532233793122, 4093.7543747375103, 4098.426220329156, 4099.221147981889, 4118.608732170439, 4059.1678705865374, 4060.3503439449696, 4066.4103704962763, 4067.3898915162667, 4091.488563929509, 3838.2899163654533, 4033.4958130233426, 4061.472008638858, 4065.0650350419273, 4079.9592004079877, 3492.7555071144775, 3503.5970863350785, 3506.8246587670515, 3510.6834936898663, 3521.383757842393, 5045.318881950963, 5047.671901326402, 5049.671771334852, 5049.974750126263, 5052.216906379517, 4475.172093162775, 4546.946325745135, 4612.561806628365, 4628.305754136873, 4635.46692130406, 5505.532029777473, 5512.862178445531, 5530.225768392428, 5531.25328080708, 5553.500184983331, 3831.5593706723803, 3832.367659336206, 3833.0, 3852.4413959975927, 3861.6524512793985, 5685.5167310778215, 5710.744256018849, 5781.103928891029, 5839.124131380285, 5852.853678658025, 3939.2712348215673, 3964.6035396460125, 3975.1652153048185, 3987.7806720630642, 3995.900102497461, 3990.580988996114, 4005.759654420744, 4019.2363450944226, 4025.3358195897936, 4027.013381721497, 4640.767961601907, 4656.534346565317, 4660.720356778536, 4678.087772884255, 4687.437507499054, 5471.863203419946, 5529.0, 5569.415211402826, 5602.85992850182, 5609.102543593006, 1365.6790654196257, 1381.6183816183816, 1391.2139641102744, 1399.3353157250428, 1401.061288936415, 880.0451510111473, 899.5547204133995, 908.40953380302, 911.589784596934, 919.7056941778567, 4872.9544034978135, 4912.336834527365, 4914.754262286871, 4924.7537623119415, 4933.925991110136, 5670.914936275959, 5686.34607020198, 5691.0609749391715, 5699.544036477072, 5713.657180569179, 4685.508021657745, 4940.580050695731, 4941.283513890466, 4951.232558953368, 4985.501449855058, 3052.1759125036115, 3078.107348868803, 3081.337512434837, 3085.2259950528537, 3107.254258977829, 5536.785285885598, 5542.002439560918, 5542.91685624716, 5543.944560554342, 5561.388247292794, 5794.333651630117, 5904.911426328608, 5939.10913362999, 5961.463468287875, 5972.581919265696, 5519.558435325164, 5536.307961504812, 5537.58468114893, 5537.750801213874, 5545.805896793673, 5557.444255574572, 5696.544276457957, 5720.3421606515785, 5746.569007324551, 5767.0, 5639.464250896158, 5642.633228840113, 5659.830205093689, 5676.659400435987, 5685.573581981451, 5449.6730196188355, 5479.780808767605, 5509.421510741315, 5522.696251706195, 5528.336599608073, 3684.6683798458266, 3875.0, 3924.1151260252714, 3969.1664750401583, 4009.2382447334912, 5626.774929002794, 5658.773649053992, 5670.262865827416, 5675.602707810413, 5694.316681998187, 5354.491323324278, 5423.511883930465, 5430.864228394322, 5446.863828404322, 5453.372862120907, 5300.443453437488, 5394.0, 5555.0834112371, 5592.133219351007, 5623.493885550157, 5179.834537229244, 5447.4824891635235, 5490.258815059916, 5498.147787093007, 5511.53151982086, 5387.3804512481565, 5587.7485513152815, 5589.273394458694, 5595.692236927008, 5599.664020158803, 5449.155380915964, 5456.781728730806, 5457.836264912059, 5472.835814925558, 5477.315335583052], "value": 4156.3110585104805, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [676.4284179868012, 704.6617623540702, 707.2997732245076, 714.2714431280091, 724.4096061709706, 11277.943610281947, 12086.939565302173, 12271.325077120755, 12290.262584244952, 12309.0, 12076.215046022024, 12092.879071209285, 12113.394330283494, 12118.21231619944, 12118.81821772674, 609.3327806052365, 775.7750252426789, 788.7357735158714, 795.7612716185122, 795.9164287749761, 791.2325044706625, 793.6468271619132, 798.1220657276978, 799.7200979657102, 802.2058162419193, 839.215333663027, 839.8950131233596, 840.1304649687575, 844.8099177685002, 847.8431490174306, 837.623069618668, 837.945533540321, 841.0538144587339, 842.2167384332569, 844.4553263145299, 606.5784279925454, 613.1722175063672, 615.6890770161085, 617.8856911471393, 618.7215752911208, 11602.361870097142, 11612.0, 11626.767464650744, 11651.067914566815, 11664.6500604982, 12621.93689031549, 12838.358082095858, 12858.540169904769, 12876.22742635445, 12918.741625167444, 9566.378185417996, 9590.6643267486, 9711.757206069835, 9732.513374331325, 9994.850077248848, 3332.7333813294877, 3354.2788300515263, 3375.696187343151, 3390.3727810355163, 3391.1352605085544, 47651.285230721565, 48700.75649621765, 49058.50941490575, 49264.261036084485, 49410.7529462354, 9797.007434299012, 9855.852162217572, 9863.0, 9945.900540994642, 10130.189584833195, 15576.376944922304, 15626.0, 15669.0, 15746.76379854303, 15809.920950395404, 6515.674216289167, 6547.345265473415, 6585.604863708097, 6618.205815302194, 6654.201495820533, 3627.6735093841153, 3649.288388764219, 3649.908752281214, 3689.538807649044, 3702.074481379655, 2892.233558107061, 3011.56332331815, 3011.9397612047637, 3017.6227971503563, 3018.154916623349, 546.6829239041347, 555.0868820789779, 555.416812347034, 561.2535328013732, 562.2353599105213, 624.1947887225429, 635.640862912453, 643.6635014895897, 644.0664509854493, 647.3073811022161, 7688.538687678757, 7794.2985131338455, 7988.001499812523, 8004.959975200087, 8241.093479717227, 609.9146119543268, 616.9383061693884, 640.4460141977249, 640.961542307463, 665.1153965226238, 3735.701143908481, 3774.7735135891935, 3810.561785394715, 3853.190829925691, 3880.78655673935, 52292.0, 52332.86002839842, 53164.46835531595, 53300.466995330324, 53676.0, 44107.55892441099, 44402.77798610986, 44869.775651121534, 45061.324080138824, 45149.322760158626, 40081.0, 41380.0, 41802.0, 42225.57774422278, 42302.788486057376, 7150.392216661434, 7272.96363518179, 7437.925620743723, 7477.364424024019, 7495.400367970658, 27601.171964841087, 27936.30159245954, 28107.0, 28124.0, 28811.42377152487, 33735.83132084422, 36809.89570312895, 36912.0, 37013.44479832751, 37240.441393378576, 9364.194728149778, 9468.573914174016, 9509.572069257038, 9818.950905245429, 10414.583416663248, 11607.477663505331, 11667.6499705009, 11779.52881884715, 11809.763804723685, 11811.350375729417, 11402.657920262405, 11666.76666466649, 11861.406929653655, 12000.15998880105, 12078.75842483163, 11429.257098288585, 11457.19799614019, 11476.942615286871, 11549.42252887369, 11602.361870097226, 11123.777524449628, 11125.554977800797, 11170.944145279222, 11377.658670239905, 11494.137939654727, 9546.57040433196, 10017.994601619339, 10084.344517606332, 10287.897121028695, 10297.794044119226, 9411.952940235255, 9708.951455242679, 9750.707478775648, 9772.804543909224, 10033.648822291185], "value": 5917.245830125353, "unit": "score"}], "name": "dromaeo_css", "value": 6351.421684838448, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [114.0, 109.0, 116.0, 113.0, 115.0, 126.0, 117.0, 115.0, 115.0, 114.0], "value": 115.4, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [158.0, 133.0, 153.0, 196.0, 132.0, 171.0, 165.0, 143.0, 193.0, 131.0], "value": 157.5, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [162.0, 168.0, 166.0, 174.0, 165.0, 161.0, 163.0, 164.0, 166.0, 163.0], "value": 165.2, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 76.0, 77.0, 170.0, 79.0, 73.0, 73.0, 77.0, 157.0, 77.0], "value": 93.4, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 96.0, 151.0, 95.0, 95.0, 94.0, 140.0, 98.0, 97.0, 142.0], "value": 110.3, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [116.0, 117.0, 117.0, 118.0, 117.0, 118.0, 118.0, 121.0, 121.0, 118.0], "value": 118.1, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 147.0, 147.0, 149.0, 149.0, 148.0, 146.0, 147.0, 148.0, 147.0], "value": 147.5, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 96.0, 96.0, 96.0, 96.0, 97.0, 97.0, 97.0, 97.0, 96.0], "value": 96.3, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [66.0, 65.0, 66.0, 65.0, 67.0, 65.0, 69.0, 90.0, 64.0, 63.0], "value": 68.0, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [65.0, 64.0, 64.0, 65.0, 64.0, 65.0, 63.0, 64.0, 64.0, 65.0], "value": 64.3, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 87.0, 86.0, 87.0, 85.0, 85.0, 85.0, 85.0, 87.0, 85.0], "value": 85.7, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [142.0, 148.0, 142.0, 141.0, 143.0, 143.0, 140.0, 152.0, 178.0, 143.0], "value": 147.2, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [175.0, 176.0, 178.0, 173.0, 172.0, 173.0, 173.0, 174.0, 177.0, 179.0], "value": 175.0, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [74.0, 73.0, 73.0, 73.0, 75.0, 74.0, 75.0, 73.0, 71.0, 72.0], "value": 73.3, "unit": "score"}], "name": "kraken", "value": 1617.1999999999998, "alertThreshold": 2.0}]} 19:28:33 INFO - Return code: 0 19:28:33 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 19:28:33 ERROR - # TBPL SUCCESS # 19:28:33 INFO - Running post-action listener: _resource_record_post_action 19:28:33 INFO - Running post-run listener: _resource_record_post_run 19:28:34 INFO - Total resource usage - Wall time: 1197s; CPU: 13.0%; Read bytes: 28672; Write bytes: 531742720; Read time: 216; Write time: 485348 19:28:34 INFO - install - Wall time: 16s; CPU: 14.0%; Read bytes: 0; Write bytes: 233607168; Read time: 0; Write time: 278704 19:28:34 INFO - run-tests - Wall time: 1181s; CPU: 13.0%; Read bytes: 28672; Write bytes: 298135552; Read time: 216; Write time: 206644 19:28:34 INFO - Running post-run listener: _upload_blobber_files 19:28:34 INFO - Blob upload gear active. 19:28:34 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 19:28:34 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 19:28:34 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Fx-Team-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 19:28:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Fx-Team-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 19:28:35 INFO - (blobuploader) - INFO - Open directory for files ... 19:28:35 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 19:28:35 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 19:28:35 INFO - (blobuploader) - INFO - Uploading, attempt #1. 19:28:36 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 19:28:36 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 19:28:36 INFO - (blobuploader) - INFO - Done attempting. 19:28:36 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 19:28:36 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 19:28:36 INFO - (blobuploader) - INFO - Uploading, attempt #1. 19:28:37 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 19:28:37 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 19:28:37 INFO - (blobuploader) - INFO - Done attempting. 19:28:37 INFO - (blobuploader) - INFO - Iteration through files over. 19:28:37 INFO - Return code: 0 19:28:37 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 19:28:37 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 19:28:37 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/938fdd049d30956bc1d70b140f4bcb1cd494cdd0d5a4eab117756db6ac304b049f583660e8bc8dae1d52fbf49311e1e6050c7226e199372d3e8fb121cd8e48e0", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/a042a20dada3e12c41ad384f21f79b81f00ca22899236c9a32da108343b32058dc6417ce17e92a7d4bafde15d34327709db661b636452667539ac9baffe337fa"} 19:28:37 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 19:28:37 INFO - Writing to file /builds/slave/test/properties/blobber_files 19:28:37 INFO - Contents: 19:28:37 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/938fdd049d30956bc1d70b140f4bcb1cd494cdd0d5a4eab117756db6ac304b049f583660e8bc8dae1d52fbf49311e1e6050c7226e199372d3e8fb121cd8e48e0", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/a042a20dada3e12c41ad384f21f79b81f00ca22899236c9a32da108343b32058dc6417ce17e92a7d4bafde15d34327709db661b636452667539ac9baffe337fa"} 19:28:37 INFO - Running post-run listener: copy_logs_to_upload_dir 19:28:37 INFO - Copying logs to upload dir... 19:28:37 INFO - mkdir: /builds/slave/test/build/upload/logs 19:28:37 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1249.127649 ========= master_lag: 0.03 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 49 secs) (at 2016-04-13 19:28:37.084894) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-13 19:28:37.088074) ========= 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=03627c79f6bb3d1578c4a402000001ba-1460594001.820813-1409371344 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/938fdd049d30956bc1d70b140f4bcb1cd494cdd0d5a4eab117756db6ac304b049f583660e8bc8dae1d52fbf49311e1e6050c7226e199372d3e8fb121cd8e48e0", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/a042a20dada3e12c41ad384f21f79b81f00ca22899236c9a32da108343b32058dc6417ce17e92a7d4bafde15d34327709db661b636452667539ac9baffe337fa"} build_url:https://queue.taskcluster.net/v1/task/AE8TDcyfQayrCyyQaRTJSQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011402 build_url: 'https://queue.taskcluster.net/v1/task/AE8TDcyfQayrCyyQaRTJSQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/938fdd049d30956bc1d70b140f4bcb1cd494cdd0d5a4eab117756db6ac304b049f583660e8bc8dae1d52fbf49311e1e6050c7226e199372d3e8fb121cd8e48e0", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/a042a20dada3e12c41ad384f21f79b81f00ca22899236c9a32da108343b32058dc6417ce17e92a7d4bafde15d34327709db661b636452667539ac9baffe337fa"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-13 19:28:37.113019) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-13 19:28:37.113395) ========= 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=03627c79f6bb3d1578c4a402000001ba-1460594001.820813-1409371344 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004513 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-13 19:28:37.195512) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-13 19:28:37.195868) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-13 19:28:37.196219) ========= ========= Total master_lag: 0.45 =========