builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-018 starttime: 1460040440.17 results: success (0) buildid: 20160407064252 builduid: c5a923078b6f478995bdbe6d4da3740b revision: f5d7c57cdfd7574361db3a1b555db546c4ccaf22 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-04-07 07:47:20.167225) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-04-07 07:47:20.167743) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-04-07 07:47:20.168102) ========= 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=62c568580acbfdaac3eec7be000001dc-1460040312.400141-1754663434 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test program finished with exit code 0 elapsedTime=0.006280 basedir: '/builds/slave/test' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-04-07 07:47:20.191776) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-07 07:47:20.192121) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-07 07:47:20.206955) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-07 07:47:20.207297) ========= 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=62c568580acbfdaac3eec7be000001dc-1460040312.400141-1754663434 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004575 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-07 07:47:20.258104) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-04-07 07:47:20.258451) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-04-07 07:47:20.258871) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-07 07:47:20.259185) ========= 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=62c568580acbfdaac3eec7be000001dc-1460040312.400141-1754663434 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-04-07 07:47:20-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 39.4M=0s 2016-04-07 07:47:20 (39.4 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.176868 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-07 07:47:20.449790) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-07 07:47:20.450380) ========= 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=62c568580acbfdaac3eec7be000001dc-1460040312.400141-1754663434 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.018577 ========= master_lag: 0.13 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-07 07:47:20.594420) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-04-07 07:47:20.594841) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev f5d7c57cdfd7574361db3a1b555db546c4ccaf22 --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 f5d7c57cdfd7574361db3a1b555db546c4ccaf22 --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=62c568580acbfdaac3eec7be000001dc-1460040312.400141-1754663434 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-04-07 07:47:20,808 truncating revision to first 12 chars 2016-04-07 07:47:20,808 Setting DEBUG logging. 2016-04-07 07:47:20,808 attempt 1/10 2016-04-07 07:47:20,808 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/f5d7c57cdfd7?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-04-07 07:47:21,775 unpacking tar archive at: fx-team-f5d7c57cdfd7/testing/mozharness/ program finished with exit code 0 elapsedTime=1.219199 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-04-07 07:47:21.829994) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-07 07:47:21.830386) ========= echo f5d7c57cdfd7574361db3a1b555db546c4ccaf22 in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'f5d7c57cdfd7574361db3a1b555db546c4ccaf22'] 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=62c568580acbfdaac3eec7be000001dc-1460040312.400141-1754663434 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False f5d7c57cdfd7574361db3a1b555db546c4ccaf22 program finished with exit code 0 elapsedTime=0.003922 script_repo_revision: 'f5d7c57cdfd7574361db3a1b555db546c4ccaf22' ========= master_lag: 0.05 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-07 07:47:21.879890) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-07 07:47:21.880239) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-07 07:47:21.890431) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 41 secs) (at 2016-04-07 07:47:21.890766) ========= /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=62c568580acbfdaac3eec7be000001dc-1460040312.400141-1754663434 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 07:47:22 INFO - MultiFileLogger online at 20160407 07:47:22 in /builds/slave/test 07:47:22 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 07:47:22 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 07:47:22 INFO - {'append_to_log': False, 07:47:22 INFO - 'base_work_dir': '/builds/slave/test', 07:47:22 INFO - 'blob_upload_branch': 'Fx-Team-Non-PGO', 07:47:22 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 07:47:22 INFO - 'branch': 'Fx-Team-Non-PGO', 07:47:22 INFO - 'buildbot_json_path': 'buildprops.json', 07:47:22 INFO - 'config_files': ('talos/linux_config.py',), 07:47:22 INFO - 'default_actions': ('clobber', 07:47:22 INFO - 'read-buildbot-config', 07:47:22 INFO - 'download-and-extract', 07:47:22 INFO - 'populate-webroot', 07:47:22 INFO - 'create-virtualenv', 07:47:22 INFO - 'install', 07:47:22 INFO - 'run-tests'), 07:47:22 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 07:47:22 INFO - 'download_minidump_stackwalk': True, 07:47:22 INFO - 'download_symbols': 'ondemand', 07:47:22 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 07:47:22 INFO - 'tooltool.py': '/tools/tooltool.py', 07:47:22 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 07:47:22 INFO - '/tools/misc-python/virtualenv.py')}, 07:47:22 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 07:47:22 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 07:47:22 INFO - 'installer_path': 'installer.exe', 07:47:22 INFO - 'log_level': 'info', 07:47:22 INFO - 'log_name': 'talos', 07:47:22 INFO - 'log_to_console': True, 07:47:22 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 07:47:22 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 07:47:22 INFO - 'opt_config_files': (), 07:47:22 INFO - 'pip_index': False, 07:47:22 INFO - 'sps_profile': False, 07:47:22 INFO - 'sps_profile_interval': 0, 07:47:22 INFO - 'suite': 'dromaeojs-e10s', 07:47:22 INFO - 'system_bits': '32', 07:47:22 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 07:47:22 INFO - 'title': 'talos-linux64-ix-018', 07:47:22 INFO - 'tooltool_cache': '/builds/tooltool_cache', 07:47:22 INFO - 'use_talos_json': True, 07:47:22 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 07:47:22 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 07:47:22 INFO - 'work_dir': 'build'} 07:47:22 INFO - ##### 07:47:22 INFO - ##### Running clobber step. 07:47:22 INFO - ##### 07:47:22 INFO - Running pre-action listener: _resource_record_pre_action 07:47:22 INFO - Running main action method: clobber 07:47:22 INFO - rmtree: /builds/slave/test/build 07:47:22 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 07:47:22 INFO - Running post-action listener: _resource_record_post_action 07:47:22 INFO - ##### 07:47:22 INFO - ##### Running read-buildbot-config step. 07:47:22 INFO - ##### 07:47:22 INFO - Running pre-action listener: _resource_record_pre_action 07:47:22 INFO - Running main action method: read_buildbot_config 07:47:22 INFO - Using buildbot properties: 07:47:22 INFO - { 07:47:22 INFO - "project": "", 07:47:22 INFO - "product": "firefox", 07:47:22 INFO - "script_repo_revision": "production", 07:47:22 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 07:47:22 INFO - "repository": "", 07:47:22 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team talos dromaeojs-e10s", 07:47:22 INFO - "buildid": "20160407064252", 07:47:22 INFO - "pgo_build": "False", 07:47:22 INFO - "basedir": "/builds/slave/test", 07:47:22 INFO - "buildnumber": 1366, 07:47:22 INFO - "slavename": "talos-linux64-ix-018", 07:47:22 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 07:47:22 INFO - "platform": "ubuntu64_hw", 07:47:22 INFO - "scheduler": "tests-fx-team-linux64-talos", 07:47:22 INFO - "branch": "fx-team", 07:47:22 INFO - "repo_path": "integration/fx-team", 07:47:22 INFO - "revision": "f5d7c57cdfd7574361db3a1b555db546c4ccaf22", 07:47:22 INFO - "stage_platform": "linux64", 07:47:22 INFO - "builduid": "c5a923078b6f478995bdbe6d4da3740b", 07:47:22 INFO - "slavebuilddir": "test" 07:47:22 INFO - } 07:47:22 INFO - Found installer url https://queue.taskcluster.net/v1/task/e1sUNeYES-mHkyIxJuXkYw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2. 07:47:22 INFO - Running post-action listener: _resource_record_post_action 07:47:22 INFO - ##### 07:47:22 INFO - ##### Running download-and-extract step. 07:47:22 INFO - ##### 07:47:22 INFO - Running pre-action listener: _resource_record_pre_action 07:47:22 INFO - Running main action method: download_and_extract 07:47:22 INFO - mkdir: /builds/slave/test/build/tests 07:47:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:47:22 INFO - https://queue.taskcluster.net/v1/task/e1sUNeYES-mHkyIxJuXkYw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 07:47:22 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/e1sUNeYES-mHkyIxJuXkYw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 07:47:22 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/e1sUNeYES-mHkyIxJuXkYw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 07:47:22 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/e1sUNeYES-mHkyIxJuXkYw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 07:47:22 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/e1sUNeYES-mHkyIxJuXkYw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 07:47:30 INFO - Downloaded 1361 bytes. 07:47:30 INFO - Reading from file /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 07:47:30 INFO - Using the following test package requirements: 07:47:30 INFO - {u'common': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'], 07:47:30 INFO - u'cppunittest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 07:47:30 INFO - u'firefox-48.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 07:47:30 INFO - u'gtest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 07:47:30 INFO - u'firefox-48.0a1.en-US.linux-x86_64.gtest.tests.zip'], 07:47:30 INFO - u'jittest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 07:47:30 INFO - u'jsshell-linux-x86_64.zip'], 07:47:30 INFO - u'mochitest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 07:47:30 INFO - u'firefox-48.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 07:47:30 INFO - u'mozbase': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'], 07:47:30 INFO - u'reftest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 07:47:30 INFO - u'firefox-48.0a1.en-US.linux-x86_64.reftest.tests.zip'], 07:47:30 INFO - u'talos': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 07:47:30 INFO - u'firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'], 07:47:30 INFO - u'web-platform': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 07:47:30 INFO - u'firefox-48.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 07:47:30 INFO - u'xpcshell': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 07:47:30 INFO - u'firefox-48.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 07:47:30 INFO - Downloading packages: [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 07:47: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')]} 07:47:30 INFO - https://queue.taskcluster.net/v1/task/e1sUNeYES-mHkyIxJuXkYw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 07:47:30 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/e1sUNeYES-mHkyIxJuXkYw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 07:47:30 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/e1sUNeYES-mHkyIxJuXkYw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 07:47:30 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/e1sUNeYES-mHkyIxJuXkYw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 07:47:30 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/e1sUNeYES-mHkyIxJuXkYw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 07:47:33 INFO - Downloaded 22143484 bytes. 07:47:33 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 07:47:33 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 07:47:34 INFO - Return code: 0 07:47:34 INFO - Downloading packages: [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 07:47:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:47:34 INFO - https://queue.taskcluster.net/v1/task/e1sUNeYES-mHkyIxJuXkYw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 07:47:34 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/e1sUNeYES-mHkyIxJuXkYw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 07:47:34 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/e1sUNeYES-mHkyIxJuXkYw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 07:47:34 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/e1sUNeYES-mHkyIxJuXkYw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 07:47:34 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/e1sUNeYES-mHkyIxJuXkYw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 07:47:36 INFO - Downloaded 22143484 bytes. 07:47:36 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 07:47:36 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 07:47:38 INFO - Return code: 0 07:47:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:47:38 INFO - https://queue.taskcluster.net/v1/task/e1sUNeYES-mHkyIxJuXkYw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 07:47:38 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/e1sUNeYES-mHkyIxJuXkYw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 07:47:38 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/e1sUNeYES-mHkyIxJuXkYw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 07:47:38 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/e1sUNeYES-mHkyIxJuXkYw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 07:47:38 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/e1sUNeYES-mHkyIxJuXkYw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 07:47:39 INFO - Downloaded 10847693 bytes. 07:47:39 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 07:47:39 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 07:47:39 INFO - Return code: 0 07:47:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:47:39 INFO - https://queue.taskcluster.net/v1/task/e1sUNeYES-mHkyIxJuXkYw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 07:47:39 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/e1sUNeYES-mHkyIxJuXkYw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 07:47:39 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/e1sUNeYES-mHkyIxJuXkYw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 07:47:39 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/e1sUNeYES-mHkyIxJuXkYw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 07:47:39 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/e1sUNeYES-mHkyIxJuXkYw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 07:47:40 INFO - Downloaded 54195850 bytes. 07:47:40 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/e1sUNeYES-mHkyIxJuXkYw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 07:47:40 INFO - mkdir: /builds/slave/test/properties 07:47:40 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 07:47:40 INFO - Writing to file /builds/slave/test/properties/build_url 07:47:40 INFO - Contents: 07:47:40 INFO - build_url:https://queue.taskcluster.net/v1/task/e1sUNeYES-mHkyIxJuXkYw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 07:47:41 INFO - Running post-action listener: _resource_record_post_action 07:47:41 INFO - Running post-action listener: set_extra_try_arguments 07:47:41 INFO - ##### 07:47:41 INFO - ##### Running populate-webroot step. 07:47:41 INFO - ##### 07:47:41 INFO - Running pre-action listener: _resource_record_pre_action 07:47:41 INFO - Running main action method: populate_webroot 07:47:41 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 07:47:41 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 07:47:41 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 07:47:41 INFO - '--tppagecycles', 07:47:41 INFO - '7'], 07:47:41 INFO - 'tests': ['tsvgm']}}, 07:47:41 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 07:47:41 INFO - 'tests': ['tresize', 'tcanvasmark']}, 07:47:41 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 07:47:41 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 07:47:41 INFO - 'tests': ['dromaeo_css', 'kraken']}, 07:47:41 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 07:47:41 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:47:41 INFO - 'talos_options': ['--disable-e10s'], 07:47:41 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 07:47:41 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:47:41 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 07:47:41 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:47:41 INFO - 'talos_options': ['--disable-e10s'], 07:47:41 INFO - 'tests': ['damp', 'tps']}, 07:47:41 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:47:41 INFO - 'tests': ['damp', 'tps']}, 07:47:41 INFO - 'g3': {'talos_options': ['--disable-e10s'], 07:47:41 INFO - 'tests': ['dromaeo_dom']}, 07:47:41 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 07:47:41 INFO - 'other': {'talos_options': ['--disable-e10s'], 07:47:41 INFO - 'tests': ['a11yr', 07:47:41 INFO - 'ts_paint', 07:47:41 INFO - 'tpaint', 07:47:41 INFO - 'sessionrestore', 07:47:41 INFO - 'sessionrestore_no_auto_restore', 07:47:41 INFO - 'tabpaint']}, 07:47:41 INFO - 'other-e10s': {'tests': ['a11yr', 07:47:41 INFO - 'ts_paint', 07:47:41 INFO - 'tpaint', 07:47:41 INFO - 'sessionrestore', 07:47:41 INFO - 'sessionrestore_no_auto_restore', 07:47:41 INFO - 'tabpaint']}, 07:47:41 INFO - 'other-e10s_l64': {'tests': ['a11yr', 07:47:41 INFO - 'ts_paint', 07:47:41 INFO - 'tpaint', 07:47:41 INFO - 'sessionrestore', 07:47:41 INFO - 'sessionrestore_no_auto_restore', 07:47:41 INFO - 'tabpaint']}, 07:47:41 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 07:47:41 INFO - 'ts_paint', 07:47:41 INFO - 'tpaint', 07:47:41 INFO - 'sessionrestore', 07:47:41 INFO - 'sessionrestore_no_auto_restore', 07:47:41 INFO - 'tabpaint']}, 07:47:41 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 07:47:41 INFO - 'tests': ['a11yr', 07:47:41 INFO - 'ts_paint', 07:47:41 INFO - 'tpaint', 07:47:41 INFO - 'sessionrestore', 07:47:41 INFO - 'sessionrestore_no_auto_restore', 07:47:41 INFO - 'tabpaint']}, 07:47:41 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 07:47:41 INFO - 'tests': ['a11yr', 07:47:41 INFO - 'ts_paint', 07:47:41 INFO - 'tpaint', 07:47:41 INFO - 'sessionrestore', 07:47:41 INFO - 'sessionrestore_no_auto_restore', 07:47:41 INFO - 'tabpaint']}, 07:47:41 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 07:47:41 INFO - 'tests': ['tsvgx', 07:47:41 INFO - 'tsvgr_opacity', 07:47:41 INFO - 'tart', 07:47:41 INFO - 'tscrollx', 07:47:41 INFO - 'cart']}, 07:47:41 INFO - 'svgr-e10s': {'tests': ['tsvgx', 07:47:41 INFO - 'tsvgr_opacity', 07:47:41 INFO - 'tart', 07:47:41 INFO - 'tscrollx', 07:47:41 INFO - 'cart']}, 07:47:41 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:47:41 INFO - 'talos_options': ['--disable-e10s'], 07:47:41 INFO - 'tests': ['tp5o']}, 07:47:41 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:47:41 INFO - 'tests': ['tp5o']}, 07:47:41 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:47:41 INFO - 'talos_options': ['--disable-e10s', 07:47:41 INFO - '--xperf_path', 07:47:41 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 07:47:41 INFO - 'tests': ['tp5n']}, 07:47:41 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:47:41 INFO - 'talos_options': ['--xperf_path', 07:47:41 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 07:47:41 INFO - 'tests': ['tp5n']}}, 07:47:41 INFO - 'talos.zip': {'path': '', 07:47:41 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 07:47:41 INFO - Running post-action listener: _resource_record_post_action 07:47:41 INFO - ##### 07:47:41 INFO - ##### Running create-virtualenv step. 07:47:41 INFO - ##### 07:47:41 INFO - Running pre-action listener: _resource_record_pre_action 07:47:41 INFO - Running main action method: create_virtualenv 07:47:41 INFO - Creating virtualenv /builds/slave/test/build/venv 07:47:41 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 07:47:41 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 07:47:41 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 07:47:41 INFO - Using real prefix '/usr' 07:47:41 INFO - New python executable in /builds/slave/test/build/venv/bin/python 07:47:42 INFO - Installing distribute.............................................................................................................................................................................................done. 07:47:44 INFO - Installing pip.................done. 07:47:44 INFO - Return code: 0 07:47:44 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 07:47:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:47:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:47:44 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:47:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:47:44 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:47:44 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:47:44 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 0x7f37c4144f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x282d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x28f85a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2987410>, '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 0x2988310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29887a0>, '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': '62c568580acbfdaac3eec7be000001dc-1460040312.400141-1754663434', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 07:47:44 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 07:47:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 07:47:44 INFO - Using env: {'DISPLAY': ':0', 07:47:44 INFO - 'HOME': '/home/cltbld', 07:47:44 INFO - 'LANG': 'en_US.UTF-8', 07:47:44 INFO - 'LANGUAGE': 'en_US:en', 07:47:44 INFO - 'LOGNAME': 'cltbld', 07:47:44 INFO - 'MAIL': '/var/mail/cltbld', 07:47:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:47:44 INFO - 'MOZ_NO_REMOTE': '1', 07:47:44 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:47:44 INFO - 'NO_EM_RESTART': '1', 07:47:44 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:47:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:47:44 INFO - 'PWD': '/builds/slave/test', 07:47:44 INFO - 'SHELL': '/bin/bash', 07:47:44 INFO - 'SHLVL': '1', 07:47:44 INFO - 'TERM': 'linux', 07:47:44 INFO - 'TMOUT': '86400', 07:47:44 INFO - 'USER': 'cltbld', 07:47:44 INFO - 'XDG_SESSION_COOKIE': '62c568580acbfdaac3eec7be000001dc-1460040312.400141-1754663434', 07:47:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:47:44 INFO - '_': '/tools/buildbot/bin/python'} 07:47:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:47:44 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 07:47:44 INFO - Cleaning up... 07:47:44 INFO - Return code: 0 07:47:44 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 07:47:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:47:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:47:44 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:47:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:47:44 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:47:44 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:47:44 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 0x7f37c4144f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x282d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x28f85a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2987410>, '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 0x2988310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29887a0>, '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': '62c568580acbfdaac3eec7be000001dc-1460040312.400141-1754663434', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 07:47:44 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test/build 07:47:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 07:47:44 INFO - Using env: {'DISPLAY': ':0', 07:47:44 INFO - 'HOME': '/home/cltbld', 07:47:44 INFO - 'LANG': 'en_US.UTF-8', 07:47:44 INFO - 'LANGUAGE': 'en_US:en', 07:47:44 INFO - 'LOGNAME': 'cltbld', 07:47:44 INFO - 'MAIL': '/var/mail/cltbld', 07:47:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:47:44 INFO - 'MOZ_NO_REMOTE': '1', 07:47:44 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:47:44 INFO - 'NO_EM_RESTART': '1', 07:47:44 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:47:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:47:44 INFO - 'PWD': '/builds/slave/test', 07:47:44 INFO - 'SHELL': '/bin/bash', 07:47:44 INFO - 'SHLVL': '1', 07:47:44 INFO - 'TERM': 'linux', 07:47:44 INFO - 'TMOUT': '86400', 07:47:44 INFO - 'USER': 'cltbld', 07:47:44 INFO - 'XDG_SESSION_COOKIE': '62c568580acbfdaac3eec7be000001dc-1460040312.400141-1754663434', 07:47:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:47:44 INFO - '_': '/tools/buildbot/bin/python'} 07:47:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:47:44 INFO - Downloading/unpacking psutil>=0.7.1 07:47:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:47:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:47:44 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:47:44 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:47:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:47:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:47:46 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 07:47:46 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 07:47:46 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 07:47:46 INFO - Installing collected packages: psutil 07:47:46 INFO - Running setup.py install for psutil 07:47:46 INFO - building 'psutil._psutil_linux' extension 07:47:46 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 07:47:46 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 07:47:46 INFO - building 'psutil._psutil_posix' extension 07:47:46 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 07:47:46 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 07:47:46 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 07:47:46 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 07:47:46 INFO - Successfully installed psutil 07:47:46 INFO - Cleaning up... 07:47:47 INFO - Return code: 0 07:47:47 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 07:47:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:47:47 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:47:47 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:47:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:47:47 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:47:47 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:47:47 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f37c4144f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x282d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x28f85a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2987410>, '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 0x2988310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29887a0>, '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': '62c568580acbfdaac3eec7be000001dc-1460040312.400141-1754663434', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 07:47:47 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test/build 07:47:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 07:47:47 INFO - Using env: {'DISPLAY': ':0', 07:47:47 INFO - 'HOME': '/home/cltbld', 07:47:47 INFO - 'LANG': 'en_US.UTF-8', 07:47:47 INFO - 'LANGUAGE': 'en_US:en', 07:47:47 INFO - 'LOGNAME': 'cltbld', 07:47:47 INFO - 'MAIL': '/var/mail/cltbld', 07:47:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:47:47 INFO - 'MOZ_NO_REMOTE': '1', 07:47:47 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:47:47 INFO - 'NO_EM_RESTART': '1', 07:47:47 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:47:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:47:47 INFO - 'PWD': '/builds/slave/test', 07:47:47 INFO - 'SHELL': '/bin/bash', 07:47:47 INFO - 'SHLVL': '1', 07:47:47 INFO - 'TERM': 'linux', 07:47:47 INFO - 'TMOUT': '86400', 07:47:47 INFO - 'USER': 'cltbld', 07:47:47 INFO - 'XDG_SESSION_COOKIE': '62c568580acbfdaac3eec7be000001dc-1460040312.400141-1754663434', 07:47:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:47:47 INFO - '_': '/tools/buildbot/bin/python'} 07:47:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:47:47 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 07:47:47 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:47:47 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:47:47 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:47:47 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:47:47 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:47:47 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:47:49 INFO - Downloading mozsystemmonitor-0.0.tar.gz 07:47:49 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 07:47:49 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 07:47:49 INFO - Installing collected packages: mozsystemmonitor 07:47:49 INFO - Running setup.py install for mozsystemmonitor 07:47:49 INFO - Successfully installed mozsystemmonitor 07:47:49 INFO - Cleaning up... 07:47:49 INFO - Return code: 0 07:47:49 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 07:47: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')]} 07:47:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:47:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:47: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')]} 07:47:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:47:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:47:49 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 0x7f37c4144f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x282d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x28f85a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2987410>, '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 0x2988310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29887a0>, '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': '62c568580acbfdaac3eec7be000001dc-1460040312.400141-1754663434', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 07:47:49 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 07:47:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 07:47:49 INFO - Using env: {'DISPLAY': ':0', 07:47:49 INFO - 'HOME': '/home/cltbld', 07:47:49 INFO - 'LANG': 'en_US.UTF-8', 07:47:49 INFO - 'LANGUAGE': 'en_US:en', 07:47:49 INFO - 'LOGNAME': 'cltbld', 07:47:49 INFO - 'MAIL': '/var/mail/cltbld', 07:47:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:47:49 INFO - 'MOZ_NO_REMOTE': '1', 07:47:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:47:49 INFO - 'NO_EM_RESTART': '1', 07:47:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:47:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:47:49 INFO - 'PWD': '/builds/slave/test', 07:47:49 INFO - 'SHELL': '/bin/bash', 07:47:49 INFO - 'SHLVL': '1', 07:47:49 INFO - 'TERM': 'linux', 07:47:49 INFO - 'TMOUT': '86400', 07:47:49 INFO - 'USER': 'cltbld', 07:47:49 INFO - 'XDG_SESSION_COOKIE': '62c568580acbfdaac3eec7be000001dc-1460040312.400141-1754663434', 07:47:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:47:49 INFO - '_': '/tools/buildbot/bin/python'} 07:47:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:47:49 INFO - Downloading/unpacking blobuploader==1.2.4 07:47:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:47:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:47:49 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:47:49 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:47:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:47:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:47:51 INFO - Downloading blobuploader-1.2.4.tar.gz 07:47:51 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 07:47:51 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 07:47:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:47:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:47:51 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:47:51 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:47:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:47:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:47:51 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 07:47:52 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 07:47:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:47:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:47:52 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:47:52 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:47:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:47:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:47:52 INFO - Downloading docopt-0.6.1.tar.gz 07:47:52 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 07:47:52 INFO - Installing collected packages: blobuploader, requests, docopt 07:47:52 INFO - Running setup.py install for blobuploader 07:47:52 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 07:47:52 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 07:47:52 INFO - Running setup.py install for requests 07:47:52 INFO - Running setup.py install for docopt 07:47:52 INFO - Successfully installed blobuploader requests docopt 07:47:52 INFO - Cleaning up... 07:47:53 INFO - Return code: 0 07:47:53 INFO - Installing None into virtualenv /builds/slave/test/build/venv 07:47:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:47:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:47:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:47:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:47:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:47:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:47:53 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 0x7f37c4144f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x282d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x28f85a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2987410>, '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 0x2988310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29887a0>, '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': '62c568580acbfdaac3eec7be000001dc-1460040312.400141-1754663434', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 07:47:53 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 07:47:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 07:47:53 INFO - Using env: {'DISPLAY': ':0', 07:47:53 INFO - 'HOME': '/home/cltbld', 07:47:53 INFO - 'LANG': 'en_US.UTF-8', 07:47:53 INFO - 'LANGUAGE': 'en_US:en', 07:47:53 INFO - 'LOGNAME': 'cltbld', 07:47:53 INFO - 'MAIL': '/var/mail/cltbld', 07:47:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:47:53 INFO - 'MOZ_NO_REMOTE': '1', 07:47:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:47:53 INFO - 'NO_EM_RESTART': '1', 07:47:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:47:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:47:53 INFO - 'PWD': '/builds/slave/test', 07:47:53 INFO - 'SHELL': '/bin/bash', 07:47:53 INFO - 'SHLVL': '1', 07:47:53 INFO - 'TERM': 'linux', 07:47:53 INFO - 'TMOUT': '86400', 07:47:53 INFO - 'USER': 'cltbld', 07:47:53 INFO - 'XDG_SESSION_COOKIE': '62c568580acbfdaac3eec7be000001dc-1460040312.400141-1754663434', 07:47:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:47:53 INFO - '_': '/tools/buildbot/bin/python'} 07:47:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:47:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 07:47:53 INFO - Running setup.py (path:/tmp/pip-D5XH4K-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 07:47:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 07:47:53 INFO - Running setup.py (path:/tmp/pip-TBYiEk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 07:47:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 07:47:53 INFO - Running setup.py (path:/tmp/pip-TQPKop-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 07:47:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 07:47:53 INFO - Running setup.py (path:/tmp/pip-HP3PUW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 07:47:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 07:47:53 INFO - Running setup.py (path:/tmp/pip-2DYjW7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 07:47:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 07:47:53 INFO - Running setup.py (path:/tmp/pip-b1tNoy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 07:47:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 07:47:53 INFO - Running setup.py (path:/tmp/pip-LMQiRh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 07:47:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 07:47:53 INFO - Running setup.py (path:/tmp/pip-rwrwky-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 07:47:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 07:47:53 INFO - Running setup.py (path:/tmp/pip-PHXxPH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 07:47:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 07:47:53 INFO - Running setup.py (path:/tmp/pip-FGTfHK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 07:47:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 07:47:53 INFO - Running setup.py (path:/tmp/pip-itq0j6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 07:47:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 07:47:54 INFO - Running setup.py (path:/tmp/pip-9itRo7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 07:47:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 07:47:54 INFO - Running setup.py (path:/tmp/pip-NGrhdN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 07:47:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 07:47:54 INFO - Running setup.py (path:/tmp/pip-vkCPMu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 07:47:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 07:47:54 INFO - Running setup.py (path:/tmp/pip-UwIiCK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 07:47:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 07:47:54 INFO - Running setup.py (path:/tmp/pip-r9bqgj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 07:47:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 07:47:54 INFO - Running setup.py (path:/tmp/pip-a_xutZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 07:47:54 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 07:47:54 INFO - Running setup.py install for manifestparser 07:47:54 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 07:47:54 INFO - Running setup.py install for mozcrash 07:47:54 INFO - Running setup.py install for mozdebug 07:47:54 INFO - Running setup.py install for mozdevice 07:47:54 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 07:47:54 INFO - Installing dm script to /builds/slave/test/build/venv/bin 07:47:54 INFO - Running setup.py install for mozfile 07:47:54 INFO - Running setup.py install for mozhttpd 07:47:55 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 07:47:55 INFO - Running setup.py install for mozinfo 07:47:55 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 07:47:55 INFO - Running setup.py install for mozInstall 07:47:55 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 07:47:55 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 07:47:55 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 07:47:55 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 07:47:55 INFO - Running setup.py install for mozleak 07:47:55 INFO - Running setup.py install for mozlog 07:47:55 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 07:47:55 INFO - Running setup.py install for moznetwork 07:47:55 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 07:47:55 INFO - Running setup.py install for mozprocess 07:47:55 INFO - Running setup.py install for mozprofile 07:47:55 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 07:47:55 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 07:47:55 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 07:47:55 INFO - Running setup.py install for mozrunner 07:47:55 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 07:47:55 INFO - Running setup.py install for mozscreenshot 07:47:55 INFO - Running setup.py install for moztest 07:47:56 INFO - Running setup.py install for mozversion 07:47:56 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 07:47:56 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 07:47:56 INFO - Cleaning up... 07:47:56 INFO - Return code: 0 07:47:56 INFO - Installing None into virtualenv /builds/slave/test/build/venv 07:47:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:47:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:47:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:47:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:47:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:47:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:47:56 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 0x7f37c4144f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x282d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x28f85a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2987410>, '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 0x2988310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29887a0>, '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': '62c568580acbfdaac3eec7be000001dc-1460040312.400141-1754663434', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 07:47:56 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 07:47:56 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 07:47:56 INFO - Using env: {'DISPLAY': ':0', 07:47:56 INFO - 'HOME': '/home/cltbld', 07:47:56 INFO - 'LANG': 'en_US.UTF-8', 07:47:56 INFO - 'LANGUAGE': 'en_US:en', 07:47:56 INFO - 'LOGNAME': 'cltbld', 07:47:56 INFO - 'MAIL': '/var/mail/cltbld', 07:47:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:47:56 INFO - 'MOZ_NO_REMOTE': '1', 07:47:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:47:56 INFO - 'NO_EM_RESTART': '1', 07:47:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:47:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:47:56 INFO - 'PWD': '/builds/slave/test', 07:47:56 INFO - 'SHELL': '/bin/bash', 07:47:56 INFO - 'SHLVL': '1', 07:47:56 INFO - 'TERM': 'linux', 07:47:56 INFO - 'TMOUT': '86400', 07:47:56 INFO - 'USER': 'cltbld', 07:47:56 INFO - 'XDG_SESSION_COOKIE': '62c568580acbfdaac3eec7be000001dc-1460040312.400141-1754663434', 07:47:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:47:56 INFO - '_': '/tools/buildbot/bin/python'} 07:47:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:47:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 07:47:56 INFO - Running setup.py (path:/tmp/pip-Ohx6gg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 07:47:56 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 07:47:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 07:47:56 INFO - Running setup.py (path:/tmp/pip-ncNH2K-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 07:47:56 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 07:47:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 07:47:56 INFO - Running setup.py (path:/tmp/pip-S7bN7H-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 07:47:56 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 07:47:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 07:47:56 INFO - Running setup.py (path:/tmp/pip-HEpy0Y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 07:47:56 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 07:47:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 07:47:56 INFO - Running setup.py (path:/tmp/pip-dgD1Lo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 07:47:56 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 07:47:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 07:47:56 INFO - Running setup.py (path:/tmp/pip-ncTxVO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 07:47:56 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 07:47:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 07:47:56 INFO - Running setup.py (path:/tmp/pip-GdCWg6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 07:47:56 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 07:47:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 07:47:56 INFO - Running setup.py (path:/tmp/pip-8B95GN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 07:47:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 07:47:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 07:47:57 INFO - Running setup.py (path:/tmp/pip-eLFTQ_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 07:47:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 07:47:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 07:47:57 INFO - Running setup.py (path:/tmp/pip-iV0Ysq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 07:47:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.1 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 07:47:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 07:47:57 INFO - Running setup.py (path:/tmp/pip-ZcgrO1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 07:47:57 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 07:47:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 07:47:57 INFO - Running setup.py (path:/tmp/pip-k8StM6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 07:47:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 07:47:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 07:47:57 INFO - Running setup.py (path:/tmp/pip-CGSV74-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 07:47:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 07:47:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 07:47:57 INFO - Running setup.py (path:/tmp/pip-eSq6ks-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 07:47:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 07:47:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 07:47:57 INFO - Running setup.py (path:/tmp/pip-a1zorb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 07:47:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 07:47:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 07:47:57 INFO - Running setup.py (path:/tmp/pip-_cqBbs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 07:47:57 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 07:47:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 07:47:57 INFO - Running setup.py (path:/tmp/pip-q4q6ph-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 07:47:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 07:47:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 07:47:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 07:47:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 07:47:57 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 07:47:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 07:47:57 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 07:47:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:47:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:47:57 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:47:57 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:47:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:47:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:47:59 INFO - Downloading blessings-1.6.tar.gz 07:47:59 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 07:47:59 INFO - Installing collected packages: blessings 07:47:59 INFO - Running setup.py install for blessings 07:47:59 INFO - Successfully installed blessings 07:47:59 INFO - Cleaning up... 07:47:59 INFO - Return code: 0 07:47:59 INFO - Done creating virtualenv /builds/slave/test/build/venv. 07:47:59 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 07:47:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 07:47:59 INFO - Reading from file tmpfile_stdout 07:47:59 INFO - Current package versions: 07:47:59 INFO - argparse == 1.2.1 07:47:59 INFO - blessings == 1.6 07:47:59 INFO - blobuploader == 1.2.4 07:47:59 INFO - docopt == 0.6.1 07:47:59 INFO - manifestparser == 1.1 07:47:59 INFO - mozInstall == 1.12 07:47:59 INFO - mozcrash == 0.17 07:47:59 INFO - mozdebug == 0.1 07:47:59 INFO - mozdevice == 0.48 07:47:59 INFO - mozfile == 1.2 07:47:59 INFO - mozhttpd == 0.7 07:47:59 INFO - mozinfo == 0.9 07:47:59 INFO - mozleak == 0.1 07:47:59 INFO - mozlog == 3.1 07:47:59 INFO - moznetwork == 0.27 07:47:59 INFO - mozprocess == 0.22 07:47:59 INFO - mozprofile == 0.28 07:47:59 INFO - mozrunner == 6.11 07:47:59 INFO - mozscreenshot == 0.1 07:47:59 INFO - mozsystemmonitor == 0.0 07:47:59 INFO - moztest == 0.7 07:47:59 INFO - mozversion == 1.4 07:47:59 INFO - psutil == 3.1.1 07:47:59 INFO - requests == 1.2.3 07:47:59 INFO - wsgiref == 0.1.2 07:47:59 INFO - Installing None into virtualenv /builds/slave/test/build/venv 07:47:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:47:59 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:47:59 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:47:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:47:59 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:47:59 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:47:59 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 0x7f37c4144f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x282d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x28f85a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2987410>, '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 0x2988310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29887a0>, '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': '62c568580acbfdaac3eec7be000001dc-1460040312.400141-1754663434', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 07:47:59 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 07:47:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 07:47:59 INFO - Using env: {'DISPLAY': ':0', 07:47:59 INFO - 'HOME': '/home/cltbld', 07:47:59 INFO - 'LANG': 'en_US.UTF-8', 07:47:59 INFO - 'LANGUAGE': 'en_US:en', 07:47:59 INFO - 'LOGNAME': 'cltbld', 07:47:59 INFO - 'MAIL': '/var/mail/cltbld', 07:47:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:47:59 INFO - 'MOZ_NO_REMOTE': '1', 07:47:59 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:47:59 INFO - 'NO_EM_RESTART': '1', 07:47:59 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:47:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:47:59 INFO - 'PWD': '/builds/slave/test', 07:47:59 INFO - 'SHELL': '/bin/bash', 07:47:59 INFO - 'SHLVL': '1', 07:47:59 INFO - 'TERM': 'linux', 07:47:59 INFO - 'TMOUT': '86400', 07:47:59 INFO - 'USER': 'cltbld', 07:47:59 INFO - 'XDG_SESSION_COOKIE': '62c568580acbfdaac3eec7be000001dc-1460040312.400141-1754663434', 07:47:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:47:59 INFO - '_': '/tools/buildbot/bin/python'} 07:48:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:48:00 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 07:48:00 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 07:48:00 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 07:48:00 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 07:48:00 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 07:48:00 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 07:48:00 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 07:48:00 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 07:48:00 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 07:48:00 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 07:48:00 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 07:48:00 INFO - Cleaning up... 07:48:00 INFO - Return code: 0 07:48:00 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 07:48: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')]} 07:48:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:48:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:48: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')]} 07:48:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:48:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:48:00 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 0x7f37c4144f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x282d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x28f85a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2987410>, '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 0x2988310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29887a0>, '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': '62c568580acbfdaac3eec7be000001dc-1460040312.400141-1754663434', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 07:48:00 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 07:48:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 07:48:00 INFO - Using env: {'DISPLAY': ':0', 07:48:00 INFO - 'HOME': '/home/cltbld', 07:48:00 INFO - 'LANG': 'en_US.UTF-8', 07:48:00 INFO - 'LANGUAGE': 'en_US:en', 07:48:00 INFO - 'LOGNAME': 'cltbld', 07:48:00 INFO - 'MAIL': '/var/mail/cltbld', 07:48:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:48:00 INFO - 'MOZ_NO_REMOTE': '1', 07:48:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:48:00 INFO - 'NO_EM_RESTART': '1', 07:48:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:48:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:48:00 INFO - 'PWD': '/builds/slave/test', 07:48:00 INFO - 'SHELL': '/bin/bash', 07:48:00 INFO - 'SHLVL': '1', 07:48:00 INFO - 'TERM': 'linux', 07:48:00 INFO - 'TMOUT': '86400', 07:48:00 INFO - 'USER': 'cltbld', 07:48:00 INFO - 'XDG_SESSION_COOKIE': '62c568580acbfdaac3eec7be000001dc-1460040312.400141-1754663434', 07:48:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:48:00 INFO - '_': '/tools/buildbot/bin/python'} 07:48:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:48:00 INFO - Downloading/unpacking jsonschema 07:48:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:48:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:48:00 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:48:00 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:48:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:48:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:48:02 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 07:48:02 INFO - Downloading/unpacking functools32 (from jsonschema) 07:48:02 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:48:02 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:48:02 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:48:02 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:48:02 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:48:02 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:48:02 INFO - Downloading functools32-3.2.3-2.tar.gz 07:48:02 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 07:48:02 INFO - warning: no files found matching '*.txt' 07:48:02 INFO - no previously-included directories found matching 'build' 07:48:02 INFO - no previously-included directories found matching 'dist' 07:48:02 INFO - no previously-included directories found matching '.git*' 07:48:02 INFO - Installing collected packages: jsonschema, functools32 07:48:02 INFO - Running setup.py install for functools32 07:48:02 INFO - warning: no files found matching '*.txt' 07:48:02 INFO - no previously-included directories found matching 'build' 07:48:02 INFO - no previously-included directories found matching 'dist' 07:48:02 INFO - no previously-included directories found matching '.git*' 07:48:02 INFO - Successfully installed jsonschema functools32 07:48:02 INFO - Cleaning up... 07:48:02 INFO - Return code: 0 07:48:02 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 07:48:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:48:02 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:48:02 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:48:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:48:02 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:48:02 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:48:02 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f37c4144f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x282d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x28f85a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2987410>, '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 0x2988310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29887a0>, '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': '62c568580acbfdaac3eec7be000001dc-1460040312.400141-1754663434', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 07:48:02 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8'] in /builds/slave/test/build 07:48:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub flake8 07:48:02 INFO - Using env: {'DISPLAY': ':0', 07:48:02 INFO - 'HOME': '/home/cltbld', 07:48:02 INFO - 'LANG': 'en_US.UTF-8', 07:48:02 INFO - 'LANGUAGE': 'en_US:en', 07:48:02 INFO - 'LOGNAME': 'cltbld', 07:48:02 INFO - 'MAIL': '/var/mail/cltbld', 07:48:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:48:02 INFO - 'MOZ_NO_REMOTE': '1', 07:48:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:48:02 INFO - 'NO_EM_RESTART': '1', 07:48:02 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:48:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:48:02 INFO - 'PWD': '/builds/slave/test', 07:48:02 INFO - 'SHELL': '/bin/bash', 07:48:02 INFO - 'SHLVL': '1', 07:48:02 INFO - 'TERM': 'linux', 07:48:02 INFO - 'TMOUT': '86400', 07:48:02 INFO - 'USER': 'cltbld', 07:48:02 INFO - 'XDG_SESSION_COOKIE': '62c568580acbfdaac3eec7be000001dc-1460040312.400141-1754663434', 07:48:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:48:02 INFO - '_': '/tools/buildbot/bin/python'} 07:48:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:48:03 INFO - Downloading/unpacking flake8 07:48:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:48:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:48:03 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:48:03 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:48:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:48:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:48:04 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 07:48:04 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 07:48:04 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:48:04 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:48:04 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:48:04 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:48:04 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:48:04 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:48:05 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 07:48:05 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 07:48:05 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:48:05 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:48:05 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:48:05 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:48:05 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:48:05 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:48:05 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 07:48:05 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:48:05 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:48:05 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:48:05 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:48:05 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:48:05 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:48:05 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 07:48:05 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 07:48:05 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 07:48:05 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 07:48:05 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 07:48:05 INFO - no previously-included directories found matching 'docs/_build' 07:48:05 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 07:48:05 INFO - Running setup.py install for pep8 07:48:05 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 07:48:05 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 07:48:05 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 07:48:05 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 07:48:05 INFO - no previously-included directories found matching 'docs/_build' 07:48:05 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 07:48:05 INFO - Successfully installed flake8 mccabe pyflakes pep8 07:48:05 INFO - Cleaning up... 07:48:05 INFO - Return code: 0 07:48:05 INFO - Running post-action listener: _resource_record_post_action 07:48:05 INFO - Running post-action listener: _start_resource_monitoring 07:48:05 INFO - Starting resource monitoring. 07:48:05 INFO - ##### 07:48:05 INFO - ##### Running install step. 07:48:05 INFO - ##### 07:48:05 INFO - Running pre-action listener: _resource_record_pre_action 07:48:05 INFO - Running main action method: install 07:48:05 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 07:48:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 07:48:06 INFO - Reading from file tmpfile_stdout 07:48:06 INFO - Detecting whether we're running mozinstall >=1.0... 07:48:06 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 07:48:06 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 07:48:06 INFO - Reading from file tmpfile_stdout 07:48:06 INFO - Output received: 07:48:06 INFO - Usage: mozinstall [options] installer 07:48:06 INFO - Options: 07:48:06 INFO - -h, --help show this help message and exit 07:48:06 INFO - -d DEST, --destination=DEST 07:48:06 INFO - Directory to install application into. [default: 07:48:06 INFO - "/builds/slave/test"] 07:48:06 INFO - --app=APP Application being installed. [default: firefox] 07:48:06 INFO - mkdir: /builds/slave/test/build/application 07:48:06 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 07:48:06 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 07:48:21 INFO - Reading from file tmpfile_stdout 07:48:21 INFO - Output received: 07:48:21 INFO - /builds/slave/test/build/application/firefox/firefox 07:48:21 INFO - Running post-action listener: _resource_record_post_action 07:48:21 INFO - ##### 07:48:21 INFO - ##### Running run-tests step. 07:48:21 INFO - ##### 07:48:21 INFO - Running pre-action listener: _resource_record_pre_action 07:48:21 INFO - Running main action method: run_tests 07:48:21 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 07:48:21 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 07:48:21 INFO - Python 2.7.3 07:48:21 INFO - Return code: 0 07:48:21 INFO - grabbing minidump binary from tooltool 07:48:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:48:21 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 0x2987410>, '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 0x2988310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29887a0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 07:48:21 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 07:48:21 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 07:48:21 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 07:48:21 INFO - Return code: 0 07:48:21 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 07:48:21 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 07:48:21 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 07:48:21 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 07:48:21 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 07:48:21 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 07:48:21 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 07:48:22 INFO - Return code: 0 07:48:22 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/e1sUNeYES-mHkyIxJuXkYw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-018', '--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 07:48:22 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/e1sUNeYES-mHkyIxJuXkYw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-018 --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 07:48:22 INFO - Using env: {'DISPLAY': ':0', 07:48:22 INFO - 'HOME': '/home/cltbld', 07:48:22 INFO - 'LANG': 'en_US.UTF-8', 07:48:22 INFO - 'LANGUAGE': 'en_US:en', 07:48:22 INFO - 'LOGNAME': 'cltbld', 07:48:22 INFO - 'MAIL': '/var/mail/cltbld', 07:48:22 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 07:48:22 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 07:48:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:48:22 INFO - 'MOZ_NO_REMOTE': '1', 07:48:22 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 07:48:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:48:22 INFO - 'NO_EM_RESTART': '1', 07:48:22 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:48:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:48:22 INFO - 'PWD': '/builds/slave/test', 07:48:22 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 07:48:22 INFO - 'SHELL': '/bin/bash', 07:48:22 INFO - 'SHLVL': '1', 07:48:22 INFO - 'TERM': 'linux', 07:48:22 INFO - 'TMOUT': '86400', 07:48:22 INFO - 'USER': 'cltbld', 07:48:22 INFO - 'XDG_SESSION_COOKIE': '62c568580acbfdaac3eec7be000001dc-1460040312.400141-1754663434', 07:48:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:48:22 INFO - '_': '/tools/buildbot/bin/python'} 07:48:22 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/e1sUNeYES-mHkyIxJuXkYw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-018', '--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 07:48:23 INFO - mozversion application_buildid: 20160407064252 07:48:23 INFO - mozversion application_changeset: f5d7c57cdfd7574361db3a1b555db546c4ccaf22 07:48:23 INFO - mozversion application_display_name: Nightly 07:48:23 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 07:48:23 INFO - mozversion application_name: Firefox 07:48:23 INFO - mozversion application_remotingname: firefox 07:48:23 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 07:48:23 INFO - mozversion application_vendor: Mozilla 07:48:23 INFO - mozversion application_version: 48.0a1 07:48:23 INFO - mozversion platform_buildid: 20160407064252 07:48:23 INFO - mozversion platform_changeset: f5d7c57cdfd7574361db3a1b555db546c4ccaf22 07:48:23 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 07:48:23 INFO - mozversion platform_version: 48.0a1 07:48:23 INFO - using testdate: 1460040503 07:48:23 INFO - actual date: 1460040503 07:48:23 INFO - starting webserver on 'localhost:56426' 07:48:23 INFO - SUITE-START | Running 2 tests 07:48:23 INFO - TEST-START | dromaeo_css 07:48:23 INFO - operating with platform_type : linux_ 07:48:23 INFO - Initialising browser for dromaeo_css test... 07:48:23 INFO - TEST-INFO | started process 13880 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpK7NhBW/profile http://localhost:56426/getInfo.html) 07:48:27 INFO - PROCESS | 13880 | 07:48:27 INFO - PROCESS | 13880 | (process:13948): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 07:48:27 INFO - PROCESS | 13880 | 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] 07:48:27 INFO - PROCESS | 13880 | __metrics Screen width/height:1600/1200 07:48:28 INFO - PROCESS | 13880 | colorDepth:24 07:48:28 INFO - PROCESS | 13880 | Browser inner width/height: 1024/697 07:48:28 INFO - PROCESS | 13880 | __metrics 07:48:28 ERROR - PROCESS | 13880 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2881: TypeError: this.tabs is undefined 07:48:29 INFO - TEST-INFO | 13880: exit 0 07:48:29 INFO - Browser initialized. 07:48:29 INFO - Running cycle 1/1 for dromaeo_css test... 07:48:29 INFO - TEST-INFO | started process 13999 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpK7NhBW/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 07:48:31 INFO - PROCESS | 13999 | 07:48:31 INFO - PROCESS | 13999 | (process:14059): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 07:48:41 INFO - PROCESS | 13999 | RSS: Main: 163602432 07:48:41 INFO - PROCESS | 13999 | 07:49:31 INFO - PROCESS | 13999 | 1460040571427 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 07:51:42 INFO - PROCESS | 13999 | Cycle 1(1): loaded http://localhost:56426/tests/dromaeo/cssquery-dojo.html (next: http://localhost:56426/tests/dromaeo/cssquery-ext.html) 07:51:43 INFO - PROCESS | 13999 | RSS: Main: 168439808 07:51:43 INFO - PROCESS | 13999 | 07:54:45 INFO - PROCESS | 13999 | Cycle 1(1): loaded http://localhost:56426/tests/dromaeo/cssquery-ext.html (next: http://localhost:56426/tests/dromaeo/cssquery-jquery.html) 07:54:46 INFO - PROCESS | 13999 | RSS: Main: 164651008 07:54:46 INFO - PROCESS | 13999 | 07:57:48 INFO - PROCESS | 13999 | Cycle 1(1): loaded http://localhost:56426/tests/dromaeo/cssquery-jquery.html (next: http://localhost:56426/tests/dromaeo/cssquery-mootools.html) 07:57:48 INFO - PROCESS | 13999 | RSS: Main: 165216256 07:57:48 INFO - PROCESS | 13999 | 08:00:50 INFO - PROCESS | 13999 | Cycle 1(1): loaded http://localhost:56426/tests/dromaeo/cssquery-mootools.html (next: http://localhost:56426/tests/dromaeo/cssquery-prototype.html) 08:00:51 INFO - PROCESS | 13999 | RSS: Main: 163475456 08:00:51 INFO - PROCESS | 13999 | 08:03:53 INFO - PROCESS | 13999 | Cycle 1(1): loaded http://localhost:56426/tests/dromaeo/cssquery-prototype.html (next: http://localhost:56426/tests/dromaeo/cssquery-yui.html) 08:03:54 INFO - PROCESS | 13999 | RSS: Main: 164515840 08:03:54 INFO - PROCESS | 13999 | 08:06:56 INFO - PROCESS | 13999 | Cycle 1(1): loaded http://localhost:56426/tests/dromaeo/cssquery-yui.html (next: http://localhost:56426/tests/dromaeo/cssquery-dojo.html) 08:06:56 INFO - PROCESS | 13999 | RSS: Main: 167567360 08:06:56 INFO - PROCESS | 13999 | 08:06:56 INFO - PROCESS | 13999 | __start_tp_report 08:06:56 INFO - PROCESS | 13999 | _x_x_mozilla_page_load 08:06:56 INFO - PROCESS | 13999 | _x_x_mozilla_page_load_details 08:06:56 INFO - PROCESS | 13999 | |i|pagename|runs| 08:06:56 INFO - PROCESS | 13999 | |0;dojo.html;2628.1327162036528;2680.584509401043;2706.49929762994;2706.878190481428;2713.6472258606377;4642.721436713799;4656.930146047804;4668.369770081038;4670.486246512885;4724.291356296557;4582.885427864305;4591.793369298382;4670.789814458349;4680.204365257906;4731.90536189276;4327.480702315719;4345.717528360647;4364.127174565084;4409.4488188976375;4456.910861782762;4336.588024137702;4388.692791504596;4439.223135951212;4452.821887124527;4483.574060464267;4235.661147108224;4239.91520169598;4295.978520107379;4330.307150855848;4422.447194100738;4305.806238719234;4317.97841010796;4329.588689074533;4332.740035597874;4346.717463364903;4293.720908140961;4298.763568003758;4299.78501074945;4327.17783621111;4345.760983145926;4459.487158976727;4511.413516242867;4582.587567118942;4585.082983403333;4602.562756538124;4993.076280888047;5007.549320561167;5026.52248036436;5031.295618613397;5082.186850103965;5069.61977851659;5076.923846142311;5087.542121209072;5095.821646242401;5136.897262054776;4607.239805432099;4701.600363969067;4729.07782982322;4753.31076993834;4774.9522504775205;5138.049460849755;5198.402183748842;5203.16749320107;5224.50367215114;5253.684778913277;4830.516948305211;4994.101061808837;4994.875128121754;5001.699898006132;5005.1491246488185;4892.0705066037335;5002.174641184237;5023.79904803811;5041.067402530543;5053.5957123430035;4941.851744447672;4979.502049795064;4980.90038199234;4995.050940321327;5046.596272298208;4818.8795280118275;4940.555350018443;4983.526564976394;4985.177445721415;5018.096742586296;4268.701190916669;4269.338252570857;4283.87148385549;4309.827606895752;4327.805248763813;3713.628637136319;3737.663610275088;3742.4573436851506;3750.474933509311;3781.9243615127543;4287.614114729689;4296.613304802583;4305.569443055732;4319.092990472036;4378.146261478981;5016.749162541858;5028.924566131511;5031.169856973558;5045.243213517928;5061.6962982221185;4351;4363.258246098171;4399.736015838996;4415.823367065345;4446.9777651111535;4510.526394728572;4513.526079761577;4554.88612784683;4569.565891240327;4587.724736515753;4757.928631070467;4785.9042819144115;4807.879803004953;4819.421669399694;4824.0834241494;5015.799368025384;5056.519630635231;5058.1148299048255;5073.416557095981;5075.3148324975655;4632.3977882875015;4780;4833.782479788348;4847;4871.147549178809;4944.678595891256;4946.307516947558;4964.230544265644;4965.553100220997;5023.196288593807;5016.097102521581;5026.396832380138;5028.270900719448;5031.22016087507;5105.030044291572;4674.345591617244;4779.689320194177;4905.8037678492465;4959;4994.600431965507;4855.732934688626;4899.461059283405;4908.386451693538;4915.11527924977;4951.034548263054;4680.4149481314835;4681.485036646034;4694.62443004552;4700.858974230779;4706.741129237925;4804.807807687654;4909.435414927186;4943.184374578154;4967.677100988424;4993.975030124826;4797.472278049481;4830.661853670209;4832.685875418087;4854.466008739107;4901.58336541398 08:06:56 INFO - PROCESS | 13999 | |1;ext.html;512.0705918757455;518.9532942035219;530.0485628297208;536.7209051293328;564.0270533330004;36855.81572092139;37382.8130859346;37674.811625941904;37758.622413775855;37818.05454863626;38745.41881871774;38756;38994.80502597483;39234.21531569367;39415.21169576607;7591.582462964535;7804.570748608824;7819.257170568815;7835.255650713173;7872;7676.080979755061;7751.18612545683;7779.066512018538;7793.298603125718;7800.024996875391;7789.221077892222;7808.1801410851895;7844.921550784505;7897.644605992716;7897.842043159133;7803.960980195091;7809.258120478574;7844.882326765103;7867.921320786776;7869.881951770728;7789.10425301092;7845.686172553148;7926.960365198137;7940.166282540308;7941.722039728582;34584;34903.1274218144;34977;34983.82508087469;35032.824835875916;2909.6072030275855;3019.411214813112;3122.609673790776;3128.139761565588;3286.342731453719;28400.437975911318;28938;29062.41875162506;29281.707182928112;30043.098707038604;3494.178867966026;3500.3524347995703;3514.3674138655033;3546.8935931922083;3577.94633080504;244233;244570;244768;245053;245359;42197.15605687869;55200;55213;55514.72242638761;55594;41467.1706565867;41544.37683434751;41585;41720.79139604283;41729.374059389134;13631.931840340734;13723.1079979801;13838.23889686077;13922.607739225996;13953.093048951989;9795.06946840049;9801.11789938909;9806.558704858298;9806.65676701312;9812.264080194014;14435.278236088154;14553.199574023318;14630.561083167522;14660.266986650624;14695.338709758087;5683.460071293221;5844.824655260349;5929.4070592941225;5956.910646340309;5974.970125149346;881.7971866470748;916.3127654259306;926.6849271247673;980.4068538534227;1012.9594816207269;27007.98729969761;27469.450610987667;27640.170794876187;27781;28010;872.5462759365095;932.8087742012871;963.1091240602415;968.5496244246459;996.8255555277798;13365.866341336656;13448.529301474597;13478.19130852152;13511.054226204267;13698.178109313472;158050;161574.1921290386;161638.19180904256;161872;162266;47654.28518572224;49210.99999999929;49287.260691089665;49511.50488495069;49605.751971240636;1210.0984766349127;1211.2853416484318;1211.715246916974;1218.8537375514995;1248.5442813373054;25850.224493265232;26255.73744262533;26672.64797507788;26873.059442919402;26964.32589185286;38291.23417531578;38738.22523549457;38906.6109338903;38951.80524097361;39105.41341879931;231566;232233;233161;233623;234565;29018;29328;29365.26586835346;30309.848450757607;32271.193220169684;40883.18233635251;40980.79509602433;41263.1747365045;43375.34936975885;45417;32320.676793231767;33353.332933341684;33711.32577348488;35548.46677299791;35575.46636800502;33901.66098339084;34909.65090349064;34988.82505587456;35384.82307588446;35413;33896;36967.44548831823;37286.813565931996;37686.2462750749;37785.24429511449;28773.56839647449;31481.21296967594;31595.684043159275;31970.36059278755;32011;24467.30674471034;24483.755162448146;24612.876935615208;24691;24708.382290442165 08:06:56 INFO - PROCESS | 13999 | |2;jquery.html;345.88239998400536;351.257091252002;354.9591796943352;359.3621322153178;361.5950135847851;9902.35634683745;13314.334283285845;15261.923690381547;15846.128462934534;16175.35298588055;16805;16952.74570881438;17164.22760975756;17312.394066207686;17552.473425797216;5456.290682211317;5619.4942455179025;5627.380988091307;5631;5644.57665675074;5288.92066619001;5525.557955363562;5548.55611551075;5551;5562.916556251659;5533.170024496318;5534.889302213954;5538.584606154534;5540.667559946396;5551.528120109796;5453.672779633215;5467.782527064277;5541.861453463655;5558.583106267026;5599.272094627713;5381.78472861089;5389.245505629215;5400.297961265011;5403.054465468527;5413.512783849473;21164.682529762067;21860.781392186032;22290.108395664152;22524.549509009892;22526.211582594693;1946.9318573849848;2022.3124137793075;2035.4097311779567;2101.317071951622;2117.301290574122;13331.40008699611;13393.598192054254;13849.723005539832;14194.077384969944;14448.927755361261;1876.0807204469847;1956.4348521182997;2038.8368930485526;2039.5003224210163;2058.5779915117364;61944.69027654833;64792;65145.348546514404;66897;66968.3303166967;14692.163479565055;15004.399824006918;15326.463573775087;15350.08123984502;15367.538973830578;11707.824382634268;24758.009679612613;24889.87555062249;25026.249212523653;25163.370915727253;5236.607254455931;5428.240046393508;5707.800226992118;7170;7273.16358618755;6855.451563874878;6879.931200688029;6953.82615434608;7055.059858538841;7060.7881763547175;4143.212789569972;4172.541020487804;4250.596193361625;4274.871753847389;4285.657147428198;1643.7370020796616;1809.1044932758368;1815.112283225457;1847.2518629954889;1869.8504119670395;846.580942433487;899.3120262998812;927.6011315134422;945.0596656326861;957.2150836314156;15043.323050462755;15910.284037218353;15968.920155399148;16293.837061629469;16342.75485867713;841.9200175983271;857.5412154497315;864.0711235421821;881.8148188880407;888.5956889615339;9107.772305692279;9199.494027828534;9252.583633736498;9254.953725231331;9466.90533094674;147392;147897;147957.26021369823;148407.2579637095;252704;68347.65826170838;68589.65705171443;68799.999999999;69593;72640.63679681568;916.4867674102658;924.2836801478908;927.1470247372433;966.468442356701;967.5500892085214;14942.925285373503;15016.92491537579;15112.848871511143;15297.464588739786;15521.301541430888;27941.441171176055;32483.512747309283;33018.17454563655;33106.6893310667;35677;40636.390454142624;41064.1787164249;41355;41716.79141604394;42450.150996980505;9696.612135514782;10278.074973252444;10367.896321036693;10592.629257975934;10753.247272690836;12201.20692155007;12242.449089790802;12321.07591930591;12337.568185113478;12504.812042855914;5462.8907421850545;9857.753556161153;10560.894391055992;10759.762627297961;11073.667789966314;10442.373457592568;10801;10831.133509319077;11004.559817607205;11020.44897755125;10780.29928054674;10809.837852432063;10959.726006849574;11133.220674553027;11143.33140011602;10632.362058276529;10899.618513352312;10964.28732132409;10981.341119532854;11034.448277585929;10619.15046796239;10648.84026739584;10973.286736362112;10999.890001099886;11022.283551569122 08:06:56 INFO - PROCESS | 13999 | |3;mootools.html;1418.6098822823724;1437.209534755884;1573.1347758732695;1724.8447639712424;1733.5926057376507;6660.134182556261;7273.963630181855;7554.773356799298;7706.229377062291;7800.804979875499;7443.627818609075;7492.925070749291;7599.658015389307;7606.657700403482;7610;2238.362066810955;2249.8312626552993;2272.9544409571618;2273.59075366434;2276.567452184088;2226.588081204974;2226.6882636430914;2262.0951619352227;2275.351524815428;2284.9657255141187;2234.1510226114056;2238.9440263993447;2261.1294651559106;2261.231181398324;2276.1805749930095;2251.797338239566;2268.5009297954425;2278.977210227893;2280.1791355112146;2287.59967005775;2217.079911836586;2225.2100504321056;2228.3983324502456;2228.643417053264;2233.084435381486;7630.046244219473;7733.883991740128;7740.303372696484;7754.806129846743;7772.3393511551585;4518.3222516622445;4564.6348292136545;4620.561046700592;4626.7223966562115;4642.582167604898;2830.8867645294163;3017.306019615479;3024.9243768905735;3035.438443887888;3045.3148041690442;931.0735817861204;935.864299676543;944.1644144931785;959.8704174936364;976.85835553845;10640;10655.094316983066;10698.51856666452;10710.678679639544;10758.300710453796;4168.749875007509;4284.742915425085;4316.9639286571;4318.460192475941;4328.718633288826;9056.230220431336;9124.726258212264;9147.405418647766;9153.54232288383;9155.038720934339;4685.929711054337;4693.366395536559;4703.270992996091;4741.122892264942;4754.7147171169845;3611.819409029538;4062.51249850014;4096.221717873595;4200.7059505834295;4271.124419493996;3538.929221415557;3581.6955558777795;3622.1487950331652;3622.9275414491563;3633.4731463937583;1185.3658292813304;1205.8311836342918;1217.0324591949422;1219.5548624751902;1222.608765195129;1202.8195770634475;1204.5422739359162;1217.6407959651924;1229.7417542316034;1232.4392401457314;7146.464015198881;7155.570665760071;7175.067241258603;7190.173130090002;7329.303716147064;1012.7012531303283;1047.6856942917095;1062.2351906627216;1066.0778426660881;1086.0551320351187;5578.9163162552595;5617.634853734494;5648.8870222595315;5672.234248376499;5678.858028549319;9229.123233292827;9431.575579098957;9463.574139163755;9521.143097121154;9613.567389467491;9247.676331328372;9398.90601093994;9425.952870235606;9535.90464095364;9553.570089345996;7297.1608265049135;7382.815429614303;7420.109586849612;7422.665980030912;7424.703011879465;6940.583564986117;7066.505344626033;7107.289271072851;7125.5368401053765;7143;8287.751367458986;8510.276626486819;8533.530655813742;8539.829203415773;8625.8706119407;8633.91366086331;8749.91250087491;8763.605637746445;8763.693270735494;8851.495245808099;5694.572907031907;6092.664903430176;6299.6535190564955;6505.447037001908;6554.377334153248;7178.24628414009;7199.1001124859395;7223.422126229784;7234.385077268281;7264.055672762718;6293;6368.16912644584;6407.167068281094;6418.807435776934;6510.5117116217425;6333.240011198685;6341.778037768656;6366.427021568081;6478.870422591616;6490.286068532363;6610.603363798187;6651.06885036105;6671.966640166768;6686.598804071771;6686.966565167143;6221;6254.374562543891;6258.374162583706;6263.279722831932;6316.905246421215;6449.419552240321;6461.19235095613;6493.935060649522;6505.73977040932;6514.54398192122 08:06:56 INFO - PROCESS | 13999 | |4;prototype.html;318.17592435591814;320.3688733195605;326.53957919333743;327.5299944579528;330.632997372916;5798.82603521894;5854.268216472941;5858.912116318259;5871.295444546655;5880.029795083811;5688.488036076752;5695.74369153388;5696.914546281809;5701.0878259478495;5706.201131841535;4147.440095587087;4289.957100429003;4403.427554417937;4424.9557504424865;4426.77866106695;4387.276099443588;4399.912001759963;4406.0747243078995;4417.315316126005;4429.734215947037;4356.215881141393;4356.673249506284;4371.73769573825;4386.934195987047;4389.934150987738;4378.387025816388;4383.539728328527;4383.671224658164;4395.7142785718825;4402;3850.5956874528333;3856.7107466940092;3857.7106716996336;3862.3627101528214;3875.2636998970106;5394.244805727201;5396.298481197458;5413.702246376448;5426.050441172779;5429.1584804355;4819.277108433763;4972.105021096201;4980.676256043345;4998.90002199954;5107.284980102751;5940.584159108864;5956.851078723023;6012.669303188323;6013;6018;4119.382092686091;4131.400946862718;4134.937975930364;4137.648299894513;4141.585841415865;6305.558610897239;6367.140436041168;6382.297947225801;6386.105945167634;6396.808095757135;4167;4192.769397683157;4194.182134483746;4211.052513184509;4214.515330737005;4117.21772863155;4258.935266183455;4269.338252570857;4278.44380230568;4299.398084268205;4882.536159064884;4901.975490122598;4928.8767780805765;4938.38270216223;4944.752762361867;5937.2578427696535;6022.337542870368;6033.456988870935;6052.515798736179;6056.031035034462;1500.6098414412113;1506.1716056169282;1515.1969456188237;1518.9468368607045;1520.0347779160313;980.3627642032736;991.2417000994245;1010.5957616953277;1014.523174108168;1015.294370412571;5210.53105220532;5221.503957124067;5241.9737901310245;5248.422673505911;5250.1337279349245;6208.50331973441;6247.875042499125;6255.343188965184;6257.561970662101;6269.523538202476;5049.545540901337;5097.082525145435;5209.140491818807;5216.686998780086;5237.135872581058;3345.8996230113135;3354.7316214702764;3372.2412457196933;3378.35811195872;3390.69483746464;5954.10688396744;5977.551683623658;5978.55160862937;5983.461488465972;5985.820425387245;6447.709853056624;6512.772052978123;6519.934800652028;6523.934760652332;6528.183977002875;5864.589478736533;5915.112733090071;5946.583739138218;5955.28536575605;5975.462208401264;6070.7875224366935;6244.188255526752;6277.2781130170615;6290.842728931813;6300.716467759054;6169.321374648695;6172.753089876354;6186.907196391968;6189.226346706661;6190.854691882017;5944.078667806497;5946.643201407929;5965.28416590012;5969.074793407029;5990.820275391745;4224.704270701021;4246.4691913510815;4247.341662042389;4258.936115958325;4265.338872474771;6061.242344706911;6235.438810506895;6247.812565623039;6279.686015699105;6284.591501552567;6031.215941927521;6035.275766907999;6043.486303664238;6054.424829641177;6073.331933487401;5969.522438204846;6039.245094363205;6048.969755151196;6071.150038994456;6072.514198864169;5915.645061296336;5939.7624095037445;5953.970230148821;5956.612820166675;5975.073863551156;6061.605995610271;6077.665728384981;6080.391960803884;6082.969585152223;6094.695265236809;5724.771009159587;5872.148538461985;5882.382349853375;5882.705864706833;5895.351511333664 08:06:56 INFO - PROCESS | 13999 | |5;yui.html;697.9197392299885;776.398291324224;778.256764789626;793.7460012795906;796.9721059762909;12411.131220814546;12428.502859885617;12598.496060157606;12609.5586654467;12622.810657840128;11404.429778511061;12235.571754988578;12252;12257.632271031862;12311.507539698423;646.0728854094366;797.2744802229972;800.2677550041705;811.1847593168886;815.8531464336417;816.3265306122473;816.5917041479261;817.6933649881295;819.2094628683319;821.2690705272313;843.8101427178897;845.5138295480093;848.5841937450635;850.0352100366067;850.1413572291999;841.4278290762279;845.3744229270358;849.6134258912211;850.0946491986015;851.4720873058682;618.5051958433236;621.0652967284253;621.2389822467486;622.551762730833;624.528480996849;12807.551735689207;12832.679183020406;12881.871181288161;12919.031072669588;12930.870691293156;12675.239485630891;12779.594244633176;12820;12892.226466412045;12915.418806153652;10004.54979525923;10208.979102089732;10228.488575571191;10351.637692680795;10369;3363.562736844219;3368.729038742866;3415.9316813663836;3448.0862571418593;3451.5340429042008;42123.94690132741;42602.36096458525;42658;42782.57217427817;43035.78482107569;9270.768230794149;9296.628134874529;9380.5309734513;9400.200982916393;9454.149126578503;17633.7354939676;17685.38101166453;17718;17798;17840.107994600217;6280.528960327993;6366.172397588284;6410.775622853178;6516.380943810331;6584.341565843377;3580.1407662161414;3583.7849729016343;3597.6042635310096;3598.4962105305276;3617.5116359291687;2760.144355249879;2784.5823126530777;2786.4566409549943;2791.804573679823;2796.6923638399758;503.3154909323317;508.6693649128022;517.5342192027131;521.8512723873678;526.0951163997918;507.3075252280684;568.5565259097827;642.9260635027032;650.200253687957;652.2401402366285;7834;8141.22658347456;8250.793730156794;8343.899952761043;8345.082040975487;498.98253561125915;599.9950083609936;620.1194304088206;640.8173670503884;669.7856685860478;3627.093226693327;3672.9147516086614;3728.8694895678523;3734.972882457346;3862.1889403225637;49665.751671241414;51312;51404;51494.742526287126;51601.2259816103;43568;43674.34488482675;45104.3234351485;45117.902104167464;45129.32306015412;41104;41423.7928810354;41424.58575414207;41689.37465938013;41709.58290417118;7529.472936894584;7546.849995263918;7572.545647261182;7658.73194438192;7900.525968441912;31610.209744756565;31766.205844854063;32168;32498.675013249565;32534.186645334055;37525;37616;38580.42129368118;40642;40804.79597601993;10113.59545618167;10230.079292863678;10245.385276883411;10378.481075946323;10420;10216.948915255376;10236.283460157718;10397.792044158923;10417.895821041995;10545.789084218119;8807.427517211361;8824.691135810473;9399.906000939904;9498.85751713711;9943.701688949342;9783.36408133469;9813.165880899918;9827.31208815376;9865.802683946138;10215.846762298721;9789.118979291898;9827.4103553787;9837.557309921214;9863.309568330435;10010.899891000996;8485.533295668798;8491.575421229038;8647.481151130953;8871.201591856763;9212.769680758034;8457.196566326189;8514.616842242238;8585.399022068395;8659.913400865911;8971.461712297283 08:06:56 INFO - PROCESS | 13999 | __end_tp_report 08:06:56 INFO - PROCESS | 13999 | __start_cc_report 08:06:56 INFO - PROCESS | 13999 | _x_x_mozilla_cycle_collect,373 08:06:56 INFO - PROCESS | 13999 | __end_cc_report 08:06:56 INFO - PROCESS | 13999 | __startTimestamp1460041616631__endTimestamp 08:06:56 INFO - PROCESS | 13999 | 08:06:56 INFO - PROCESS | 13999 | ------- Summary: start ------- 08:06:56 INFO - PROCESS | 13999 | Number of tests: 6 08:06:56 INFO - PROCESS | 13999 | 08:06:56 INFO - PROCESS | 13999 | [#0] dojo.html Cycles:165 Average:4650.59 Median:4774.95 stddev:476.51 (10.0%) stddev-sans-first:450.78 08:06:56 INFO - PROCESS | 13999 | Values: 2628.1 2680.6 2706.5 2706.9 2713.6 4642.7 4656.9 4668.4 4670.5 4724.3 4582.9 4591.8 4670.8 4680.2 4731.9 4327.5 4345.7 4364.1 4409.4 4456.9 4336.6 4388.7 4439.2 4452.8 4483.6 4235.7 4239.9 4296.0 4330.3 4422.4 4305.8 4318.0 4329.6 4332.7 4346.7 4293.7 4298.8 4299.8 4327.2 4345.8 4459.5 4511.4 4582.6 4585.1 4602.6 4993.1 5007.5 5026.5 5031.3 5082.2 5069.6 5076.9 5087.5 5095.8 5136.9 4607.2 4701.6 4729.1 4753.3 4775.0 5138.0 5198.4 5203.2 5224.5 5253.7 4830.5 4994.1 4994.9 5001.7 5005.1 4892.1 5002.2 5023.8 5041.1 5053.6 4941.9 4979.5 4980.9 4995.1 5046.6 4818.9 4940.6 4983.5 4985.2 5018.1 4268.7 4269.3 4283.9 4309.8 4327.8 3713.6 3737.7 3742.5 3750.5 3781.9 4287.6 4296.6 4305.6 4319.1 4378.1 5016.7 5028.9 5031.2 5045.2 5061.7 4351.0 4363.3 4399.7 4415.8 4447.0 4510.5 4513.5 4554.9 4569.6 4587.7 4757.9 4785.9 4807.9 4819.4 4824.1 5015.8 5056.5 5058.1 5073.4 5075.3 4632.4 4780.0 4833.8 4847.0 4871.1 4944.7 4946.3 4964.2 4965.6 5023.2 5016.1 5026.4 5028.3 5031.2 5105.0 4674.3 4779.7 4905.8 4959.0 4994.6 4855.7 4899.5 4908.4 4915.1 4951.0 4680.4 4681.5 4694.6 4700.9 4706.7 4804.8 4909.4 4943.2 4967.7 4994.0 4797.5 4830.7 4832.7 4854.5 4901.6 08:06:56 INFO - PROCESS | 13999 | 08:06:56 INFO - PROCESS | 13999 | [#1] ext.html Cycles:180 Average:37686.30 Median:19576.71 stddev:56189.47 (287.0%) stddev-sans-first:56277.77 08:06:56 INFO - PROCESS | 13999 | Values: 512.1 519.0 530.0 536.7 564.0 36855.8 37382.8 37674.8 37758.6 37818.1 38745.4 38756.0 38994.8 39234.2 39415.2 7591.6 7804.6 7819.3 7835.3 7872.0 7676.1 7751.2 7779.1 7793.3 7800.0 7789.2 7808.2 7844.9 7897.6 7897.8 7804.0 7809.3 7844.9 7867.9 7869.9 7789.1 7845.7 7927.0 7940.2 7941.7 34584.0 34903.1 34977.0 34983.8 35032.8 2909.6 3019.4 3122.6 3128.1 3286.3 28400.4 28938.0 29062.4 29281.7 30043.1 3494.2 3500.4 3514.4 3546.9 3577.9 244233.0 244570.0 244768.0 245053.0 245359.0 42197.2 55200.0 55213.0 55514.7 55594.0 41467.2 41544.4 41585.0 41720.8 41729.4 13631.9 13723.1 13838.2 13922.6 13953.1 9795.1 9801.1 9806.6 9806.7 9812.3 14435.3 14553.2 14630.6 14660.3 14695.3 5683.5 5844.8 5929.4 5956.9 5975.0 881.8 916.3 926.7 980.4 1013.0 27008.0 27469.5 27640.2 27781.0 28010.0 872.5 932.8 963.1 968.5 996.8 13365.9 13448.5 13478.2 13511.1 13698.2 158050.0 161574.2 161638.2 161872.0 162266.0 47654.3 49211.0 49287.3 49511.5 49605.8 1210.1 1211.3 1211.7 1218.9 1248.5 25850.2 26255.7 26672.6 26873.1 26964.3 38291.2 38738.2 38906.6 38951.8 39105.4 231566.0 232233.0 233161.0 233623.0 234565.0 29018.0 29328.0 29365.3 30309.8 32271.2 40883.2 40980.8 41263.2 43375.3 45417.0 32320.7 33353.3 33711.3 35548.5 35575.5 33901.7 34909.7 34988.8 35384.8 35413.0 33896.0 36967.4 37286.8 37686.2 37785.2 28773.6 31481.2 31595.7 31970.4 32011.0 24467.3 24483.8 24612.9 24691.0 24708.4 08:06:56 INFO - PROCESS | 13999 | 08:06:56 INFO - PROCESS | 13999 | [#2] jquery.html Cycles:180 Average:18112.22 Median:140322.72 stddev:30789.21 (21.9%) stddev-sans-first:30846.68 08:06:56 INFO - PROCESS | 13999 | Values: 345.9 351.3 355.0 359.4 361.6 9902.4 13314.3 15261.9 15846.1 16175.4 16805.0 16952.7 17164.2 17312.4 17552.5 5456.3 5619.5 5627.4 5631.0 5644.6 5288.9 5525.6 5548.6 5551.0 5562.9 5533.2 5534.9 5538.6 5540.7 5551.5 5453.7 5467.8 5541.9 5558.6 5599.3 5381.8 5389.2 5400.3 5403.1 5413.5 21164.7 21860.8 22290.1 22524.5 22526.2 1946.9 2022.3 2035.4 2101.3 2117.3 13331.4 13393.6 13849.7 14194.1 14448.9 1876.1 1956.4 2038.8 2039.5 2058.6 61944.7 64792.0 65145.3 66897.0 66968.3 14692.2 15004.4 15326.5 15350.1 15367.5 11707.8 24758.0 24889.9 25026.2 25163.4 5236.6 5428.2 5707.8 7170.0 7273.2 6855.5 6879.9 6953.8 7055.1 7060.8 4143.2 4172.5 4250.6 4274.9 4285.7 1643.7 1809.1 1815.1 1847.3 1869.9 846.6 899.3 927.6 945.1 957.2 15043.3 15910.3 15968.9 16293.8 16342.8 841.9 857.5 864.1 881.8 888.6 9107.8 9199.5 9252.6 9255.0 9466.9 147392.0 147897.0 147957.3 148407.3 252704.0 68347.7 68589.7 68800.0 69593.0 72640.6 916.5 924.3 927.1 966.5 967.6 14942.9 15016.9 15112.8 15297.5 15521.3 27941.4 32483.5 33018.2 33106.7 35677.0 40636.4 41064.2 41355.0 41716.8 42450.2 9696.6 10278.1 10367.9 10592.6 10753.2 12201.2 12242.4 12321.1 12337.6 12504.8 5462.9 9857.8 10560.9 10759.8 11073.7 10442.4 10801.0 10831.1 11004.6 11020.4 10780.3 10809.8 10959.7 11133.2 11143.3 10632.4 10899.6 10964.3 10981.3 11034.4 10619.2 10648.8 10973.3 10999.9 11022.3 08:06:56 INFO - PROCESS | 13999 | 08:06:56 INFO - PROCESS | 13999 | [#3] mootools.html Cycles:180 Average:5364.19 Median:6278.14 stddev:2799.10 (44.6%) stddev-sans-first:2791.24 08:06:56 INFO - PROCESS | 13999 | Values: 1418.6 1437.2 1573.1 1724.8 1733.6 6660.1 7274.0 7554.8 7706.2 7800.8 7443.6 7492.9 7599.7 7606.7 7610.0 2238.4 2249.8 2273.0 2273.6 2276.6 2226.6 2226.7 2262.1 2275.4 2285.0 2234.2 2238.9 2261.1 2261.2 2276.2 2251.8 2268.5 2279.0 2280.2 2287.6 2217.1 2225.2 2228.4 2228.6 2233.1 7630.0 7733.9 7740.3 7754.8 7772.3 4518.3 4564.6 4620.6 4626.7 4642.6 2830.9 3017.3 3024.9 3035.4 3045.3 931.1 935.9 944.2 959.9 976.9 10640.0 10655.1 10698.5 10710.7 10758.3 4168.7 4284.7 4317.0 4318.5 4328.7 9056.2 9124.7 9147.4 9153.5 9155.0 4685.9 4693.4 4703.3 4741.1 4754.7 3611.8 4062.5 4096.2 4200.7 4271.1 3538.9 3581.7 3622.1 3622.9 3633.5 1185.4 1205.8 1217.0 1219.6 1222.6 1202.8 1204.5 1217.6 1229.7 1232.4 7146.5 7155.6 7175.1 7190.2 7329.3 1012.7 1047.7 1062.2 1066.1 1086.1 5578.9 5617.6 5648.9 5672.2 5678.9 9229.1 9431.6 9463.6 9521.1 9613.6 9247.7 9398.9 9426.0 9535.9 9553.6 7297.2 7382.8 7420.1 7422.7 7424.7 6940.6 7066.5 7107.3 7125.5 7143.0 8287.8 8510.3 8533.5 8539.8 8625.9 8633.9 8749.9 8763.6 8763.7 8851.5 5694.6 6092.7 6299.7 6505.4 6554.4 7178.2 7199.1 7223.4 7234.4 7264.1 6293.0 6368.2 6407.2 6418.8 6510.5 6333.2 6341.8 6366.4 6478.9 6490.3 6610.6 6651.1 6672.0 6686.6 6687.0 6221.0 6254.4 6258.4 6263.3 6316.9 6449.4 6461.2 6493.9 6505.7 6514.5 08:06:56 INFO - PROCESS | 13999 | 08:06:56 INFO - PROCESS | 13999 | [#4] prototype.html Cycles:180 Average:4979.43 Median:5699.00 stddev:1489.46 (26.1%) stddev-sans-first:1451.96 08:06:56 INFO - PROCESS | 13999 | Values: 318.2 320.4 326.5 327.5 330.6 5798.8 5854.3 5858.9 5871.3 5880.0 5688.5 5695.7 5696.9 5701.1 5706.2 4147.4 4290.0 4403.4 4425.0 4426.8 4387.3 4399.9 4406.1 4417.3 4429.7 4356.2 4356.7 4371.7 4386.9 4389.9 4378.4 4383.5 4383.7 4395.7 4402.0 3850.6 3856.7 3857.7 3862.4 3875.3 5394.2 5396.3 5413.7 5426.1 5429.2 4819.3 4972.1 4980.7 4998.9 5107.3 5940.6 5956.9 6012.7 6013.0 6018.0 4119.4 4131.4 4134.9 4137.6 4141.6 6305.6 6367.1 6382.3 6386.1 6396.8 4167.0 4192.8 4194.2 4211.1 4214.5 4117.2 4258.9 4269.3 4278.4 4299.4 4882.5 4902.0 4928.9 4938.4 4944.8 5937.3 6022.3 6033.5 6052.5 6056.0 1500.6 1506.2 1515.2 1518.9 1520.0 980.4 991.2 1010.6 1014.5 1015.3 5210.5 5221.5 5242.0 5248.4 5250.1 6208.5 6247.9 6255.3 6257.6 6269.5 5049.5 5097.1 5209.1 5216.7 5237.1 3345.9 3354.7 3372.2 3378.4 3390.7 5954.1 5977.6 5978.6 5983.5 5985.8 6447.7 6512.8 6519.9 6523.9 6528.2 5864.6 5915.1 5946.6 5955.3 5975.5 6070.8 6244.2 6277.3 6290.8 6300.7 6169.3 6172.8 6186.9 6189.2 6190.9 5944.1 5946.6 5965.3 5969.1 5990.8 4224.7 4246.5 4247.3 4258.9 4265.3 6061.2 6235.4 6247.8 6279.7 6284.6 6031.2 6035.3 6043.5 6054.4 6073.3 5969.5 6039.2 6049.0 6071.2 6072.5 5915.6 5939.8 5954.0 5956.6 5975.1 6061.6 6077.7 6080.4 6083.0 6094.7 5724.8 5872.1 5882.4 5882.7 5895.4 08:06:56 INFO - PROCESS | 13999 | 08:06:56 INFO - PROCESS | 13999 | [#5] yui.html Cycles:180 Average:12438.19 Median:507.99 stddev:14106.29 (2776.9%) stddev-sans-first:14118.31 08:06:56 INFO - PROCESS | 13999 | Values: 697.9 776.4 778.3 793.7 797.0 12411.1 12428.5 12598.5 12609.6 12622.8 11404.4 12235.6 12252.0 12257.6 12311.5 646.1 797.3 800.3 811.2 815.9 816.3 816.6 817.7 819.2 821.3 843.8 845.5 848.6 850.0 850.1 841.4 845.4 849.6 850.1 851.5 618.5 621.1 621.2 622.6 624.5 12807.6 12832.7 12881.9 12919.0 12930.9 12675.2 12779.6 12820.0 12892.2 12915.4 10004.5 10209.0 10228.5 10351.6 10369.0 3363.6 3368.7 3415.9 3448.1 3451.5 42123.9 42602.4 42658.0 42782.6 43035.8 9270.8 9296.6 9380.5 9400.2 9454.1 17633.7 17685.4 17718.0 17798.0 17840.1 6280.5 6366.2 6410.8 6516.4 6584.3 3580.1 3583.8 3597.6 3598.5 3617.5 2760.1 2784.6 2786.5 2791.8 2796.7 503.3 508.7 517.5 521.9 526.1 507.3 568.6 642.9 650.2 652.2 7834.0 8141.2 8250.8 8343.9 8345.1 499.0 600.0 620.1 640.8 669.8 3627.1 3672.9 3728.9 3735.0 3862.2 49665.8 51312.0 51404.0 51494.7 51601.2 43568.0 43674.3 45104.3 45117.9 45129.3 41104.0 41423.8 41424.6 41689.4 41709.6 7529.5 7546.8 7572.5 7658.7 7900.5 31610.2 31766.2 32168.0 32498.7 32534.2 37525.0 37616.0 38580.4 40642.0 40804.8 10113.6 10230.1 10245.4 10378.5 10420.0 10216.9 10236.3 10397.8 10417.9 10545.8 8807.4 8824.7 9399.9 9498.9 9943.7 9783.4 9813.2 9827.3 9865.8 10215.8 9789.1 9827.4 9837.6 9863.3 10010.9 8485.5 8491.6 8647.5 8871.2 9212.8 8457.2 8514.6 8585.4 8659.9 8971.5 08:06:56 INFO - PROCESS | 13999 | -------- Summary: end -------- 08:06:56 INFO - PROCESS | 13999 | 08:06:57 INFO - TEST-INFO | 13999: exit 0 08:06:57 INFO - TEST-OK | dromaeo_css | took 1114321ms 08:06:57 INFO - TEST-START | kraken 08:06:57 INFO - operating with platform_type : linux_ 08:06:57 INFO - Initialising browser for kraken test... 08:06:57 INFO - TEST-INFO | started process 14236 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp5zwUMI/profile http://localhost:56426/getInfo.html) 08:07:01 INFO - PROCESS | 14236 | 08:07:01 INFO - PROCESS | 14236 | (process:14303): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 08:07:01 INFO - PROCESS | 14236 | 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] 08:07:02 INFO - PROCESS | 14236 | __metrics Screen width/height:1600/1200 08:07:02 INFO - PROCESS | 14236 | colorDepth:24 08:07:02 INFO - PROCESS | 14236 | Browser inner width/height: 1024/697 08:07:02 INFO - PROCESS | 14236 | __metrics 08:07:03 ERROR - PROCESS | 14236 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2881: TypeError: this.tabs is undefined 08:07:03 INFO - TEST-INFO | 14236: exit 0 08:07:03 INFO - Browser initialized. 08:07:03 INFO - Running cycle 1/1 for kraken test... 08:07:03 INFO - TEST-INFO | started process 14354 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp5zwUMI/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 08:07:05 INFO - PROCESS | 14354 | 08:07:05 INFO - PROCESS | 14354 | (process:14412): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 08:07:15 INFO - PROCESS | 14354 | RSS: Main: 163717120 08:07:15 INFO - PROCESS | 14354 | 08:07:18 INFO - PROCESS | 14354 | Cycle 1(1): loaded http://localhost:56426/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:56426/tests/kraken/driver.html?testName=audio-beat-detection) 08:07:19 INFO - PROCESS | 14354 | RSS: Main: 168124416 08:07:19 INFO - PROCESS | 14354 | 08:07:21 INFO - PROCESS | 14354 | Cycle 1(1): loaded http://localhost:56426/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:56426/tests/kraken/driver.html?testName=audio-dft) 08:07:22 INFO - PROCESS | 14354 | RSS: Main: 171401216 08:07:22 INFO - PROCESS | 14354 | 08:07:25 INFO - PROCESS | 14354 | Cycle 1(1): loaded http://localhost:56426/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:56426/tests/kraken/driver.html?testName=audio-fft) 08:07:26 INFO - PROCESS | 14354 | RSS: Main: 164425728 08:07:26 INFO - PROCESS | 14354 | 08:07:28 INFO - PROCESS | 14354 | Cycle 1(1): loaded http://localhost:56426/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:56426/tests/kraken/driver.html?testName=audio-oscillator) 08:07:28 INFO - PROCESS | 14354 | RSS: Main: 164118528 08:07:28 INFO - PROCESS | 14354 | 08:07:31 INFO - PROCESS | 14354 | Cycle 1(1): loaded http://localhost:56426/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:56426/tests/kraken/driver.html?testName=imaging-gaussian-blur) 08:07:31 INFO - PROCESS | 14354 | RSS: Main: 164696064 08:07:31 INFO - PROCESS | 14354 | 08:07:34 INFO - PROCESS | 14354 | Cycle 1(1): loaded http://localhost:56426/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:56426/tests/kraken/driver.html?testName=imaging-darkroom) 08:07:35 INFO - PROCESS | 14354 | RSS: Main: 165494784 08:07:35 INFO - PROCESS | 14354 | 08:07:38 INFO - PROCESS | 14354 | Cycle 1(1): loaded http://localhost:56426/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:56426/tests/kraken/driver.html?testName=imaging-desaturate) 08:07:39 INFO - PROCESS | 14354 | RSS: Main: 162816000 08:07:39 INFO - PROCESS | 14354 | 08:07:42 INFO - PROCESS | 14354 | Cycle 1(1): loaded http://localhost:56426/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:56426/tests/kraken/driver.html?testName=json-parse-financial) 08:07:43 INFO - PROCESS | 14354 | RSS: Main: 163344384 08:07:43 INFO - PROCESS | 14354 | 08:07:44 INFO - PROCESS | 14354 | Cycle 1(1): loaded http://localhost:56426/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:56426/tests/kraken/driver.html?testName=json-stringify-tinderbox) 08:07:45 INFO - PROCESS | 14354 | RSS: Main: 163946496 08:07:45 INFO - PROCESS | 14354 | 08:07:47 INFO - PROCESS | 14354 | Cycle 1(1): loaded http://localhost:56426/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:56426/tests/kraken/driver.html?testName=stanford-crypto-aes) 08:07:47 INFO - PROCESS | 14354 | RSS: Main: 163532800 08:07:47 INFO - PROCESS | 14354 | 08:07:49 INFO - PROCESS | 14354 | Cycle 1(1): loaded http://localhost:56426/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:56426/tests/kraken/driver.html?testName=stanford-crypto-ccm) 08:07:50 INFO - PROCESS | 14354 | RSS: Main: 163631104 08:07:50 INFO - PROCESS | 14354 | 08:07:53 INFO - PROCESS | 14354 | Cycle 1(1): loaded http://localhost:56426/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:56426/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 08:07:53 INFO - PROCESS | 14354 | RSS: Main: 164499456 08:07:53 INFO - PROCESS | 14354 | 08:07:56 INFO - PROCESS | 14354 | Cycle 1(1): loaded http://localhost:56426/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:56426/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 08:07:56 INFO - PROCESS | 14354 | RSS: Main: 164261888 08:07:56 INFO - PROCESS | 14354 | 08:07:58 INFO - PROCESS | 14354 | Cycle 1(1): loaded http://localhost:56426/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:56426/tests/kraken/driver.html?testName=ai-astar) 08:07:58 INFO - PROCESS | 14354 | RSS: Main: 165269504 08:07:58 INFO - PROCESS | 14354 | 08:07:58 INFO - PROCESS | 14354 | __start_tp_report 08:07:58 INFO - PROCESS | 14354 | _x_x_mozilla_page_load 08:07:58 INFO - PROCESS | 14354 | _x_x_mozilla_page_load_details 08:07:58 INFO - PROCESS | 14354 | |i|pagename|runs| 08:07:58 INFO - PROCESS | 14354 | |0;ai-astar;114;107;113;113;113;126;113;113;115;113 08:07:58 INFO - PROCESS | 14354 | |1;audio-beat-detection;167;140;155;170;134;155;159;139;185;135 08:07:58 INFO - PROCESS | 14354 | |2;audio-dft;164;163;162;160;162;166;169;162;164;162 08:07:58 INFO - PROCESS | 14354 | |3;audio-fft;76;74;86;79;76;74;74;150;74;74 08:07:58 INFO - PROCESS | 14354 | |4;audio-oscillator;93;94;144;93;95;94;147;95;95;141 08:07:58 INFO - PROCESS | 14354 | |5;imaging-gaussian-blur;118;118;118;118;118;118;118;118;119;118 08:07:58 INFO - PROCESS | 14354 | |6;imaging-darkroom;146;148;148;148;147;148;149;146;147;148 08:07:58 INFO - PROCESS | 14354 | |7;imaging-desaturate;96;96;96;95;96;96;96;97;95;96 08:07:58 INFO - PROCESS | 14354 | |8;json-parse-financial;65;65;65;69;65;65;65;65;64;62 08:07:58 INFO - PROCESS | 14354 | |9;json-stringify-tinderbox;62;66;65;64;64;65;65;65;64;64 08:07:58 INFO - PROCESS | 14354 | |10;stanford-crypto-aes;80;82;84;87;90;83;83;83;84;83 08:07:58 INFO - PROCESS | 14354 | |11;stanford-crypto-ccm;126;119;128;118;117;121;120;118;126;125 08:07:58 INFO - PROCESS | 14354 | |12;stanford-crypto-pbkdf2;133;144;147;147;147;139;144;143;143;131 08:07:58 INFO - PROCESS | 14354 | |13;stanford-crypto-sha256-iterative;67;69;69;70;70;69;67;70;66;68 08:07:58 INFO - PROCESS | 14354 | __end_tp_report 08:07:58 INFO - PROCESS | 14354 | __start_cc_report 08:07:58 INFO - PROCESS | 14354 | _x_x_mozilla_cycle_collect,902 08:07:58 INFO - PROCESS | 14354 | __end_cc_report 08:07:58 INFO - PROCESS | 14354 | __startTimestamp1460041678895__endTimestamp 08:07:58 INFO - PROCESS | 14354 | 08:07:58 INFO - PROCESS | 14354 | ------- Summary: start ------- 08:07:58 INFO - PROCESS | 14354 | Number of tests: 14 08:07:58 INFO - PROCESS | 14354 | 08:07:58 INFO - PROCESS | 14354 | [#0] ai-astar Cycles:10 Average:114.00 Median:113.00 stddev:4.71 (4.2%) stddev-sans-first:5.00 08:07:58 INFO - PROCESS | 14354 | Values: 114.0 107.0 113.0 113.0 113.0 126.0 113.0 113.0 115.0 113.0 08:07:58 INFO - PROCESS | 14354 | 08:07:58 INFO - PROCESS | 14354 | [#1] audio-beat-detection Cycles:10 Average:153.90 Median:157.00 stddev:16.98 (10.8%) stddev-sans-first:17.34 08:07:58 INFO - PROCESS | 14354 | Values: 167.0 140.0 155.0 170.0 134.0 155.0 159.0 139.0 185.0 135.0 08:07:58 INFO - PROCESS | 14354 | 08:07:58 INFO - PROCESS | 14354 | [#2] audio-dft Cycles:10 Average:163.40 Median:163.50 stddev:2.55 (1.6%) stddev-sans-first:2.69 08:07:58 INFO - PROCESS | 14354 | Values: 164.0 163.0 162.0 160.0 162.0 166.0 169.0 162.0 164.0 162.0 08:07:58 INFO - PROCESS | 14354 | 08:07:58 INFO - PROCESS | 14354 | [#3] audio-fft Cycles:10 Average:83.70 Median:75.00 stddev:23.60 (31.5%) stddev-sans-first:24.87 08:07:58 INFO - PROCESS | 14354 | Values: 76.0 74.0 86.0 79.0 76.0 74.0 74.0 150.0 74.0 74.0 08:07:58 INFO - PROCESS | 14354 | 08:07:58 INFO - PROCESS | 14354 | [#4] audio-oscillator Cycles:10 Average:109.10 Median:94.00 stddev:24.14 (25.7%) stddev-sans-first:24.89 08:07:58 INFO - PROCESS | 14354 | Values: 93.0 94.0 144.0 93.0 95.0 94.0 147.0 95.0 95.0 141.0 08:07:58 INFO - PROCESS | 14354 | 08:07:58 INFO - PROCESS | 14354 | [#5] imaging-gaussian-blur Cycles:10 Average:118.10 Median:118.00 stddev:0.32 (0.3%) stddev-sans-first:0.33 08:07:58 INFO - PROCESS | 14354 | Values: 118.0 118.0 118.0 118.0 118.0 118.0 118.0 118.0 119.0 118.0 08:07:58 INFO - PROCESS | 14354 | 08:07:58 INFO - PROCESS | 14354 | [#6] imaging-darkroom Cycles:10 Average:147.50 Median:148.00 stddev:0.97 (0.7%) stddev-sans-first:0.87 08:07:58 INFO - PROCESS | 14354 | Values: 146.0 148.0 148.0 148.0 147.0 148.0 149.0 146.0 147.0 148.0 08:07:58 INFO - PROCESS | 14354 | 08:07:58 INFO - PROCESS | 14354 | [#7] imaging-desaturate Cycles:10 Average:95.90 Median:96.00 stddev:0.57 (0.6%) stddev-sans-first:0.60 08:07:58 INFO - PROCESS | 14354 | Values: 96.0 96.0 96.0 95.0 96.0 96.0 96.0 97.0 95.0 96.0 08:07:58 INFO - PROCESS | 14354 | 08:07:58 INFO - PROCESS | 14354 | [#8] json-parse-financial Cycles:10 Average:65.00 Median:65.00 stddev:1.70 (2.6%) stddev-sans-first:1.80 08:07:58 INFO - PROCESS | 14354 | Values: 65.0 65.0 65.0 69.0 65.0 65.0 65.0 65.0 64.0 62.0 08:07:58 INFO - PROCESS | 14354 | 08:07:58 INFO - PROCESS | 14354 | [#9] json-stringify-tinderbox Cycles:10 Average:64.40 Median:65.00 stddev:1.07 (1.7%) stddev-sans-first:0.71 08:07:58 INFO - PROCESS | 14354 | Values: 62.0 66.0 65.0 64.0 64.0 65.0 65.0 65.0 64.0 64.0 08:07:58 INFO - PROCESS | 14354 | 08:07:58 INFO - PROCESS | 14354 | [#10] stanford-crypto-aes Cycles:10 Average:83.90 Median:83.50 stddev:2.77 (3.3%) stddev-sans-first:2.55 08:07:58 INFO - PROCESS | 14354 | Values: 80.0 82.0 84.0 87.0 90.0 83.0 83.0 83.0 84.0 83.0 08:07:58 INFO - PROCESS | 14354 | 08:07:58 INFO - PROCESS | 14354 | [#11] stanford-crypto-ccm Cycles:10 Average:121.80 Median:123.00 stddev:4.05 (3.3%) stddev-sans-first:4.00 08:07:58 INFO - PROCESS | 14354 | Values: 126.0 119.0 128.0 118.0 117.0 121.0 120.0 118.0 126.0 125.0 08:07:58 INFO - PROCESS | 14354 | 08:07:58 INFO - PROCESS | 14354 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:141.80 Median:144.00 stddev:5.73 (4.0%) stddev-sans-first:5.12 08:07:58 INFO - PROCESS | 14354 | Values: 133.0 144.0 147.0 147.0 147.0 139.0 144.0 143.0 143.0 131.0 08:07:58 INFO - PROCESS | 14354 | 08:07:58 INFO - PROCESS | 14354 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:68.50 Median:69.00 stddev:1.43 (2.1%) stddev-sans-first:1.41 08:07:58 INFO - PROCESS | 14354 | Values: 67.0 69.0 69.0 70.0 70.0 69.0 67.0 70.0 66.0 68.0 08:07:58 INFO - PROCESS | 14354 | -------- Summary: end -------- 08:07:58 INFO - PROCESS | 14354 | 08:07:59 INFO - TEST-INFO | 14354: exit 0 08:07:59 INFO - TEST-OK | kraken | took 62529ms 08:07:59 INFO - SUITE-END | took 1176s 08:08:00 INFO - Completed test suite (00:19:36) 08:08:00 INFO - javascript benchmark 08:08:00 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2628.1327162036528, 2680.584509401043, 2706.49929762994, 2706.878190481428, 2713.6472258606377, 4642.721436713799, 4656.930146047804, 4668.369770081038, 4670.486246512885, 4724.291356296557, 4582.885427864305, 4591.793369298382, 4670.789814458349, 4680.204365257906, 4731.90536189276, 4327.480702315719, 4345.717528360647, 4364.127174565084, 4409.4488188976375, 4456.910861782762, 4336.588024137702, 4388.692791504596, 4439.223135951212, 4452.821887124527, 4483.574060464267, 4235.661147108224, 4239.91520169598, 4295.978520107379, 4330.307150855848, 4422.447194100738, 4305.806238719234, 4317.97841010796, 4329.588689074533, 4332.740035597874, 4346.717463364903, 4293.720908140961, 4298.763568003758, 4299.78501074945, 4327.17783621111, 4345.760983145926, 4459.487158976727, 4511.413516242867, 4582.587567118942, 4585.082983403333, 4602.562756538124, 4993.076280888047, 5007.549320561167, 5026.52248036436, 5031.295618613397, 5082.186850103965, 5069.61977851659, 5076.923846142311, 5087.542121209072, 5095.821646242401, 5136.897262054776, 4607.239805432099, 4701.600363969067, 4729.07782982322, 4753.31076993834, 4774.9522504775205, 5138.049460849755, 5198.402183748842, 5203.16749320107, 5224.50367215114, 5253.684778913277, 4830.516948305211, 4994.101061808837, 4994.875128121754, 5001.699898006132, 5005.1491246488185, 4892.0705066037335, 5002.174641184237, 5023.79904803811, 5041.067402530543, 5053.5957123430035, 4941.851744447672, 4979.502049795064, 4980.90038199234, 4995.050940321327, 5046.596272298208, 4818.8795280118275, 4940.555350018443, 4983.526564976394, 4985.177445721415, 5018.096742586296, 4268.701190916669, 4269.338252570857, 4283.87148385549, 4309.827606895752, 4327.805248763813, 3713.628637136319, 3737.663610275088, 3742.4573436851506, 3750.474933509311, 3781.9243615127543, 4287.614114729689, 4296.613304802583, 4305.569443055732, 4319.092990472036, 4378.146261478981, 5016.749162541858, 5028.924566131511, 5031.169856973558, 5045.243213517928, 5061.6962982221185, 4351.0, 4363.258246098171, 4399.736015838996, 4415.823367065345, 4446.9777651111535, 4510.526394728572, 4513.526079761577, 4554.88612784683, 4569.565891240327, 4587.724736515753, 4757.928631070467, 4785.9042819144115, 4807.879803004953, 4819.421669399694, 4824.0834241494, 5015.799368025384, 5056.519630635231, 5058.1148299048255, 5073.416557095981, 5075.3148324975655, 4632.3977882875015, 4780.0, 4833.782479788348, 4847.0, 4871.147549178809, 4944.678595891256, 4946.307516947558, 4964.230544265644, 4965.553100220997, 5023.196288593807, 5016.097102521581, 5026.396832380138, 5028.270900719448, 5031.22016087507, 5105.030044291572, 4674.345591617244, 4779.689320194177, 4905.8037678492465, 4959.0, 4994.600431965507, 4855.732934688626, 4899.461059283405, 4908.386451693538, 4915.11527924977, 4951.034548263054, 4680.4149481314835, 4681.485036646034, 4694.62443004552, 4700.858974230779, 4706.741129237925, 4804.807807687654, 4909.435414927186, 4943.184374578154, 4967.677100988424, 4993.975030124826, 4797.472278049481, 4830.661853670209, 4832.685875418087, 4854.466008739107, 4901.58336541398], "value": 4621.214709815359, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [512.0705918757455, 518.9532942035219, 530.0485628297208, 536.7209051293328, 564.0270533330004, 36855.81572092139, 37382.8130859346, 37674.811625941904, 37758.622413775855, 37818.05454863626, 38745.41881871774, 38756.0, 38994.80502597483, 39234.21531569367, 39415.21169576607, 7591.582462964535, 7804.570748608824, 7819.257170568815, 7835.255650713173, 7872.0, 7676.080979755061, 7751.18612545683, 7779.066512018538, 7793.298603125718, 7800.024996875391, 7789.221077892222, 7808.1801410851895, 7844.921550784505, 7897.644605992716, 7897.842043159133, 7803.960980195091, 7809.258120478574, 7844.882326765103, 7867.921320786776, 7869.881951770728, 7789.10425301092, 7845.686172553148, 7926.960365198137, 7940.166282540308, 7941.722039728582, 34584.0, 34903.1274218144, 34977.0, 34983.82508087469, 35032.824835875916, 2909.6072030275855, 3019.411214813112, 3122.609673790776, 3128.139761565588, 3286.342731453719, 28400.437975911318, 28938.0, 29062.41875162506, 29281.707182928112, 30043.098707038604, 3494.178867966026, 3500.3524347995703, 3514.3674138655033, 3546.8935931922083, 3577.94633080504, 244233.0, 244570.0, 244768.0, 245053.0, 245359.0, 42197.15605687869, 55200.0, 55213.0, 55514.72242638761, 55594.0, 41467.1706565867, 41544.37683434751, 41585.0, 41720.79139604283, 41729.374059389134, 13631.931840340734, 13723.1079979801, 13838.23889686077, 13922.607739225996, 13953.093048951989, 9795.06946840049, 9801.11789938909, 9806.558704858298, 9806.65676701312, 9812.264080194014, 14435.278236088154, 14553.199574023318, 14630.561083167522, 14660.266986650624, 14695.338709758087, 5683.460071293221, 5844.824655260349, 5929.4070592941225, 5956.910646340309, 5974.970125149346, 881.7971866470748, 916.3127654259306, 926.6849271247673, 980.4068538534227, 1012.9594816207269, 27007.98729969761, 27469.450610987667, 27640.170794876187, 27781.0, 28010.0, 872.5462759365095, 932.8087742012871, 963.1091240602415, 968.5496244246459, 996.8255555277798, 13365.866341336656, 13448.529301474597, 13478.19130852152, 13511.054226204267, 13698.178109313472, 158050.0, 161574.1921290386, 161638.19180904256, 161872.0, 162266.0, 47654.28518572224, 49210.99999999929, 49287.260691089665, 49511.50488495069, 49605.751971240636, 1210.0984766349127, 1211.2853416484318, 1211.715246916974, 1218.8537375514995, 1248.5442813373054, 25850.224493265232, 26255.73744262533, 26672.64797507788, 26873.059442919402, 26964.32589185286, 38291.23417531578, 38738.22523549457, 38906.6109338903, 38951.80524097361, 39105.41341879931, 231566.0, 232233.0, 233161.0, 233623.0, 234565.0, 29018.0, 29328.0, 29365.26586835346, 30309.848450757607, 32271.193220169684, 40883.18233635251, 40980.79509602433, 41263.1747365045, 43375.34936975885, 45417.0, 32320.676793231767, 33353.332933341684, 33711.32577348488, 35548.46677299791, 35575.46636800502, 33901.66098339084, 34909.65090349064, 34988.82505587456, 35384.82307588446, 35413.0, 33896.0, 36967.44548831823, 37286.813565931996, 37686.2462750749, 37785.24429511449, 28773.56839647449, 31481.21296967594, 31595.684043159275, 31970.36059278755, 32011.0, 24467.30674471034, 24483.755162448146, 24612.876935615208, 24691.0, 24708.382290442165], "value": 16382.523163696316, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [345.88239998400536, 351.257091252002, 354.9591796943352, 359.3621322153178, 361.5950135847851, 9902.35634683745, 13314.334283285845, 15261.923690381547, 15846.128462934534, 16175.35298588055, 16805.0, 16952.74570881438, 17164.22760975756, 17312.394066207686, 17552.473425797216, 5456.290682211317, 5619.4942455179025, 5627.380988091307, 5631.0, 5644.57665675074, 5288.92066619001, 5525.557955363562, 5548.55611551075, 5551.0, 5562.916556251659, 5533.170024496318, 5534.889302213954, 5538.584606154534, 5540.667559946396, 5551.528120109796, 5453.672779633215, 5467.782527064277, 5541.861453463655, 5558.583106267026, 5599.272094627713, 5381.78472861089, 5389.245505629215, 5400.297961265011, 5403.054465468527, 5413.512783849473, 21164.682529762067, 21860.781392186032, 22290.108395664152, 22524.549509009892, 22526.211582594693, 1946.9318573849848, 2022.3124137793075, 2035.4097311779567, 2101.317071951622, 2117.301290574122, 13331.40008699611, 13393.598192054254, 13849.723005539832, 14194.077384969944, 14448.927755361261, 1876.0807204469847, 1956.4348521182997, 2038.8368930485526, 2039.5003224210163, 2058.5779915117364, 61944.69027654833, 64792.0, 65145.348546514404, 66897.0, 66968.3303166967, 14692.163479565055, 15004.399824006918, 15326.463573775087, 15350.08123984502, 15367.538973830578, 11707.824382634268, 24758.009679612613, 24889.87555062249, 25026.249212523653, 25163.370915727253, 5236.607254455931, 5428.240046393508, 5707.800226992118, 7170.0, 7273.16358618755, 6855.451563874878, 6879.931200688029, 6953.82615434608, 7055.059858538841, 7060.7881763547175, 4143.212789569972, 4172.541020487804, 4250.596193361625, 4274.871753847389, 4285.657147428198, 1643.7370020796616, 1809.1044932758368, 1815.112283225457, 1847.2518629954889, 1869.8504119670395, 846.580942433487, 899.3120262998812, 927.6011315134422, 945.0596656326861, 957.2150836314156, 15043.323050462755, 15910.284037218353, 15968.920155399148, 16293.837061629469, 16342.75485867713, 841.9200175983271, 857.5412154497315, 864.0711235421821, 881.8148188880407, 888.5956889615339, 9107.772305692279, 9199.494027828534, 9252.583633736498, 9254.953725231331, 9466.90533094674, 147392.0, 147897.0, 147957.26021369823, 148407.2579637095, 252704.0, 68347.65826170838, 68589.65705171443, 68799.999999999, 69593.0, 72640.63679681568, 916.4867674102658, 924.2836801478908, 927.1470247372433, 966.468442356701, 967.5500892085214, 14942.925285373503, 15016.92491537579, 15112.848871511143, 15297.464588739786, 15521.301541430888, 27941.441171176055, 32483.512747309283, 33018.17454563655, 33106.6893310667, 35677.0, 40636.390454142624, 41064.1787164249, 41355.0, 41716.79141604394, 42450.150996980505, 9696.612135514782, 10278.074973252444, 10367.896321036693, 10592.629257975934, 10753.247272690836, 12201.20692155007, 12242.449089790802, 12321.07591930591, 12337.568185113478, 12504.812042855914, 5462.8907421850545, 9857.753556161153, 10560.894391055992, 10759.762627297961, 11073.667789966314, 10442.373457592568, 10801.0, 10831.133509319077, 11004.559817607205, 11020.44897755125, 10780.29928054674, 10809.837852432063, 10959.726006849574, 11133.220674553027, 11143.33140011602, 10632.362058276529, 10899.618513352312, 10964.28732132409, 10981.341119532854, 11034.448277585929, 10619.15046796239, 10648.84026739584, 10973.286736362112, 10999.890001099886, 11022.283551569122], "value": 8384.894424475659, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1418.6098822823724, 1437.209534755884, 1573.1347758732695, 1724.8447639712424, 1733.5926057376507, 6660.134182556261, 7273.963630181855, 7554.773356799298, 7706.229377062291, 7800.804979875499, 7443.627818609075, 7492.925070749291, 7599.658015389307, 7606.657700403482, 7610.0, 2238.362066810955, 2249.8312626552993, 2272.9544409571618, 2273.59075366434, 2276.567452184088, 2226.588081204974, 2226.6882636430914, 2262.0951619352227, 2275.351524815428, 2284.9657255141187, 2234.1510226114056, 2238.9440263993447, 2261.1294651559106, 2261.231181398324, 2276.1805749930095, 2251.797338239566, 2268.5009297954425, 2278.977210227893, 2280.1791355112146, 2287.59967005775, 2217.079911836586, 2225.2100504321056, 2228.3983324502456, 2228.643417053264, 2233.084435381486, 7630.046244219473, 7733.883991740128, 7740.303372696484, 7754.806129846743, 7772.3393511551585, 4518.3222516622445, 4564.6348292136545, 4620.561046700592, 4626.7223966562115, 4642.582167604898, 2830.8867645294163, 3017.306019615479, 3024.9243768905735, 3035.438443887888, 3045.3148041690442, 931.0735817861204, 935.864299676543, 944.1644144931785, 959.8704174936364, 976.85835553845, 10640.0, 10655.094316983066, 10698.51856666452, 10710.678679639544, 10758.300710453796, 4168.749875007509, 4284.742915425085, 4316.9639286571, 4318.460192475941, 4328.718633288826, 9056.230220431336, 9124.726258212264, 9147.405418647766, 9153.54232288383, 9155.038720934339, 4685.929711054337, 4693.366395536559, 4703.270992996091, 4741.122892264942, 4754.7147171169845, 3611.819409029538, 4062.51249850014, 4096.221717873595, 4200.7059505834295, 4271.124419493996, 3538.929221415557, 3581.6955558777795, 3622.1487950331652, 3622.9275414491563, 3633.4731463937583, 1185.3658292813304, 1205.8311836342918, 1217.0324591949422, 1219.5548624751902, 1222.608765195129, 1202.8195770634475, 1204.5422739359162, 1217.6407959651924, 1229.7417542316034, 1232.4392401457314, 7146.464015198881, 7155.570665760071, 7175.067241258603, 7190.173130090002, 7329.303716147064, 1012.7012531303283, 1047.6856942917095, 1062.2351906627216, 1066.0778426660881, 1086.0551320351187, 5578.9163162552595, 5617.634853734494, 5648.8870222595315, 5672.234248376499, 5678.858028549319, 9229.123233292827, 9431.575579098957, 9463.574139163755, 9521.143097121154, 9613.567389467491, 9247.676331328372, 9398.90601093994, 9425.952870235606, 9535.90464095364, 9553.570089345996, 7297.1608265049135, 7382.815429614303, 7420.109586849612, 7422.665980030912, 7424.703011879465, 6940.583564986117, 7066.505344626033, 7107.289271072851, 7125.5368401053765, 7143.0, 8287.751367458986, 8510.276626486819, 8533.530655813742, 8539.829203415773, 8625.8706119407, 8633.91366086331, 8749.91250087491, 8763.605637746445, 8763.693270735494, 8851.495245808099, 5694.572907031907, 6092.664903430176, 6299.6535190564955, 6505.447037001908, 6554.377334153248, 7178.24628414009, 7199.1001124859395, 7223.422126229784, 7234.385077268281, 7264.055672762718, 6293.0, 6368.16912644584, 6407.167068281094, 6418.807435776934, 6510.5117116217425, 6333.240011198685, 6341.778037768656, 6366.427021568081, 6478.870422591616, 6490.286068532363, 6610.603363798187, 6651.06885036105, 6671.966640166768, 6686.598804071771, 6686.966565167143, 6221.0, 6254.374562543891, 6258.374162583706, 6263.279722831932, 6316.905246421215, 6449.419552240321, 6461.19235095613, 6493.935060649522, 6505.73977040932, 6514.54398192122], "value": 4413.146292919648, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [318.17592435591814, 320.3688733195605, 326.53957919333743, 327.5299944579528, 330.632997372916, 5798.82603521894, 5854.268216472941, 5858.912116318259, 5871.295444546655, 5880.029795083811, 5688.488036076752, 5695.74369153388, 5696.914546281809, 5701.0878259478495, 5706.201131841535, 4147.440095587087, 4289.957100429003, 4403.427554417937, 4424.9557504424865, 4426.77866106695, 4387.276099443588, 4399.912001759963, 4406.0747243078995, 4417.315316126005, 4429.734215947037, 4356.215881141393, 4356.673249506284, 4371.73769573825, 4386.934195987047, 4389.934150987738, 4378.387025816388, 4383.539728328527, 4383.671224658164, 4395.7142785718825, 4402.0, 3850.5956874528333, 3856.7107466940092, 3857.7106716996336, 3862.3627101528214, 3875.2636998970106, 5394.244805727201, 5396.298481197458, 5413.702246376448, 5426.050441172779, 5429.1584804355, 4819.277108433763, 4972.105021096201, 4980.676256043345, 4998.90002199954, 5107.284980102751, 5940.584159108864, 5956.851078723023, 6012.669303188323, 6013.0, 6018.0, 4119.382092686091, 4131.400946862718, 4134.937975930364, 4137.648299894513, 4141.585841415865, 6305.558610897239, 6367.140436041168, 6382.297947225801, 6386.105945167634, 6396.808095757135, 4167.0, 4192.769397683157, 4194.182134483746, 4211.052513184509, 4214.515330737005, 4117.21772863155, 4258.935266183455, 4269.338252570857, 4278.44380230568, 4299.398084268205, 4882.536159064884, 4901.975490122598, 4928.8767780805765, 4938.38270216223, 4944.752762361867, 5937.2578427696535, 6022.337542870368, 6033.456988870935, 6052.515798736179, 6056.031035034462, 1500.6098414412113, 1506.1716056169282, 1515.1969456188237, 1518.9468368607045, 1520.0347779160313, 980.3627642032736, 991.2417000994245, 1010.5957616953277, 1014.523174108168, 1015.294370412571, 5210.53105220532, 5221.503957124067, 5241.9737901310245, 5248.422673505911, 5250.1337279349245, 6208.50331973441, 6247.875042499125, 6255.343188965184, 6257.561970662101, 6269.523538202476, 5049.545540901337, 5097.082525145435, 5209.140491818807, 5216.686998780086, 5237.135872581058, 3345.8996230113135, 3354.7316214702764, 3372.2412457196933, 3378.35811195872, 3390.69483746464, 5954.10688396744, 5977.551683623658, 5978.55160862937, 5983.461488465972, 5985.820425387245, 6447.709853056624, 6512.772052978123, 6519.934800652028, 6523.934760652332, 6528.183977002875, 5864.589478736533, 5915.112733090071, 5946.583739138218, 5955.28536575605, 5975.462208401264, 6070.7875224366935, 6244.188255526752, 6277.2781130170615, 6290.842728931813, 6300.716467759054, 6169.321374648695, 6172.753089876354, 6186.907196391968, 6189.226346706661, 6190.854691882017, 5944.078667806497, 5946.643201407929, 5965.28416590012, 5969.074793407029, 5990.820275391745, 4224.704270701021, 4246.4691913510815, 4247.341662042389, 4258.936115958325, 4265.338872474771, 6061.242344706911, 6235.438810506895, 6247.812565623039, 6279.686015699105, 6284.591501552567, 6031.215941927521, 6035.275766907999, 6043.486303664238, 6054.424829641177, 6073.331933487401, 5969.522438204846, 6039.245094363205, 6048.969755151196, 6071.150038994456, 6072.514198864169, 5915.645061296336, 5939.7624095037445, 5953.970230148821, 5956.612820166675, 5975.073863551156, 6061.605995610271, 6077.665728384981, 6080.391960803884, 6082.969585152223, 6094.695265236809, 5724.771009159587, 5872.148538461985, 5882.382349853375, 5882.705864706833, 5895.351511333664], "value": 4497.588411553855, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [697.9197392299885, 776.398291324224, 778.256764789626, 793.7460012795906, 796.9721059762909, 12411.131220814546, 12428.502859885617, 12598.496060157606, 12609.5586654467, 12622.810657840128, 11404.429778511061, 12235.571754988578, 12252.0, 12257.632271031862, 12311.507539698423, 646.0728854094366, 797.2744802229972, 800.2677550041705, 811.1847593168886, 815.8531464336417, 816.3265306122473, 816.5917041479261, 817.6933649881295, 819.2094628683319, 821.2690705272313, 843.8101427178897, 845.5138295480093, 848.5841937450635, 850.0352100366067, 850.1413572291999, 841.4278290762279, 845.3744229270358, 849.6134258912211, 850.0946491986015, 851.4720873058682, 618.5051958433236, 621.0652967284253, 621.2389822467486, 622.551762730833, 624.528480996849, 12807.551735689207, 12832.679183020406, 12881.871181288161, 12919.031072669588, 12930.870691293156, 12675.239485630891, 12779.594244633176, 12820.0, 12892.226466412045, 12915.418806153652, 10004.54979525923, 10208.979102089732, 10228.488575571191, 10351.637692680795, 10369.0, 3363.562736844219, 3368.729038742866, 3415.9316813663836, 3448.0862571418593, 3451.5340429042008, 42123.94690132741, 42602.36096458525, 42658.0, 42782.57217427817, 43035.78482107569, 9270.768230794149, 9296.628134874529, 9380.5309734513, 9400.200982916393, 9454.149126578503, 17633.7354939676, 17685.38101166453, 17718.0, 17798.0, 17840.107994600217, 6280.528960327993, 6366.172397588284, 6410.775622853178, 6516.380943810331, 6584.341565843377, 3580.1407662161414, 3583.7849729016343, 3597.6042635310096, 3598.4962105305276, 3617.5116359291687, 2760.144355249879, 2784.5823126530777, 2786.4566409549943, 2791.804573679823, 2796.6923638399758, 503.3154909323317, 508.6693649128022, 517.5342192027131, 521.8512723873678, 526.0951163997918, 507.3075252280684, 568.5565259097827, 642.9260635027032, 650.200253687957, 652.2401402366285, 7834.0, 8141.22658347456, 8250.793730156794, 8343.899952761043, 8345.082040975487, 498.98253561125915, 599.9950083609936, 620.1194304088206, 640.8173670503884, 669.7856685860478, 3627.093226693327, 3672.9147516086614, 3728.8694895678523, 3734.972882457346, 3862.1889403225637, 49665.751671241414, 51312.0, 51404.0, 51494.742526287126, 51601.2259816103, 43568.0, 43674.34488482675, 45104.3234351485, 45117.902104167464, 45129.32306015412, 41104.0, 41423.7928810354, 41424.58575414207, 41689.37465938013, 41709.58290417118, 7529.472936894584, 7546.849995263918, 7572.545647261182, 7658.73194438192, 7900.525968441912, 31610.209744756565, 31766.205844854063, 32168.0, 32498.675013249565, 32534.186645334055, 37525.0, 37616.0, 38580.42129368118, 40642.0, 40804.79597601993, 10113.59545618167, 10230.079292863678, 10245.385276883411, 10378.481075946323, 10420.0, 10216.948915255376, 10236.283460157718, 10397.792044158923, 10417.895821041995, 10545.789084218119, 8807.427517211361, 8824.691135810473, 9399.906000939904, 9498.85751713711, 9943.701688949342, 9783.36408133469, 9813.165880899918, 9827.31208815376, 9865.802683946138, 10215.846762298721, 9789.118979291898, 9827.4103553787, 9837.557309921214, 9863.309568330435, 10010.899891000996, 8485.533295668798, 8491.575421229038, 8647.481151130953, 8871.201591856763, 9212.769680758034, 8457.196566326189, 8514.616842242238, 8585.399022068395, 8659.913400865911, 8971.461712297283], "value": 5813.747583009024, "unit": "score"}], "name": "dromaeo_css", "value": 6468.59025276313, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [114.0, 107.0, 113.0, 113.0, 113.0, 126.0, 113.0, 113.0, 115.0, 113.0], "value": 114.0, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [167.0, 140.0, 155.0, 170.0, 134.0, 155.0, 159.0, 139.0, 185.0, 135.0], "value": 153.9, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [164.0, 163.0, 162.0, 160.0, 162.0, 166.0, 169.0, 162.0, 164.0, 162.0], "value": 163.4, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 74.0, 86.0, 79.0, 76.0, 74.0, 74.0, 150.0, 74.0, 74.0], "value": 83.7, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [93.0, 94.0, 144.0, 93.0, 95.0, 94.0, 147.0, 95.0, 95.0, 141.0], "value": 109.1, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 118.0, 118.0, 118.0, 118.0, 118.0, 118.0, 118.0, 119.0, 118.0], "value": 118.1, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 148.0, 148.0, 148.0, 147.0, 148.0, 149.0, 146.0, 147.0, 148.0], "value": 147.5, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 96.0, 96.0, 95.0, 96.0, 96.0, 96.0, 97.0, 95.0, 96.0], "value": 95.9, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [65.0, 65.0, 65.0, 69.0, 65.0, 65.0, 65.0, 65.0, 64.0, 62.0], "value": 65.0, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [62.0, 66.0, 65.0, 64.0, 64.0, 65.0, 65.0, 65.0, 64.0, 64.0], "value": 64.4, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [80.0, 82.0, 84.0, 87.0, 90.0, 83.0, 83.0, 83.0, 84.0, 83.0], "value": 83.9, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [126.0, 119.0, 128.0, 118.0, 117.0, 121.0, 120.0, 118.0, 126.0, 125.0], "value": 121.8, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [133.0, 144.0, 147.0, 147.0, 147.0, 139.0, 144.0, 143.0, 143.0, 131.0], "value": 141.8, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [67.0, 69.0, 69.0, 70.0, 70.0, 69.0, 67.0, 70.0, 66.0, 68.0], "value": 68.5, "unit": "score"}], "name": "kraken", "value": 1531.0, "alertThreshold": 2.0}]} 08:08:00 INFO - Return code: 0 08:08:00 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 08:08:00 ERROR - # TBPL SUCCESS # 08:08:00 INFO - Running post-action listener: _resource_record_post_action 08:08:00 INFO - Running post-run listener: _resource_record_post_run 08:08:01 INFO - Total resource usage - Wall time: 1194s; CPU: 13.0%; Read bytes: 0; Write bytes: 519462912; Read time: 0; Write time: 922316 08:08:01 INFO - install - Wall time: 16s; CPU: 15.0%; Read bytes: 0; Write bytes: 233185280; Read time: 0; Write time: 470972 08:08:01 INFO - run-tests - Wall time: 1178s; CPU: 13.0%; Read bytes: 0; Write bytes: 286277632; Read time: 0; Write time: 451344 08:08:01 INFO - Running post-run listener: _upload_blobber_files 08:08:01 INFO - Blob upload gear active. 08:08:01 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 08:08:01 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 08:08:01 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'] 08:08:01 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 08:08:01 INFO - (blobuploader) - INFO - Open directory for files ... 08:08:01 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 08:08:01 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:08:01 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:08:02 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 08:08:02 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:08:02 INFO - (blobuploader) - INFO - Done attempting. 08:08:02 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 08:08:02 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:08:02 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:08:03 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 08:08:03 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:08:03 INFO - (blobuploader) - INFO - Done attempting. 08:08:03 INFO - (blobuploader) - INFO - Iteration through files over. 08:08:03 INFO - Return code: 0 08:08:03 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 08:08:03 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 08:08:03 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/9409f6419299d47d90deee1108cbcb1a79cb9fe5fd0221201bba7232eec8a72d9cbd70ae531e0ac105691d52c3723035dbf022628af4ce4f57190a9b179bc26d", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/2b7fe96bb1d8a266cfa9bd36b28e373b8caaea3fda98236cc01b5e7a7597343d7d080d145f8d2cc6eeddd5853ad9d402aa068524a6df96aa928c791f865b7b97"} 08:08:03 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 08:08:03 INFO - Writing to file /builds/slave/test/properties/blobber_files 08:08:03 INFO - Contents: 08:08:03 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/9409f6419299d47d90deee1108cbcb1a79cb9fe5fd0221201bba7232eec8a72d9cbd70ae531e0ac105691d52c3723035dbf022628af4ce4f57190a9b179bc26d", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/2b7fe96bb1d8a266cfa9bd36b28e373b8caaea3fda98236cc01b5e7a7597343d7d080d145f8d2cc6eeddd5853ad9d402aa068524a6df96aa928c791f865b7b97"} 08:08:03 INFO - Running post-run listener: copy_logs_to_upload_dir 08:08:03 INFO - Copying logs to upload dir... 08:08:03 INFO - mkdir: /builds/slave/test/build/upload/logs 08:08:03 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1241.908457 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 41 secs) (at 2016-04-07 08:08:03.818388) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-07 08:08:03.822039) ========= 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=62c568580acbfdaac3eec7be000001dc-1460040312.400141-1754663434 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/9409f6419299d47d90deee1108cbcb1a79cb9fe5fd0221201bba7232eec8a72d9cbd70ae531e0ac105691d52c3723035dbf022628af4ce4f57190a9b179bc26d", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/2b7fe96bb1d8a266cfa9bd36b28e373b8caaea3fda98236cc01b5e7a7597343d7d080d145f8d2cc6eeddd5853ad9d402aa068524a6df96aa928c791f865b7b97"} build_url:https://queue.taskcluster.net/v1/task/e1sUNeYES-mHkyIxJuXkYw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011383 build_url: 'https://queue.taskcluster.net/v1/task/e1sUNeYES-mHkyIxJuXkYw/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/9409f6419299d47d90deee1108cbcb1a79cb9fe5fd0221201bba7232eec8a72d9cbd70ae531e0ac105691d52c3723035dbf022628af4ce4f57190a9b179bc26d", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/2b7fe96bb1d8a266cfa9bd36b28e373b8caaea3fda98236cc01b5e7a7597343d7d080d145f8d2cc6eeddd5853ad9d402aa068524a6df96aa928c791f865b7b97"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-07 08:08:03.846178) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-07 08:08:03.846489) ========= 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=62c568580acbfdaac3eec7be000001dc-1460040312.400141-1754663434 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004657 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-07 08:08:03.897917) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-07 08:08:03.898219) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-07 08:08:03.898493) ========= ========= Total master_lag: 0.34 =========