builder: mozilla-beta_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-020 starttime: 1467054799.02 results: success (0) buildid: 20160627094317 builduid: 59e32d1fac0b4cb482da14c713334a08 revision: 00a6e2ca6e9ab22fe9cbacf4cec52315a8b38b47 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-06-27 12:13:19.020787) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-06-27 12:13:19.021300) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-27 12:13:19.021615) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-27 12:13:19.036567) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-27 12:13:19.036934) ========= 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=af724c981e2a0f424dbabf99000001e7-1467054798.548444-1639179931 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-06-27 12:13:19-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 36.9M=0s 2016-06-27 12:13:19 (36.9 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.092287 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-27 12:13:19.143586) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-27 12:13:19.143957) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', '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=af724c981e2a0f424dbabf99000001e7-1467054798.548444-1639179931 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.015561 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-27 12:13:19.195551) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-27 12:13:19.195976) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-beta --rev 00a6e2ca6e9ab22fe9cbacf4cec52315a8b38b47 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo releases/mozilla-beta --rev 00a6e2ca6e9ab22fe9cbacf4cec52315a8b38b47 --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=af724c981e2a0f424dbabf99000001e7-1467054798.548444-1639179931 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-06-27 12:13:19,489 truncating revision to first 12 chars 2016-06-27 12:13:19,489 Setting DEBUG logging. 2016-06-27 12:13:19,489 attempt 1/10 2016-06-27 12:13:19,489 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-beta/00a6e2ca6e9a?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-06-27 12:13:19,794 unpacking tar archive at: mozilla-beta-00a6e2ca6e9a/testing/mozharness/ program finished with exit code 0 elapsedTime=0.644452 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-27 12:13:19.855258) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-27 12:13:19.855679) ========= script_repo_revision: 00a6e2ca6e9ab22fe9cbacf4cec52315a8b38b47 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-27 12:13:19.856207) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-27 12:13:19.856601) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-27 12:13:19.866668) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 27 secs) (at 2016-06-27 12:13:19.867051) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Beta --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Beta in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Beta', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Beta'] 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=af724c981e2a0f424dbabf99000001e7-1467054798.548444-1639179931 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 12:13:20 INFO - MultiFileLogger online at 20160627 12:13:20 in /builds/slave/test 12:13:20 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Beta --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Beta 12:13:20 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 12:13:20 INFO - {'append_to_log': False, 12:13:20 INFO - 'base_work_dir': '/builds/slave/test', 12:13:20 INFO - 'blob_upload_branch': 'Mozilla-Beta', 12:13:20 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 12:13:20 INFO - 'branch': 'Mozilla-Beta', 12:13:20 INFO - 'buildbot_json_path': 'buildprops.json', 12:13:20 INFO - 'config_files': ('talos/linux_config.py',), 12:13:20 INFO - 'default_actions': ('clobber', 12:13:20 INFO - 'read-buildbot-config', 12:13:20 INFO - 'download-and-extract', 12:13:20 INFO - 'populate-webroot', 12:13:20 INFO - 'create-virtualenv', 12:13:20 INFO - 'install', 12:13:20 INFO - 'run-tests'), 12:13:20 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 12:13:20 INFO - 'download_minidump_stackwalk': True, 12:13:20 INFO - 'download_symbols': 'ondemand', 12:13:20 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 12:13:20 INFO - 'tooltool.py': '/tools/tooltool.py', 12:13:20 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 12:13:20 INFO - '/tools/misc-python/virtualenv.py')}, 12:13:20 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 12:13:20 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 12:13:20 INFO - 'installer_path': 'installer.exe', 12:13:20 INFO - 'log_level': 'info', 12:13:20 INFO - 'log_name': 'talos', 12:13:20 INFO - 'log_to_console': True, 12:13:20 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 12:13:20 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 12:13:20 INFO - 'opt_config_files': (), 12:13:20 INFO - 'pip_index': False, 12:13:20 INFO - 'sps_profile': False, 12:13:20 INFO - 'sps_profile_interval': 0, 12:13:20 INFO - 'suite': 'dromaeojs', 12:13:20 INFO - 'system_bits': '32', 12:13:20 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 12:13:20 INFO - 'title': 'talos-linux64-ix-020', 12:13:20 INFO - 'tooltool_cache': '/builds/tooltool_cache', 12:13:20 INFO - 'use_talos_json': True, 12:13:20 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 12:13:20 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 12:13:20 INFO - 'work_dir': 'build'} 12:13:20 INFO - ##### 12:13:20 INFO - ##### Running clobber step. 12:13:20 INFO - ##### 12:13:20 INFO - Running pre-action listener: _resource_record_pre_action 12:13:20 INFO - Running main action method: clobber 12:13:20 INFO - rmtree: /builds/slave/test/build 12:13:20 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 12:13:20 INFO - Running post-action listener: _resource_record_post_action 12:13:20 INFO - ##### 12:13:20 INFO - ##### Running read-buildbot-config step. 12:13:20 INFO - ##### 12:13:20 INFO - Running pre-action listener: _resource_record_pre_action 12:13:20 INFO - Running main action method: read_buildbot_config 12:13:20 INFO - Using buildbot properties: 12:13:20 INFO - { 12:13:20 INFO - "project": "", 12:13:20 INFO - "product": "firefox", 12:13:20 INFO - "script_repo_revision": "production", 12:13:20 INFO - "builddir": "mozilla-beta_ubuntu64_hw_test-dromaeojs", 12:13:20 INFO - "repository": "", 12:13:20 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-beta pgo talos dromaeojs", 12:13:20 INFO - "buildid": "20160627094317", 12:13:20 INFO - "pgo_build": "True", 12:13:20 INFO - "basedir": "/builds/slave/test", 12:13:20 INFO - "buildnumber": 278, 12:13:20 INFO - "slavename": "talos-linux64-ix-020", 12:13:20 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 12:13:20 INFO - "platform": "ubuntu64_hw", 12:13:20 INFO - "scheduler": "tests-mozilla-beta-linux64-pgo-talos", 12:13:20 INFO - "branch": "mozilla-beta", 12:13:20 INFO - "repo_path": "releases/mozilla-beta", 12:13:20 INFO - "revision": "00a6e2ca6e9ab22fe9cbacf4cec52315a8b38b47", 12:13:20 INFO - "stage_platform": "linux64-pgo", 12:13:20 INFO - "builduid": "59e32d1fac0b4cb482da14c713334a08", 12:13:20 INFO - "slavebuilddir": "test" 12:13:20 INFO - } 12:13:20 INFO - Found installer url https://queue.taskcluster.net/v1/task/W4a73pTTQLqHwmdQHMlENw/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.tar.bz2. 12:13:20 INFO - Running post-action listener: _resource_record_post_action 12:13:20 INFO - ##### 12:13:20 INFO - ##### Running download-and-extract step. 12:13:20 INFO - ##### 12:13:20 INFO - Running pre-action listener: _resource_record_pre_action 12:13:20 INFO - Running main action method: download_and_extract 12:13:20 INFO - mkdir: /builds/slave/test/build/tests 12:13:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:13:20 INFO - https://queue.taskcluster.net/v1/task/W4a73pTTQLqHwmdQHMlENw/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 12:13:20 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/W4a73pTTQLqHwmdQHMlENw/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.test_packages.json 12:13:20 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/W4a73pTTQLqHwmdQHMlENw/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.test_packages.json 12:13:20 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/W4a73pTTQLqHwmdQHMlENw/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-48.0.en-US.linux-x86_64.test_packages.json 12:13:20 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/W4a73pTTQLqHwmdQHMlENw/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-48.0.en-US.linux-x86_64.test_packages.json'}, attempt #1 12:13:21 INFO - Downloaded 1327 bytes. 12:13:21 INFO - Reading from file /builds/slave/test/build/firefox-48.0.en-US.linux-x86_64.test_packages.json 12:13:21 INFO - Using the following test package requirements: 12:13:21 INFO - {u'common': [u'firefox-48.0.en-US.linux-x86_64.common.tests.zip'], 12:13:21 INFO - u'cppunittest': [u'firefox-48.0.en-US.linux-x86_64.common.tests.zip', 12:13:21 INFO - u'firefox-48.0.en-US.linux-x86_64.cppunittest.tests.zip'], 12:13:21 INFO - u'gtest': [u'firefox-48.0.en-US.linux-x86_64.common.tests.zip', 12:13:21 INFO - u'firefox-48.0.en-US.linux-x86_64.gtest.tests.zip'], 12:13:21 INFO - u'jittest': [u'firefox-48.0.en-US.linux-x86_64.common.tests.zip', 12:13:21 INFO - u'jsshell-linux-x86_64.zip'], 12:13:21 INFO - u'mochitest': [u'firefox-48.0.en-US.linux-x86_64.common.tests.zip', 12:13:21 INFO - u'firefox-48.0.en-US.linux-x86_64.mochitest.tests.zip'], 12:13:21 INFO - u'mozbase': [u'firefox-48.0.en-US.linux-x86_64.common.tests.zip'], 12:13:21 INFO - u'reftest': [u'firefox-48.0.en-US.linux-x86_64.common.tests.zip', 12:13:21 INFO - u'firefox-48.0.en-US.linux-x86_64.reftest.tests.zip'], 12:13:21 INFO - u'talos': [u'firefox-48.0.en-US.linux-x86_64.common.tests.zip', 12:13:21 INFO - u'firefox-48.0.en-US.linux-x86_64.talos.tests.zip'], 12:13:21 INFO - u'web-platform': [u'firefox-48.0.en-US.linux-x86_64.common.tests.zip', 12:13:21 INFO - u'firefox-48.0.en-US.linux-x86_64.web-platform.tests.zip'], 12:13:21 INFO - u'xpcshell': [u'firefox-48.0.en-US.linux-x86_64.common.tests.zip', 12:13:21 INFO - u'firefox-48.0.en-US.linux-x86_64.xpcshell.tests.zip']} 12:13:21 INFO - Downloading packages: [u'firefox-48.0.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 12:13: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')]} 12:13:21 INFO - https://queue.taskcluster.net/v1/task/W4a73pTTQLqHwmdQHMlENw/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 12:13:21 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/W4a73pTTQLqHwmdQHMlENw/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.common.tests.zip 12:13:21 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/W4a73pTTQLqHwmdQHMlENw/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.common.tests.zip 12:13:21 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/W4a73pTTQLqHwmdQHMlENw/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-48.0.en-US.linux-x86_64.common.tests.zip 12:13:21 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/W4a73pTTQLqHwmdQHMlENw/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0.en-US.linux-x86_64.common.tests.zip'}, attempt #1 12:13:23 INFO - Downloaded 24235710 bytes. 12:13:23 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 12:13:23 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 12:13:25 INFO - Return code: 0 12:13:25 INFO - Downloading packages: [u'firefox-48.0.en-US.linux-x86_64.common.tests.zip', u'firefox-48.0.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 12:13:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:13:25 INFO - https://queue.taskcluster.net/v1/task/W4a73pTTQLqHwmdQHMlENw/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 12:13:25 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/W4a73pTTQLqHwmdQHMlENw/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.common.tests.zip 12:13:25 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/W4a73pTTQLqHwmdQHMlENw/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.common.tests.zip 12:13:25 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/W4a73pTTQLqHwmdQHMlENw/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-48.0.en-US.linux-x86_64.common.tests.zip 12:13:25 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/W4a73pTTQLqHwmdQHMlENw/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0.en-US.linux-x86_64.common.tests.zip'}, attempt #1 12:13:26 INFO - Downloaded 24235710 bytes. 12:13:26 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 12:13:26 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 12:13:27 INFO - Return code: 0 12:13:27 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')]} 12:13:27 INFO - https://queue.taskcluster.net/v1/task/W4a73pTTQLqHwmdQHMlENw/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 12:13:27 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/W4a73pTTQLqHwmdQHMlENw/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.talos.tests.zip 12:13:27 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/W4a73pTTQLqHwmdQHMlENw/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.talos.tests.zip 12:13:27 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/W4a73pTTQLqHwmdQHMlENw/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-48.0.en-US.linux-x86_64.talos.tests.zip 12:13:27 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/W4a73pTTQLqHwmdQHMlENw/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 12:13:28 INFO - Downloaded 10840145 bytes. 12:13:28 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 12:13:28 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 12:13:28 INFO - Return code: 0 12:13:28 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')]} 12:13:28 INFO - https://queue.taskcluster.net/v1/task/W4a73pTTQLqHwmdQHMlENw/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 12:13:28 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/W4a73pTTQLqHwmdQHMlENw/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.tar.bz2 12:13:28 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/W4a73pTTQLqHwmdQHMlENw/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.tar.bz2 12:13:28 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/W4a73pTTQLqHwmdQHMlENw/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-48.0.en-US.linux-x86_64.tar.bz2 12:13:28 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/W4a73pTTQLqHwmdQHMlENw/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-48.0.en-US.linux-x86_64.tar.bz2'}, attempt #1 12:13:30 INFO - Downloaded 56020254 bytes. 12:13:30 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/W4a73pTTQLqHwmdQHMlENw/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.tar.bz2 12:13:30 INFO - mkdir: /builds/slave/test/properties 12:13:30 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 12:13:30 INFO - Writing to file /builds/slave/test/properties/build_url 12:13:30 INFO - Contents: 12:13:30 INFO - build_url:https://queue.taskcluster.net/v1/task/W4a73pTTQLqHwmdQHMlENw/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.tar.bz2 12:13:31 INFO - Running post-action listener: _resource_record_post_action 12:13:31 INFO - Running post-action listener: set_extra_try_arguments 12:13:31 INFO - ##### 12:13:31 INFO - ##### Running populate-webroot step. 12:13:31 INFO - ##### 12:13:31 INFO - Running pre-action listener: _resource_record_pre_action 12:13:31 INFO - Running main action method: populate_webroot 12:13:31 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 12:13:31 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 12:13:31 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 12:13:31 INFO - '--tppagecycles', 12:13:31 INFO - '7'], 12:13:31 INFO - 'tests': ['tsvgm']}}, 12:13:31 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 12:13:31 INFO - 'tests': ['tresize', 'tcanvasmark']}, 12:13:31 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 12:13:31 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 12:13:31 INFO - 'tests': ['dromaeo_css', 'kraken']}, 12:13:31 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 12:13:31 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:13:31 INFO - 'talos_options': ['--disable-e10s'], 12:13:31 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 12:13:31 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:13:31 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 12:13:31 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:13:31 INFO - 'talos_options': ['--disable-e10s'], 12:13:31 INFO - 'tests': ['damp', 'tps']}, 12:13:31 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:13:31 INFO - 'tests': ['damp', 'tps']}, 12:13:31 INFO - 'g3': {'talos_options': ['--disable-e10s'], 12:13:31 INFO - 'tests': ['dromaeo_dom']}, 12:13:31 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 12:13:31 INFO - 'other': {'talos_options': ['--disable-e10s'], 12:13:31 INFO - 'tests': ['a11yr', 12:13:31 INFO - 'ts_paint', 12:13:31 INFO - 'tpaint', 12:13:31 INFO - 'sessionrestore', 12:13:31 INFO - 'sessionrestore_no_auto_restore', 12:13:31 INFO - 'tabpaint']}, 12:13:31 INFO - 'other-e10s': {'tests': ['a11yr', 12:13:31 INFO - 'ts_paint', 12:13:31 INFO - 'tpaint', 12:13:31 INFO - 'sessionrestore', 12:13:31 INFO - 'sessionrestore_no_auto_restore', 12:13:31 INFO - 'tabpaint']}, 12:13:31 INFO - 'other-e10s_l64': {'tests': ['a11yr', 12:13:31 INFO - 'ts_paint', 12:13:31 INFO - 'tpaint', 12:13:31 INFO - 'sessionrestore', 12:13:31 INFO - 'sessionrestore_no_auto_restore', 12:13:31 INFO - 'tabpaint']}, 12:13:31 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 12:13:31 INFO - 'ts_paint', 12:13:31 INFO - 'tpaint', 12:13:31 INFO - 'sessionrestore', 12:13:31 INFO - 'sessionrestore_no_auto_restore', 12:13:31 INFO - 'tabpaint']}, 12:13:31 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 12:13:31 INFO - 'tests': ['a11yr', 12:13:31 INFO - 'ts_paint', 12:13:31 INFO - 'tpaint', 12:13:31 INFO - 'sessionrestore', 12:13:31 INFO - 'sessionrestore_no_auto_restore', 12:13:31 INFO - 'tabpaint']}, 12:13:31 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 12:13:31 INFO - 'tests': ['a11yr', 12:13:31 INFO - 'ts_paint', 12:13:31 INFO - 'tpaint', 12:13:31 INFO - 'sessionrestore', 12:13:31 INFO - 'sessionrestore_no_auto_restore', 12:13:31 INFO - 'tabpaint']}, 12:13:31 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 12:13:31 INFO - 'tests': ['tsvgx', 12:13:31 INFO - 'tsvgr_opacity', 12:13:31 INFO - 'tart', 12:13:31 INFO - 'tscrollx', 12:13:31 INFO - 'cart']}, 12:13:31 INFO - 'svgr-e10s': {'tests': ['tsvgx', 12:13:31 INFO - 'tsvgr_opacity', 12:13:31 INFO - 'tart', 12:13:31 INFO - 'tscrollx', 12:13:31 INFO - 'cart']}, 12:13:31 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:13:31 INFO - 'talos_options': ['--disable-e10s'], 12:13:31 INFO - 'tests': ['tp5o']}, 12:13:31 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:13:31 INFO - 'tests': ['tp5o']}, 12:13:31 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:13:31 INFO - 'talos_options': ['--disable-e10s', 12:13:31 INFO - '--xperf_path', 12:13:31 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 12:13:31 INFO - 'tests': ['tp5n']}, 12:13:31 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:13:31 INFO - 'talos_options': ['--xperf_path', 12:13:31 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 12:13:31 INFO - 'tests': ['tp5n']}}, 12:13:31 INFO - 'talos.zip': {'path': '', 12:13:31 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 12:13:31 INFO - Running post-action listener: _resource_record_post_action 12:13:31 INFO - ##### 12:13:31 INFO - ##### Running create-virtualenv step. 12:13:31 INFO - ##### 12:13:31 INFO - Running pre-action listener: _resource_record_pre_action 12:13:31 INFO - Running main action method: create_virtualenv 12:13:31 INFO - Creating virtualenv /builds/slave/test/build/venv 12:13:31 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 12:13:31 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 12:13:31 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 12:13:31 INFO - Using real prefix '/usr' 12:13:31 INFO - New python executable in /builds/slave/test/build/venv/bin/python 12:13:32 INFO - Installing distribute.............................................................................................................................................................................................done. 12:13:34 INFO - Installing pip.................done. 12:13:34 INFO - Return code: 0 12:13:34 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 12:13: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')]} 12:13:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:13:34 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:13: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')]} 12:13:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:13:34 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:13:34 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 0x7f8e3dc00f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22968a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23615a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23f0410>, '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 0x23f1310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x23f17a0>, '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': 'af724c981e2a0f424dbabf99000001e7-1467054798.548444-1639179931', '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 12:13:34 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 12:13:34 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 12:13:34 INFO - Using env: {'DISPLAY': ':0', 12:13:34 INFO - 'HOME': '/home/cltbld', 12:13:34 INFO - 'LANG': 'en_US.UTF-8', 12:13:34 INFO - 'LANGUAGE': 'en_US:en', 12:13:34 INFO - 'LOGNAME': 'cltbld', 12:13:34 INFO - 'MAIL': '/var/mail/cltbld', 12:13:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:13:34 INFO - 'MOZ_NO_REMOTE': '1', 12:13:34 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:13:34 INFO - 'NO_EM_RESTART': '1', 12:13:34 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:13:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:13:34 INFO - 'PWD': '/builds/slave/test', 12:13:34 INFO - 'SHELL': '/bin/bash', 12:13:34 INFO - 'SHLVL': '1', 12:13:34 INFO - 'TERM': 'linux', 12:13:34 INFO - 'TMOUT': '86400', 12:13:34 INFO - 'USER': 'cltbld', 12:13:34 INFO - 'XDG_SESSION_COOKIE': 'af724c981e2a0f424dbabf99000001e7-1467054798.548444-1639179931', 12:13:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:13:34 INFO - '_': '/tools/buildbot/bin/python'} 12:13:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:13:34 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 12:13:34 INFO - Cleaning up... 12:13:34 INFO - Return code: 0 12:13:34 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 12:13: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')]} 12:13:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:13:34 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:13: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')]} 12:13:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:13:34 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:13:34 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 0x7f8e3dc00f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22968a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23615a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23f0410>, '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 0x23f1310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x23f17a0>, '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': 'af724c981e2a0f424dbabf99000001e7-1467054798.548444-1639179931', '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 12:13:34 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 12:13:34 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 12:13:34 INFO - Using env: {'DISPLAY': ':0', 12:13:34 INFO - 'HOME': '/home/cltbld', 12:13:34 INFO - 'LANG': 'en_US.UTF-8', 12:13:34 INFO - 'LANGUAGE': 'en_US:en', 12:13:34 INFO - 'LOGNAME': 'cltbld', 12:13:34 INFO - 'MAIL': '/var/mail/cltbld', 12:13:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:13:34 INFO - 'MOZ_NO_REMOTE': '1', 12:13:34 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:13:34 INFO - 'NO_EM_RESTART': '1', 12:13:34 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:13:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:13:34 INFO - 'PWD': '/builds/slave/test', 12:13:34 INFO - 'SHELL': '/bin/bash', 12:13:34 INFO - 'SHLVL': '1', 12:13:34 INFO - 'TERM': 'linux', 12:13:34 INFO - 'TMOUT': '86400', 12:13:34 INFO - 'USER': 'cltbld', 12:13:34 INFO - 'XDG_SESSION_COOKIE': 'af724c981e2a0f424dbabf99000001e7-1467054798.548444-1639179931', 12:13:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:13:34 INFO - '_': '/tools/buildbot/bin/python'} 12:13:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:13:34 INFO - Downloading/unpacking psutil>=0.7.1 12:13:34 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 12:13:34 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 12:13:34 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 12:13:34 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 12:13:34 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 12:13:34 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 12:13:36 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 12:13:36 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 12:13:36 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 12:13:36 INFO - Installing collected packages: psutil 12:13:36 INFO - Running setup.py install for psutil 12:13:36 INFO - building 'psutil._psutil_linux' extension 12:13:36 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 12:13:36 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 12:13:36 INFO - building 'psutil._psutil_posix' extension 12:13:36 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 12:13:37 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 12:13:37 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 12:13:37 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 12:13:37 INFO - Successfully installed psutil 12:13:37 INFO - Cleaning up... 12:13:37 INFO - Return code: 0 12:13:37 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 12:13:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:13:37 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:13:37 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:13:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:13:37 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:13:37 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:13:37 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7f8e3dc00f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22968a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23615a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23f0410>, '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 0x23f1310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x23f17a0>, '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': 'af724c981e2a0f424dbabf99000001e7-1467054798.548444-1639179931', '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 12:13:37 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test/build 12:13:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 12:13:37 INFO - Using env: {'DISPLAY': ':0', 12:13:37 INFO - 'HOME': '/home/cltbld', 12:13:37 INFO - 'LANG': 'en_US.UTF-8', 12:13:37 INFO - 'LANGUAGE': 'en_US:en', 12:13:37 INFO - 'LOGNAME': 'cltbld', 12:13:37 INFO - 'MAIL': '/var/mail/cltbld', 12:13:37 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:13:37 INFO - 'MOZ_NO_REMOTE': '1', 12:13:37 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:13:37 INFO - 'NO_EM_RESTART': '1', 12:13:37 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:13:37 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:13:37 INFO - 'PWD': '/builds/slave/test', 12:13:37 INFO - 'SHELL': '/bin/bash', 12:13:37 INFO - 'SHLVL': '1', 12:13:37 INFO - 'TERM': 'linux', 12:13:37 INFO - 'TMOUT': '86400', 12:13:37 INFO - 'USER': 'cltbld', 12:13:37 INFO - 'XDG_SESSION_COOKIE': 'af724c981e2a0f424dbabf99000001e7-1467054798.548444-1639179931', 12:13:37 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:13:37 INFO - '_': '/tools/buildbot/bin/python'} 12:13:37 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:13:37 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 12:13:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:13:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:13:37 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:13:37 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:13:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:13:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:13:39 INFO - Downloading mozsystemmonitor-0.0.tar.gz 12:13:39 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 12:13:39 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 12:13:39 INFO - Installing collected packages: mozsystemmonitor 12:13:39 INFO - Running setup.py install for mozsystemmonitor 12:13:39 INFO - Successfully installed mozsystemmonitor 12:13:39 INFO - Cleaning up... 12:13:39 INFO - Return code: 0 12:13:39 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 12:13: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')]} 12:13:39 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:13:39 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:13: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')]} 12:13:39 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:13:39 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:13:39 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 0x7f8e3dc00f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22968a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23615a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23f0410>, '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 0x23f1310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x23f17a0>, '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': 'af724c981e2a0f424dbabf99000001e7-1467054798.548444-1639179931', '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 12:13:39 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 12:13:39 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 12:13:39 INFO - Using env: {'DISPLAY': ':0', 12:13:39 INFO - 'HOME': '/home/cltbld', 12:13:39 INFO - 'LANG': 'en_US.UTF-8', 12:13:39 INFO - 'LANGUAGE': 'en_US:en', 12:13:39 INFO - 'LOGNAME': 'cltbld', 12:13:39 INFO - 'MAIL': '/var/mail/cltbld', 12:13:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:13:39 INFO - 'MOZ_NO_REMOTE': '1', 12:13:39 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:13:39 INFO - 'NO_EM_RESTART': '1', 12:13:39 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:13:39 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:13:39 INFO - 'PWD': '/builds/slave/test', 12:13:39 INFO - 'SHELL': '/bin/bash', 12:13:39 INFO - 'SHLVL': '1', 12:13:39 INFO - 'TERM': 'linux', 12:13:39 INFO - 'TMOUT': '86400', 12:13:39 INFO - 'USER': 'cltbld', 12:13:39 INFO - 'XDG_SESSION_COOKIE': 'af724c981e2a0f424dbabf99000001e7-1467054798.548444-1639179931', 12:13:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:13:39 INFO - '_': '/tools/buildbot/bin/python'} 12:13:39 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:13:39 INFO - Downloading/unpacking blobuploader==1.2.4 12:13:39 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 12:13:39 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 12:13:39 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 12:13:39 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 12:13:39 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 12:13:39 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 12:13:41 INFO - Downloading blobuploader-1.2.4.tar.gz 12:13:41 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 12:13:41 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 12:13:41 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 12:13:41 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 12:13:41 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 12:13:41 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 12:13:41 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 12:13:41 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 12:13:41 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 12:13:42 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 12:13:42 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:13:42 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:13:42 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:13:42 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:13:42 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:13:42 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:13:42 INFO - Downloading docopt-0.6.1.tar.gz 12:13:42 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 12:13:42 INFO - Installing collected packages: blobuploader, requests, docopt 12:13:42 INFO - Running setup.py install for blobuploader 12:13:42 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 12:13:42 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 12:13:42 INFO - Running setup.py install for requests 12:13:42 INFO - Running setup.py install for docopt 12:13:42 INFO - Successfully installed blobuploader requests docopt 12:13:42 INFO - Cleaning up... 12:13:42 INFO - Return code: 0 12:13:42 INFO - Installing None into virtualenv /builds/slave/test/build/venv 12:13:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:13:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:13:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:13:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:13:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:13:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:13:42 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 0x7f8e3dc00f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22968a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23615a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23f0410>, '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 0x23f1310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x23f17a0>, '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': 'af724c981e2a0f424dbabf99000001e7-1467054798.548444-1639179931', '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 12:13:42 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 12:13:42 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 12:13:42 INFO - Using env: {'DISPLAY': ':0', 12:13:42 INFO - 'HOME': '/home/cltbld', 12:13:42 INFO - 'LANG': 'en_US.UTF-8', 12:13:42 INFO - 'LANGUAGE': 'en_US:en', 12:13:42 INFO - 'LOGNAME': 'cltbld', 12:13:42 INFO - 'MAIL': '/var/mail/cltbld', 12:13:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:13:42 INFO - 'MOZ_NO_REMOTE': '1', 12:13:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:13:42 INFO - 'NO_EM_RESTART': '1', 12:13:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:13:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:13:42 INFO - 'PWD': '/builds/slave/test', 12:13:42 INFO - 'SHELL': '/bin/bash', 12:13:42 INFO - 'SHLVL': '1', 12:13:42 INFO - 'TERM': 'linux', 12:13:42 INFO - 'TMOUT': '86400', 12:13:42 INFO - 'USER': 'cltbld', 12:13:42 INFO - 'XDG_SESSION_COOKIE': 'af724c981e2a0f424dbabf99000001e7-1467054798.548444-1639179931', 12:13:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:13:42 INFO - '_': '/tools/buildbot/bin/python'} 12:13:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:13:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 12:13:43 INFO - Running setup.py (path:/tmp/pip-niuwjG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 12:13:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 12:13:43 INFO - Running setup.py (path:/tmp/pip-Ci0Crz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 12:13:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 12:13:43 INFO - Running setup.py (path:/tmp/pip-4nA3mR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 12:13:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 12:13:43 INFO - Running setup.py (path:/tmp/pip-KdO08e-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 12:13:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 12:13:43 INFO - Running setup.py (path:/tmp/pip-7cmzay-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 12:13:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 12:13:43 INFO - Running setup.py (path:/tmp/pip-Zvpv8Z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 12:13:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 12:13:43 INFO - Running setup.py (path:/tmp/pip-dLNVHV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 12:13:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 12:13:43 INFO - Running setup.py (path:/tmp/pip-pmro8y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 12:13:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 12:13:43 INFO - Running setup.py (path:/tmp/pip-pFbxw0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 12:13:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 12:13:43 INFO - Running setup.py (path:/tmp/pip-R7o87W-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 12:13:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 12:13:43 INFO - Running setup.py (path:/tmp/pip-WGpAvX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 12:13:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 12:13:44 INFO - Running setup.py (path:/tmp/pip-nAKd78-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 12:13:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 12:13:44 INFO - Running setup.py (path:/tmp/pip-s7IW96-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 12:13:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 12:13:44 INFO - Running setup.py (path:/tmp/pip-544dC5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 12:13:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 12:13:44 INFO - Running setup.py (path:/tmp/pip-JlcwlA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 12:13:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 12:13:44 INFO - Running setup.py (path:/tmp/pip-E8n7fs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 12:13:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 12:13:44 INFO - Running setup.py (path:/tmp/pip-8IH0jD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 12:13:44 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 12:13:44 INFO - Running setup.py install for manifestparser 12:13:44 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 12:13:44 INFO - Running setup.py install for mozcrash 12:13:44 INFO - Running setup.py install for mozdebug 12:13:44 INFO - Running setup.py install for mozdevice 12:13:44 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 12:13:44 INFO - Installing dm script to /builds/slave/test/build/venv/bin 12:13:44 INFO - Running setup.py install for mozfile 12:13:44 INFO - Running setup.py install for mozhttpd 12:13:45 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 12:13:45 INFO - Running setup.py install for mozinfo 12:13:45 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 12:13:45 INFO - Running setup.py install for mozInstall 12:13:45 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 12:13:45 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 12:13:45 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 12:13:45 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 12:13:45 INFO - Running setup.py install for mozleak 12:13:45 INFO - Running setup.py install for mozlog 12:13:45 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 12:13:45 INFO - Running setup.py install for moznetwork 12:13:45 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 12:13:45 INFO - Running setup.py install for mozprocess 12:13:45 INFO - Running setup.py install for mozprofile 12:13:45 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 12:13:45 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 12:13:45 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 12:13:45 INFO - Running setup.py install for mozrunner 12:13:45 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 12:13:45 INFO - Running setup.py install for mozscreenshot 12:13:46 INFO - Running setup.py install for moztest 12:13:46 INFO - Running setup.py install for mozversion 12:13:46 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 12:13:46 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 12:13:46 INFO - Cleaning up... 12:13:46 INFO - Return code: 0 12:13:46 INFO - Installing None into virtualenv /builds/slave/test/build/venv 12:13:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:13:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:13:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:13:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:13:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:13:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:13:46 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 0x7f8e3dc00f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22968a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23615a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23f0410>, '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 0x23f1310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x23f17a0>, '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': 'af724c981e2a0f424dbabf99000001e7-1467054798.548444-1639179931', '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 12:13:46 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 12:13:46 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 12:13:46 INFO - Using env: {'DISPLAY': ':0', 12:13:46 INFO - 'HOME': '/home/cltbld', 12:13:46 INFO - 'LANG': 'en_US.UTF-8', 12:13:46 INFO - 'LANGUAGE': 'en_US:en', 12:13:46 INFO - 'LOGNAME': 'cltbld', 12:13:46 INFO - 'MAIL': '/var/mail/cltbld', 12:13:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:13:46 INFO - 'MOZ_NO_REMOTE': '1', 12:13:46 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:13:46 INFO - 'NO_EM_RESTART': '1', 12:13:46 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:13:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:13:46 INFO - 'PWD': '/builds/slave/test', 12:13:46 INFO - 'SHELL': '/bin/bash', 12:13:46 INFO - 'SHLVL': '1', 12:13:46 INFO - 'TERM': 'linux', 12:13:46 INFO - 'TMOUT': '86400', 12:13:46 INFO - 'USER': 'cltbld', 12:13:46 INFO - 'XDG_SESSION_COOKIE': 'af724c981e2a0f424dbabf99000001e7-1467054798.548444-1639179931', 12:13:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:13:46 INFO - '_': '/tools/buildbot/bin/python'} 12:13:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:13:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 12:13:46 INFO - Running setup.py (path:/tmp/pip-DDD34h-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 12:13:46 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)) 12:13:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 12:13:46 INFO - Running setup.py (path:/tmp/pip-7V05ud-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 12:13:46 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)) 12:13:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 12:13:46 INFO - Running setup.py (path:/tmp/pip-wcA2Eq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 12:13:46 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)) 12:13:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 12:13:46 INFO - Running setup.py (path:/tmp/pip-LPfL9z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 12:13:46 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)) 12:13:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 12:13:46 INFO - Running setup.py (path:/tmp/pip-jOZTm9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 12:13:46 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)) 12:13:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 12:13:46 INFO - Running setup.py (path:/tmp/pip-VmN2Nf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 12:13:46 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)) 12:13:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 12:13:46 INFO - Running setup.py (path:/tmp/pip-U2KSTj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 12:13:46 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)) 12:13:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 12:13:46 INFO - Running setup.py (path:/tmp/pip-BrBfE4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 12:13:47 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)) 12:13:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 12:13:47 INFO - Running setup.py (path:/tmp/pip-WFE8uj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 12:13:47 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)) 12:13:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 12:13:47 INFO - Running setup.py (path:/tmp/pip-M__gjp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 12:13:47 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)) 12:13:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 12:13:47 INFO - Running setup.py (path:/tmp/pip-XPHXEN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 12:13:47 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)) 12:13:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 12:13:47 INFO - Running setup.py (path:/tmp/pip-YzNCTz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 12:13:47 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)) 12:13:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 12:13:47 INFO - Running setup.py (path:/tmp/pip-4vS0au-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 12:13:47 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)) 12:13:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 12:13:47 INFO - Running setup.py (path:/tmp/pip-_Ap4Wm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 12:13:47 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)) 12:13:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 12:13:47 INFO - Running setup.py (path:/tmp/pip-GudIXm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 12:13:47 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)) 12:13:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 12:13:47 INFO - Running setup.py (path:/tmp/pip-xR7fwe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 12:13:47 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)) 12:13:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 12:13:47 INFO - Running setup.py (path:/tmp/pip-S9SRkk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 12:13:47 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)) 12:13:47 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)) 12:13:47 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)) 12:13:47 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)) 12:13:47 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)) 12:13:47 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)) 12:13:47 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 12:13: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 12:13: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 12:13: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 12:13: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 12:13: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 12:13: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 12:13:49 INFO - Downloading blessings-1.6.tar.gz 12:13:49 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 12:13:49 INFO - Installing collected packages: blessings 12:13:49 INFO - Running setup.py install for blessings 12:13:49 INFO - Successfully installed blessings 12:13:49 INFO - Cleaning up... 12:13:49 INFO - Return code: 0 12:13:49 INFO - Done creating virtualenv /builds/slave/test/build/venv. 12:13:49 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 12:13:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 12:13:50 INFO - Reading from file tmpfile_stdout 12:13:50 INFO - Current package versions: 12:13:50 INFO - argparse == 1.2.1 12:13:50 INFO - blessings == 1.6 12:13:50 INFO - blobuploader == 1.2.4 12:13:50 INFO - docopt == 0.6.1 12:13:50 INFO - manifestparser == 1.1 12:13:50 INFO - mozInstall == 1.12 12:13:50 INFO - mozcrash == 0.17 12:13:50 INFO - mozdebug == 0.1 12:13:50 INFO - mozdevice == 0.48 12:13:50 INFO - mozfile == 1.2 12:13:50 INFO - mozhttpd == 0.7 12:13:50 INFO - mozinfo == 0.9 12:13:50 INFO - mozleak == 0.1 12:13:50 INFO - mozlog == 3.1 12:13:50 INFO - moznetwork == 0.27 12:13:50 INFO - mozprocess == 0.22 12:13:50 INFO - mozprofile == 0.28 12:13:50 INFO - mozrunner == 6.11 12:13:50 INFO - mozscreenshot == 0.1 12:13:50 INFO - mozsystemmonitor == 0.0 12:13:50 INFO - moztest == 0.7 12:13:50 INFO - mozversion == 1.4 12:13:50 INFO - psutil == 3.1.1 12:13:50 INFO - requests == 1.2.3 12:13:50 INFO - wsgiref == 0.1.2 12:13:50 INFO - Installing None into virtualenv /builds/slave/test/build/venv 12:13:50 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')]} 12:13:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:13:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:13:50 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')]} 12:13:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:13:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:13:50 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 0x7f8e3dc00f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22968a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23615a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23f0410>, '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 0x23f1310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x23f17a0>, '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': 'af724c981e2a0f424dbabf99000001e7-1467054798.548444-1639179931', '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 12:13:50 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 12:13:50 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 12:13:50 INFO - Using env: {'DISPLAY': ':0', 12:13:50 INFO - 'HOME': '/home/cltbld', 12:13:50 INFO - 'LANG': 'en_US.UTF-8', 12:13:50 INFO - 'LANGUAGE': 'en_US:en', 12:13:50 INFO - 'LOGNAME': 'cltbld', 12:13:50 INFO - 'MAIL': '/var/mail/cltbld', 12:13:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:13:50 INFO - 'MOZ_NO_REMOTE': '1', 12:13:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:13:50 INFO - 'NO_EM_RESTART': '1', 12:13:50 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:13:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:13:50 INFO - 'PWD': '/builds/slave/test', 12:13:50 INFO - 'SHELL': '/bin/bash', 12:13:50 INFO - 'SHLVL': '1', 12:13:50 INFO - 'TERM': 'linux', 12:13:50 INFO - 'TMOUT': '86400', 12:13:50 INFO - 'USER': 'cltbld', 12:13:50 INFO - 'XDG_SESSION_COOKIE': 'af724c981e2a0f424dbabf99000001e7-1467054798.548444-1639179931', 12:13:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:13:50 INFO - '_': '/tools/buildbot/bin/python'} 12:13:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:13:50 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)) 12:13:50 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)) 12:13:50 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)) 12:13:50 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)) 12:13:50 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)) 12:13:50 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)) 12:13:50 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)) 12:13:50 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)) 12:13:50 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)) 12:13:50 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)) 12:13:50 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)) 12:13:50 INFO - Cleaning up... 12:13:50 INFO - Return code: 0 12:13:50 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 12:13:50 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')]} 12:13:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:13:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:13:50 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')]} 12:13:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:13:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:13:50 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 0x7f8e3dc00f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22968a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23615a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23f0410>, '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 0x23f1310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x23f17a0>, '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': 'af724c981e2a0f424dbabf99000001e7-1467054798.548444-1639179931', '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 12:13:50 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 12:13:50 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 12:13:50 INFO - Using env: {'DISPLAY': ':0', 12:13:50 INFO - 'HOME': '/home/cltbld', 12:13:50 INFO - 'LANG': 'en_US.UTF-8', 12:13:50 INFO - 'LANGUAGE': 'en_US:en', 12:13:50 INFO - 'LOGNAME': 'cltbld', 12:13:50 INFO - 'MAIL': '/var/mail/cltbld', 12:13:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:13:50 INFO - 'MOZ_NO_REMOTE': '1', 12:13:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:13:50 INFO - 'NO_EM_RESTART': '1', 12:13:50 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:13:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:13:50 INFO - 'PWD': '/builds/slave/test', 12:13:50 INFO - 'SHELL': '/bin/bash', 12:13:50 INFO - 'SHLVL': '1', 12:13:50 INFO - 'TERM': 'linux', 12:13:50 INFO - 'TMOUT': '86400', 12:13:50 INFO - 'USER': 'cltbld', 12:13:50 INFO - 'XDG_SESSION_COOKIE': 'af724c981e2a0f424dbabf99000001e7-1467054798.548444-1639179931', 12:13:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:13:50 INFO - '_': '/tools/buildbot/bin/python'} 12:13:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:13:50 INFO - Downloading/unpacking jsonschema 12:13:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:13:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:13:50 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:13:50 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:13:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:13:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:13:52 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 12:13:52 INFO - Downloading/unpacking functools32 (from jsonschema) 12:13: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 12:13: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 12:13: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 12:13: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 12:13: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 12:13: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 12:13:52 INFO - Downloading functools32-3.2.3-2.tar.gz 12:13:52 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 12:13:52 INFO - warning: no files found matching '*.txt' 12:13:52 INFO - no previously-included directories found matching 'build' 12:13:52 INFO - no previously-included directories found matching 'dist' 12:13:52 INFO - no previously-included directories found matching '.git*' 12:13:52 INFO - Installing collected packages: jsonschema, functools32 12:13:52 INFO - Running setup.py install for functools32 12:13:52 INFO - warning: no files found matching '*.txt' 12:13:52 INFO - no previously-included directories found matching 'build' 12:13:52 INFO - no previously-included directories found matching 'dist' 12:13:52 INFO - no previously-included directories found matching '.git*' 12:13:52 INFO - Successfully installed jsonschema functools32 12:13:52 INFO - Cleaning up... 12:13:52 INFO - Return code: 0 12:13:52 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 12:13:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:13:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:13:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:13:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:13:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:13:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:13:52 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f8e3dc00f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22968a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23615a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23f0410>, '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 0x23f1310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x23f17a0>, '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': 'af724c981e2a0f424dbabf99000001e7-1467054798.548444-1639179931', '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 12:13:52 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8'] in /builds/slave/test/build 12:13:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub flake8 12:13:52 INFO - Using env: {'DISPLAY': ':0', 12:13:52 INFO - 'HOME': '/home/cltbld', 12:13:52 INFO - 'LANG': 'en_US.UTF-8', 12:13:52 INFO - 'LANGUAGE': 'en_US:en', 12:13:52 INFO - 'LOGNAME': 'cltbld', 12:13:52 INFO - 'MAIL': '/var/mail/cltbld', 12:13:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:13:52 INFO - 'MOZ_NO_REMOTE': '1', 12:13:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:13:52 INFO - 'NO_EM_RESTART': '1', 12:13:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:13:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:13:52 INFO - 'PWD': '/builds/slave/test', 12:13:52 INFO - 'SHELL': '/bin/bash', 12:13:52 INFO - 'SHLVL': '1', 12:13:52 INFO - 'TERM': 'linux', 12:13:52 INFO - 'TMOUT': '86400', 12:13:52 INFO - 'USER': 'cltbld', 12:13:52 INFO - 'XDG_SESSION_COOKIE': 'af724c981e2a0f424dbabf99000001e7-1467054798.548444-1639179931', 12:13:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:13:52 INFO - '_': '/tools/buildbot/bin/python'} 12:13:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:13:53 INFO - Downloading/unpacking flake8 12:13:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:13:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:13:53 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:13:53 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:13:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:13:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:13:54 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 12:13:54 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 12:13:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:13:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:13:54 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:13:54 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:13:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:13:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:13:55 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 12:13:55 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 12:13:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:13:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:13:55 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:13:55 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:13:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:13:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:13:55 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 12:13:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:13:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:13:55 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:13:55 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:13:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:13:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:13:55 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 12:13:55 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 12:13:55 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 12:13:55 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 12:13:55 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 12:13:55 INFO - no previously-included directories found matching 'docs/_build' 12:13:55 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 12:13:55 INFO - Running setup.py install for pep8 12:13:55 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 12:13:55 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 12:13:55 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 12:13:55 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 12:13:55 INFO - no previously-included directories found matching 'docs/_build' 12:13:55 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 12:13:55 INFO - Successfully installed flake8 mccabe pyflakes pep8 12:13:55 INFO - Cleaning up... 12:13:55 INFO - Return code: 0 12:13:55 INFO - Running post-action listener: _resource_record_post_action 12:13:55 INFO - Running post-action listener: _start_resource_monitoring 12:13:55 INFO - Starting resource monitoring. 12:13:55 INFO - ##### 12:13:55 INFO - ##### Running install step. 12:13:55 INFO - ##### 12:13:55 INFO - Running pre-action listener: _resource_record_pre_action 12:13:55 INFO - Running main action method: install 12:13:55 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 12:13:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 12:13:56 INFO - Reading from file tmpfile_stdout 12:13:56 INFO - Detecting whether we're running mozinstall >=1.0... 12:13:56 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 12:13:56 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 12:13:56 INFO - Reading from file tmpfile_stdout 12:13:56 INFO - Output received: 12:13:56 INFO - Usage: mozinstall [options] installer 12:13:56 INFO - Options: 12:13:56 INFO - -h, --help show this help message and exit 12:13:56 INFO - -d DEST, --destination=DEST 12:13:56 INFO - Directory to install application into. [default: 12:13:56 INFO - "/builds/slave/test"] 12:13:56 INFO - --app=APP Application being installed. [default: firefox] 12:13:56 INFO - mkdir: /builds/slave/test/build/application 12:13:56 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-48.0.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 12:13:56 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-48.0.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 12:14:09 INFO - Reading from file tmpfile_stdout 12:14:09 INFO - Output received: 12:14:09 INFO - /builds/slave/test/build/application/firefox/firefox 12:14:09 INFO - Running post-action listener: _resource_record_post_action 12:14:09 INFO - ##### 12:14:09 INFO - ##### Running run-tests step. 12:14:09 INFO - ##### 12:14:09 INFO - Running pre-action listener: _resource_record_pre_action 12:14:09 INFO - Running main action method: run_tests 12:14:09 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 12:14:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 12:14:09 INFO - Python 2.7.3 12:14:09 INFO - Return code: 0 12:14:09 INFO - grabbing minidump binary from tooltool 12:14:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:14:09 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 0x23f0410>, '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 0x23f1310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x23f17a0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 12:14:09 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 12:14:09 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 12:14:09 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 12:14:09 INFO - Return code: 0 12:14:09 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 12:14:09 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 12:14:09 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 12:14:09 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 12:14:09 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 12:14:09 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 12:14:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 12:14:10 INFO - Return code: 0 12:14:10 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Beta', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/W4a73pTTQLqHwmdQHMlENw/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-020', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 12:14:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Beta --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/W4a73pTTQLqHwmdQHMlENw/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-020 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 12:14:10 INFO - Using env: {'DISPLAY': ':0', 12:14:10 INFO - 'HOME': '/home/cltbld', 12:14:10 INFO - 'LANG': 'en_US.UTF-8', 12:14:10 INFO - 'LANGUAGE': 'en_US:en', 12:14:10 INFO - 'LOGNAME': 'cltbld', 12:14:10 INFO - 'MAIL': '/var/mail/cltbld', 12:14:10 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 12:14:10 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 12:14:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:14:10 INFO - 'MOZ_NO_REMOTE': '1', 12:14:10 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 12:14:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:14:10 INFO - 'NO_EM_RESTART': '1', 12:14:10 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:14:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:14:10 INFO - 'PWD': '/builds/slave/test', 12:14:10 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 12:14:10 INFO - 'SHELL': '/bin/bash', 12:14:10 INFO - 'SHLVL': '1', 12:14:10 INFO - 'TERM': 'linux', 12:14:10 INFO - 'TMOUT': '86400', 12:14:10 INFO - 'USER': 'cltbld', 12:14:10 INFO - 'XDG_SESSION_COOKIE': 'af724c981e2a0f424dbabf99000001e7-1467054798.548444-1639179931', 12:14:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:14:10 INFO - '_': '/tools/buildbot/bin/python'} 12:14:10 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Beta', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/W4a73pTTQLqHwmdQHMlENw/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-020', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 12:14:11 INFO - mozversion application_buildid: 20160627094317 12:14:11 INFO - mozversion application_changeset: 00a6e2ca6e9ab22fe9cbacf4cec52315a8b38b47 12:14:11 INFO - mozversion application_display_name: Firefox 12:14:11 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 12:14:11 INFO - mozversion application_name: Firefox 12:14:11 INFO - mozversion application_remotingname: firefox 12:14:11 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-beta 12:14:11 INFO - mozversion application_vendor: Mozilla 12:14:11 INFO - mozversion application_version: 48.0 12:14:11 INFO - mozversion platform_buildid: 20160627094317 12:14:11 INFO - mozversion platform_changeset: 00a6e2ca6e9ab22fe9cbacf4cec52315a8b38b47 12:14:11 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-beta 12:14:11 INFO - mozversion platform_version: 48.0 12:14:11 INFO - using testdate: 1467054851 12:14:11 INFO - actual date: 1467054851 12:14:11 INFO - starting webserver on 'localhost:59834' 12:14:11 INFO - SUITE-START | Running 2 tests 12:14:11 INFO - TEST-START | dromaeo_css 12:14:11 INFO - operating with platform_type : linux_ 12:14:11 INFO - Initialising browser for dromaeo_css test... 12:14:11 INFO - TEST-INFO | started process 21694 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpX5mrfA/profile http://localhost:59834/getInfo.html) 12:14:15 INFO - PROCESS | 21694 | __metrics Screen width/height:1600/1200 12:14:15 INFO - PROCESS | 21694 | colorDepth:24 12:14:15 INFO - PROCESS | 21694 | Browser inner width/height: 1024/697 12:14:15 INFO - PROCESS | 21694 | __metrics 12:14:16 ERROR - PROCESS | 21694 | JavaScript error: resource://app/modules/AboutNewTab.jsm, line 36: TypeError: this.pageListener is null 12:14:17 INFO - TEST-INFO | 21694: exit 0 12:14:17 INFO - Browser initialized. 12:14:17 INFO - Running cycle 1/1 for dromaeo_css test... 12:14:17 INFO - TEST-INFO | started process 21788 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpX5mrfA/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 12:14:29 INFO - PROCESS | 21788 | RSS: Main: 139948032 12:14:29 INFO - PROCESS | 21788 | 12:15:21 INFO - PROCESS | 21788 | 1467054921054 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] 12:17:27 INFO - PROCESS | 21788 | Cycle 1(1): loaded http://localhost:59834/tests/dromaeo/cssquery-dojo.html (next: http://localhost:59834/tests/dromaeo/cssquery-ext.html) 12:17:29 INFO - PROCESS | 21788 | RSS: Main: 239296512 12:17:29 INFO - PROCESS | 21788 | 12:20:31 INFO - PROCESS | 21788 | Cycle 1(1): loaded http://localhost:59834/tests/dromaeo/cssquery-ext.html (next: http://localhost:59834/tests/dromaeo/cssquery-jquery.html) 12:20:31 INFO - PROCESS | 21788 | RSS: Main: 219250688 12:20:31 INFO - PROCESS | 21788 | 12:23:33 INFO - PROCESS | 21788 | Cycle 1(1): loaded http://localhost:59834/tests/dromaeo/cssquery-jquery.html (next: http://localhost:59834/tests/dromaeo/cssquery-mootools.html) 12:23:34 INFO - PROCESS | 21788 | RSS: Main: 217096192 12:23:34 INFO - PROCESS | 21788 | 12:26:36 INFO - PROCESS | 21788 | Cycle 1(1): loaded http://localhost:59834/tests/dromaeo/cssquery-mootools.html (next: http://localhost:59834/tests/dromaeo/cssquery-prototype.html) 12:26:36 INFO - PROCESS | 21788 | RSS: Main: 220139520 12:26:36 INFO - PROCESS | 21788 | 12:29:39 INFO - PROCESS | 21788 | Cycle 1(1): loaded http://localhost:59834/tests/dromaeo/cssquery-prototype.html (next: http://localhost:59834/tests/dromaeo/cssquery-yui.html) 12:29:39 INFO - PROCESS | 21788 | RSS: Main: 211238912 12:29:39 INFO - PROCESS | 21788 | 12:32:41 INFO - PROCESS | 21788 | Cycle 1(1): loaded http://localhost:59834/tests/dromaeo/cssquery-yui.html (next: http://localhost:59834/tests/dromaeo/cssquery-dojo.html) 12:32:42 INFO - PROCESS | 21788 | RSS: Main: 251494400 12:32:42 INFO - PROCESS | 21788 | 12:32:42 INFO - PROCESS | 21788 | __start_tp_report 12:32:42 INFO - PROCESS | 21788 | _x_x_mozilla_page_load 12:32:42 INFO - PROCESS | 21788 | _x_x_mozilla_page_load_details 12:32:42 INFO - PROCESS | 21788 | |i|pagename|runs| 12:32:42 INFO - PROCESS | 21788 | |0;dojo.html;3259.6251431085425;3311.3377324535086;3321.9335613287735;3354.916127096824;3376.0378292186733;5441.863953401162;5474.72626368682;5475.78096876125;5480.04099282626;5489.451054894508;5460.535854452366;5485.890282194354;5496.725163741817;5506.614536982403;5532.170174473831;4860.368152140217;4920.065187614351;5065.670731402447;5108.259302401149;5140.434552199255;4910;4946.0107978404285;4971.925421118686;5052.621053421009;5067.594592432615;4976.576990955755;5064.341635587387;5071.518205770446;5100.795968161269;5101.54086132248;5093.643444958854;5115.155999260118;5118.206677964921;5122.487751224848;5162.148245539482;4850.975745121287;4864.854054378375;4876.049170411771;5045.41977672565;5053.36832895888;5239.266502689627;5296;5308.097623404031;5331.866703332409;5354.973225133888;5664.830055098354;5711.600187986843;5716.256886604757;5723.71381430931;5729.140628905656;5572.7770889164385;5767.826965191051;5776.566757493205;5844.357120716718;5865.032269675498;5529.585281103933;5541.612087153901;5549.694766787825;5551.084071128259;5552.833414997597;6038;6038.607490513103;6045.818625441244;6064.969675151596;6073.331933487313;5610.102383618601;5781.797637082682;5841.678707671119;5881.32364778056;5886.529077673776;5813.5349172066135;5818.418158184232;5818.941810581925;5823.272090988627;5839.562032847553;5644;5815.505682017076;5817.7963771267805;5818.796342128006;5819.709014549256;5821.388754180834;5877.441643043904;5906.40935906406;5914.556408269311;5921.703914804242;4523.773811309487;4533.5013148553635;4535.841245556456;4546.454425468899;4547.909041819211;3931.331673615492;4058.6144316289906;4059.8579049733116;4066.8576599818866;4084.959150408458;5550.333959924835;5596.048671725816;5606.131049687305;5613.915791263134;5637.154426836008;5807.941920580824;5828.6211396259105;5853.180554722342;5861.413858614104;5872.031114865999;5408.0535906216255;5567.331920169525;5568.805091821848;5575.0243707351865;5590.357108932443;4973.32860063894;4978.477259887732;4983.127952608279;4999.800007999712;5008.348914641073;6093.847653808691;6094.207752992172;6096.72564734588;6097.237845269341;6099.481544068715;5696.316442026983;5830.53355731549;5842.707864606753;5845.1232315153065;5918.437748413894;6171.444569988723;6187.597806142587;6199.907001395073;6203.2245969253845;6210.5652604319075;5813.76744930198;5828.213191219301;5828.94171058284;5833.970830145822;5862.824115276549;5707.258056452801;5840.299164100165;5903.557233207613;5904.232449781501;5919.171316015847;5740.569457290637;5752.827415177551;5757.683327417032;5758.395368486249;5759.65442073477;5689.800856969986;5726.055200891807;5736.340320863154;5744.655320680772;5746.16680581305;5449.972750136224;5578.497935185853;5595.160725891149;5700.942990570207;5715.971420142872;5841.094630332305;5850.268716410449;5860.38465961068;5874.882502350015;5878.823635290948;5745.482906538432;5747.339056008445;5754.367019627922;5754.395788442153;5754.482096611325 12:32:42 INFO - PROCESS | 21788 | |1;ext.html;658.2101478226127;683.9247682754897;685.1162001018686;740.8333125046865;766.9271419215177;35352.2929541409;36044.45933310996;36068.2786344273;36100.819495902484;40517.79741101298;43077.56922430782;43525.564744352545;43627.56372436283;43661.56338436615;43732.3440148398;8761.737147885542;8898.510581917992;8923.286137109015;8939.776505587348;8946.507942063217;8044.115147333789;10658.20063495237;10919.617813376533;10921.672349829478;10922.781544369147;10631.78736425271;10715.464226788668;10716.249862509627;10718;10719;10575.576976920915;10605;10608.416537090457;10629;10638.521266543024;10356.067953884187;10476.842847357295;10486.632967846088;10489.108425783817;10513.421761803098;43779.78110109429;44387;44481.777591112164;44484.55515444869;44513.777431112634;3698.167912219756;3767.7296146730687;3834.5973672764517;3883.4757307763657;4515.367848501212;33475.83262083698;33590.66409335924;33843.830780845936;34032.6596734032;34230.14424639379;4567.794449249758;4600.240960241556;4626.144163329761;4635.420572428447;4656.115338085787;316557;317061.4146929274;317355;318835;319569;63314.366856330846;64269;64280;64301.35698643047;64438.355616444176;70722.29277707158;71976.64011680013;72553;72587.63706181436;72700.63649681718;19313.4205973821;19452.221911123397;19518.219271229274;19543.511412214808;19552.60894782125;14058.578242652737;14696.706065878623;14958.326875290639;14990.400383984519;15179.696406072038;20157.697634535492;20306.898465507576;20367.79632203659;20444.488887777923;20452.284170053976;7396.852062958711;7475.2905669429;7539.924600754032;7558.848823023509;7696.190890325103;1055.3773273768513;1059.369675043348;1126.5099681638515;1149.4594567813174;1199.5561642192445;30313.848430757706;30750.384992300027;30873.691263087083;31280.37439251202;31511.842440788107;1207.5713121841795;1211.2066596379386;1242.4036462498052;1245.3648639193896;1260.426505939795;16197.137329207291;16672.833271667372;16957.66084678324;17175.141242937803;17340.65318693619;517361;521982;525337;526962;528079;63099.6845015772;63781.68109159425;63887;63906.6804665983;63950.36049639537;1393.749125157461;1475.6310922269433;1526.4809964611864;1532.9080255184501;1592.633694250329;30711.2322191947;32507.187320316236;32756.603474260406;33079.83460082684;33123.50314745233;52774;53052.73473632761;53516.46483535115;53558.73220633872;53575.464245358606;366235;366907;366983;367085;368285;28026;31004.68995310018;31011.689883101782;31406.685933140376;31798.364032719677;45296.547034529234;45552.31671524996;45883.54116458793;46838.29742553796;46887.76556117334;38821.22357552889;40421.393679094246;41812.57053823753;42811.7859410701;42871.7856410716;40484.19031619292;40579.82541607814;40757;41475.58524414838;42201.15597687968;41654.58345416507;42297;42406.36390454207;42510;42681.57318426776;34906.825465872505;36393.272134557694;36791.26417471689;37275.62724372721;37615.6238437623;27647.58528622032;28627.85488580517;28701.28246793847;28708;28726.138215853556 12:32:42 INFO - PROCESS | 21788 | |2;jquery.html;445.35645991542225;445.7303331484452;448.51784331843277;449.7436461217106;451.10905960727587;18589.442316730485;18797;19293.614127717436;19299.421017369503;19422.805771942276;18197.63604727908;18803;18832.90583547084;18839.71740423895;18911.90544047278;5670.149477578355;5787.334456537489;5791.9284932287555;5796.971015144918;5889.64662120272;4221.472315960505;5699.03116470199;5702.800401985931;6052.092186172087;6325.841853953665;6260.405261500173;6316.684165791715;6325.778597749079;6326.620402775825;6340.461060809836;6282.842928926768;6349.174607301067;6385.584936979105;6478.255000674935;6535.673216339164;3989.40158976153;5595.916061259084;5788.768449262025;5809.331926828427;5868.061110222344;21984.780152198433;22164.335069947927;22232.444188895246;22285.888570557207;22365.552688946293;2436.561418944589;2460.225029115823;2488;2717.225590706639;2881;13951.651208719763;14162.71674566503;14205.502807401796;14230.146191228456;14590.124592524482;2078.646630072891;2089.696993935871;2091.0799248330686;2101.4116047506723;2138.2622995066677;76263.6186819068;77551.61224193899;77900.61049694772;78158.99999999943;79169.60415197887;10302.536385862653;10365.689029329133;10565.683029509128;10690.732731681615;10710.732231694114;14098.788518172236;14166.150030998173;14202.431902723776;14241.43034278638;14247.287635618177;8655.52394618302;8798.076201998825;8824.77938051541;8835.381523293308;8958.507282099417;8861.689840855539;9017.909820901707;9045.954770226239;9122.817543649222;9157.725268241964;6554.737810487527;6707.49693772969;6804.693788779517;6829.282925292872;6843.486738494633;1824.908754562293;1832.9442101961804;1860.5627677495777;1894.9147288372055;1897.3643829317334;473.1908436573429;1107.1751545098953;1113.4098927568402;1140.2474366917795;1175.3476820364779;11372.943135284271;11746.412679365998;11987.280763154064;12105;12192.75614487723;507.13533425509416;508.461031306816;511.2842021170391;521.8460554136539;529.6610169491529;6435.871282574322;6473.385028422293;6548.508861835381;6641.800745977628;6644.103046088813;509212;514431;521797;530748;531398;87055;90930;91158.54420727986;91826;91967;503.7355388421035;504.1303751029518;505.30520534265384;507.84256880367207;509.5261406891626;10668.573257069631;10684.519196636014;10752.301100428447;10945.45272736376;10995.505202266077;37761.2447751038;38313;38329;38500.614993850824;38840.028999275244;57294;57755;57866.7106664464;57973.71013145076;57980;8836.337274704552;8840.734777956672;8858.29133669292;8882.60028298741;9208.539573021457;9614.855777163208;13030.153040052746;13374.531891383755;13387.464501419834;13431.529896453578;9894.45580493051;10236.641717539851;11188.272762270426;11249.943750281196;11328.490217940047;11206.719832004264;11609.709757256136;11749.941250293694;11779.528818847493;11950.043996480086;11016.724581885517;11195;11206.719832004264;11479.196456247982;11688.824667630162;8509.531975741394;8663.393562450568;8785.912140878765;8810.647574096964;8852;9025.684101056431;10872.945635271773;11248.775024499628;11499.482523286304;11895.10786691019 12:32:42 INFO - PROCESS | 21788 | |3;mootools.html;1405.2762827144015;1573.8976966497178;1580.652256503569;1774.2636805725624;1898.1932678611586;8341.249287564118;8599.054104048557;8607.311415086793;8608.13918608138;8618.61216245269;8458.577071146434;8617.91382086179;8636.265917397013;8639.913600863989;8647.610857511412;2388.6417037444394;2403.086827005744;2408.51829634073;2412.1316326122583;2415.975840241593;2415.7946574541184;2455.8526488410753;2461.2739241923587;2461.9753802462014;2483.1805504183667;2373.371056669984;2410.18053861687;2412.6139817629182;2415.9637605435933;2417.9637305440433;2381.880905954695;2428.9149879754214;2430.1980346485616;2437.81716371272;2438.67077944477;2411.9397015074587;2449.8040156787415;2473.307473907309;2473.567125753004;2473.9010439582394;7098.503104782667;7844.097928738154;8829.823403531893;8866.512341821197;8874.86687699685;5393.2719082923695;5551;5552.750126244328;5556.444355564452;5560.833175004756;3515.54297941266;3546.3261980223674;3590.676839084495;3609.458581212813;3662.450632405134;1190.7023244188954;1195.8923696867237;1197.6407077876602;1223.3088305107585;1228.8648248692637;12157.635270941886;12615.810762838657;12630.115891887572;12673.873261267361;12695.04787140968;4777.1878780606685;4854.80580776765;4910.8772280693265;4922.163232250526;4924.064427758714;10787.406692631823;10811.567537298577;10816.78366432667;10837.891621083845;10838.241323107464;5536.861578460571;5586.385497595261;5594;5594.552435805126;5597.440255974451;4998.750062496861;5065.645404821701;5070.797168113234;5073.847784566469;5082.695038297714;4030.234255491447;4116.382542618571;4128.731632443882;4153.127843152972;4153.439285696452;1283.1787655900232;1288.606974872673;1294.4822071171607;1295.2746461981321;1328.9734205316033;1074.8602681651334;1077.7628921637227;1084.739662480999;1094.4035500652165;1120.3501968858043;6042.637441753509;6143.109249158847;6156.630602163885;6195.907061394083;6247.5939063960695;473.23572430524456;476.3830839063421;479.5061087080243;486.9196582563908;491.35632321658744;4270.871873843789;4334.523202447728;4400.603945644907;4444.066745983315;4448.199324121689;10657.094146997591;10985.176111791647;11076.778464430827;11175.329480231212;11187.32876027441;10943.83584246237;10969.067629251444;11031.22781405294;11035.613753518588;11038.503267352988;8086.353091752646;8174.468659537111;8199.262066413932;8284.99999999988;8385.245327920517;6145.938540614537;6337.082465940788;6401.743930242738;6402.839929001626;6518.608883467007;9802.215822734306;9877.357971731815;9938.155256803253;10105.39367637944;10140;9988.550515226978;10242.283040187116;10420.218483613911;10421.374717516974;10446.63436779709;7431.219721929336;7631.1605723371495;7669.501482403626;7676.117246516722;7676.577788221702;8321;8330.375221858263;8369.874451883104;8401.621927013177;8418.873716894374;7416.66625001887;7420.40636749048;7467.365273951775;7480.887786683095;7510.248975102446;7497.2877576630135;7542.321191092828;7646.350060244719;7664.885026724715;7783.066032076187;7136.215016348094;7164.820879477847;7189.820254493679;7194.928050719426;7196.460265480006;5389.568834493152;5492.780288788404;5493.038718224215;5562.16567514876;5602.243697101002;5575.4424557543925;5589.608727389043;5591.21722958778;5649.293838270216;5720.141978703228 12:32:42 INFO - PROCESS | 21788 | |4;prototype.html;347.44408945686894;347.9652034796521;352.4378616107308;371.5578461630661;373.23486851953487;6215.129881816543;6217.285012223596;6239.56323057385;6251;6256.311805701369;6218.284897236819;6227.782027629022;6240.56316057875;6248.531360147996;6298.842528936779;4470.150671372437;4633.9073218535605;4725.9054818903605;4738.384010078685;4791.041791641668;4751.619870410359;4766.404199475066;4790.401199850019;4791.9520804791855;4794.808207671689;4488.0799436115685;4763.095011947719;4783.952160478403;4789.257665061904;4789.712617242959;4588.1511920294515;4605.930911036337;4606.792694328747;4617.538246175389;4790.137775200463;4195.181939521794;4201.474815648044;4208.095259519218;4211.410402543646;4216.262154123016;5966.164736936832;5970;5990.430909063632;5991.161237426763;5999.940000599981;5552.86117847053;5554.0835762099205;5566.610337276392;5573.721313934287;5576.609637325389;6428.742850286029;6494.058361537551;6558.80323590293;6564.179477565304;6568.441682456997;4672.439307283148;4678.672492925462;4686.2267725825195;4686.789094490756;4690.812367505296;6809.795706128774;6810.693518791666;6857.931420685779;6872.381485666264;6876.346747059021;4783.091212669582;4787.952120478751;4794.856154315376;4795.95204047962;4800.159972004885;4851.708897466164;4853.708777473363;4856.150173719585;4858.271259311132;4858.514148585114;5533.253010843485;5547.334319881559;5548.056830338852;5554.389017208104;5561.332640083216;6429.54993150475;6592.901106483407;6594.802155935329;6607.041978913031;6608.933910660832;1663.3180396037567;1695.7202061659689;1707.1123016031595;1707.846293833561;1712.86297096232;1016.481594386868;1074.2641290715885;1106.9889301107046;1120.7758448310371;1141.1156353825852;6267.96866015667;6409.583377080475;6431.807045788541;6548.934510654833;6599.406053455116;6883.690233939485;6892.827679307957;6893.862122757517;6896.137982752156;6901.930980690229;6504.1869766279215;6513.544051916415;6519.087327774116;6524.314946930599;6524.478041756648;3666.5783434904793;3683.4474828775897;3706.8331925063435;3711.31340701971;3712.554493460802;7067;7122.501424900311;7194.424446044304;7219.422446204291;7226.891596626055;6963.547369420971;6972.1284839395075;6972.825679357955;6983.406410455066;6988.161420629557;7177.533460324958;7178.784636460915;7186.928130718626;7187.065681461377;7199.820004499825;6862.245153033063;6865.382115609619;6866.416354609914;6922.723091076301;6946.37482626566;6474.741010359533;6754.763583274562;6769.559978601375;6797.524173307821;6806.93193068063;7180.820479487846;7192.568445893263;7204.9279507204255;7211.567305961659;7219.014770938034;4565.954340456553;4569.337446070234;4574.085182963354;4585.72485650862;4604.309353596987;6826.8634627308165;6828.487863410165;6834.624095674786;6839.794806155824;6843.178818541807;6433.613983161025;6648.1025061616065;6652.567583107082;6653.434458071119;6656.667166641745;6588.308227636221;6639.568428052161;6640.701168447528;6647.867042659216;6648.534602577966;6489.772857949949;6524.347565243627;6525.3800888915475;6529.542931994714;6535.202819224751;6668.3331666834865;6671.733130674718;6675.7997260082275;6677.399034086956;6679.866402672016;6396.456301214449;6504.447121994494;6525.673716314261;6531;6534.803955881332 12:32:42 INFO - PROCESS | 21788 | |5;yui.html;820.2371794231366;875.7153924974381;923.5751554285029;928.7260258223824;940.2947789158131;13745;14655.926720366397;15516.689666206668;15563.066216027019;15590.376384944602;14248.928755356235;14469.92765036176;14520.782188267185;14523.854761452383;14555.781663275033;760.9695612175507;885.2917665867312;907.9636814527411;914.634146341462;922.423485321674;897.6544030548254;900.5407242306405;900.7072701372048;901.8782464367292;902.7833320003185;952.8237276103908;954.1555723184997;954.1889394015101;954.3271993244746;958.4345236310576;785.8624740670389;797.1669605262485;938.737153596994;953.0993211415215;955.6750704760415;704.7181127549021;704.8660754456688;705.0869124483805;705.400409651797;705.696550483292;14648;14696.044757090755;14767.26163691811;14770.556883293519;14771.778423323658;14204.147751134966;14679.339429725687;14703.117812931152;14759.70480590393;14805.407783688639;11618.709532261677;11771.823422648667;11849.17055806094;11927.224730392496;11931.94034029833;4051.9189616207805;4058.0666446717123;4069.6133867282856;4116.773577453238;4149.315362965107;53326.466735332535;53720;54851.72574137104;55220;56261.43738562603;11127.944360278147;11217.831732524019;11335.036521895567;11464.197506174654;11500.827487587692;19824.504387390432;19825.206991720457;19847.20611175566;19901.900490497454;20193.798062019487;8758.255548278341;8880.600372983232;8988.32587555936;9011.23404510624;9139.95430022859;4837.516248375135;4922.876928076755;4975.577075948512;4978;5009.5741861941415;3628.7097032237357;3675.22820207754;3676.3933950898336;3678.448232765053;3682.3187710273687;584.8888711144868;657.7500549791049;666.8466252761892;673.0577191931237;679.3715812873171;770.8256862531166;798.2057852436747;823.6499487717696;847.3983471735137;870.1429092344036;10271.281010329354;10283.640072597573;10388.740281493023;10432.113270371952;10456.581736730446;668.6055227415848;803.477739469338;812.3379445751693;836.6277006732067;851.1573542193184;4647.790849411717;4703.396346212056;4735.621150308036;4818.7108773473;4935.3090567320605;60132;60531.69734151301;61429.69285153546;61490;61663.38336616576;55224.72387638116;56043;56131;56146.43853561412;57335.426645733845;50469;50746;51524.742376287875;51576.48423515717;52390.738046309525;9507.66723164686;9546.856797148188;9776.462294573583;9797.755949529022;9917.65288214909;37965;38450.807745961094;39063.60936390713;39537.60462395339;39787;45893.77053114713;48179.27731084107;50558.74720626373;51219.48780512296;51421.74289128531;11195.2723073;11420.428978551205;11467.827982580102;11519.88480115188;11804.82292765592;12570.811437828623;12839.486420543448;12960.935195323964;13081.542146024844;13326;10200.642977495752;12074.879251207376;12509.812352814897;13107.475700971854;13300.800487992494;12450.25298482094;12707.569736966318;12913.870861291267;13007.674808129872;13152.934235328763;13105.2136871788;13475.797863032258;13506.527271545448;13517;13591.592252232449;11142.498587563741;11255.155863310121;11471.139664525028;11561.364124972872;11619.012383947122;11186.32882027081;11538.48076836561;11610.76778464443;11798.705032373917;11807.527698892292 12:32:42 INFO - PROCESS | 21788 | __end_tp_report 12:32:42 INFO - PROCESS | 21788 | __start_cc_report 12:32:42 INFO - PROCESS | 21788 | _x_x_mozilla_cycle_collect,822 12:32:42 INFO - PROCESS | 21788 | __end_cc_report 12:32:42 INFO - PROCESS | 21788 | __startTimestamp1467055962118__endTimestamp 12:32:42 INFO - PROCESS | 21788 | 12:32:42 INFO - PROCESS | 21788 | ------- Summary: start ------- 12:32:42 INFO - PROCESS | 21788 | Number of tests: 6 12:32:42 INFO - PROCESS | 21788 | 12:32:42 INFO - PROCESS | 21788 | [#0] dojo.html Cycles:165 Average:5459.40 Median:5689.80 stddev:598.42 (10.5%) stddev-sans-first:574.83 12:32:42 INFO - PROCESS | 21788 | Values: 3259.6 3311.3 3321.9 3354.9 3376.0 5441.9 5474.7 5475.8 5480.0 5489.5 5460.5 5485.9 5496.7 5506.6 5532.2 4860.4 4920.1 5065.7 5108.3 5140.4 4910.0 4946.0 4971.9 5052.6 5067.6 4976.6 5064.3 5071.5 5100.8 5101.5 5093.6 5115.2 5118.2 5122.5 5162.1 4851.0 4864.9 4876.0 5045.4 5053.4 5239.3 5296.0 5308.1 5331.9 5355.0 5664.8 5711.6 5716.3 5723.7 5729.1 5572.8 5767.8 5776.6 5844.4 5865.0 5529.6 5541.6 5549.7 5551.1 5552.8 6038.0 6038.6 6045.8 6065.0 6073.3 5610.1 5781.8 5841.7 5881.3 5886.5 5813.5 5818.4 5818.9 5823.3 5839.6 5644.0 5815.5 5817.8 5818.8 5819.7 5821.4 5877.4 5906.4 5914.6 5921.7 4523.8 4533.5 4535.8 4546.5 4547.9 3931.3 4058.6 4059.9 4066.9 4085.0 5550.3 5596.0 5606.1 5613.9 5637.2 5807.9 5828.6 5853.2 5861.4 5872.0 5408.1 5567.3 5568.8 5575.0 5590.4 4973.3 4978.5 4983.1 4999.8 5008.3 6093.8 6094.2 6096.7 6097.2 6099.5 5696.3 5830.5 5842.7 5845.1 5918.4 6171.4 6187.6 6199.9 6203.2 6210.6 5813.8 5828.2 5828.9 5834.0 5862.8 5707.3 5840.3 5903.6 5904.2 5919.2 5740.6 5752.8 5757.7 5758.4 5759.7 5689.8 5726.1 5736.3 5744.7 5746.2 5450.0 5578.5 5595.2 5700.9 5716.0 5841.1 5850.3 5860.4 5874.9 5878.8 5745.5 5747.3 5754.4 5754.4 5754.5 12:32:42 INFO - PROCESS | 21788 | 12:32:42 INFO - PROCESS | 21788 | [#1] ext.html Cycles:180 Average:58158.77 Median:366571.00 stddev:109019.05 (29.7%) stddev-sans-first:109239.40 12:32:42 INFO - PROCESS | 21788 | Values: 658.2 683.9 685.1 740.8 766.9 35352.3 36044.5 36068.3 36100.8 40517.8 43077.6 43525.6 43627.6 43661.6 43732.3 8761.7 8898.5 8923.3 8939.8 8946.5 8044.1 10658.2 10919.6 10921.7 10922.8 10631.8 10715.5 10716.2 10718.0 10719.0 10575.6 10605.0 10608.4 10629.0 10638.5 10356.1 10476.8 10486.6 10489.1 10513.4 43779.8 44387.0 44481.8 44484.6 44513.8 3698.2 3767.7 3834.6 3883.5 4515.4 33475.8 33590.7 33843.8 34032.7 34230.1 4567.8 4600.2 4626.1 4635.4 4656.1 316557.0 317061.4 317355.0 318835.0 319569.0 63314.4 64269.0 64280.0 64301.4 64438.4 70722.3 71976.6 72553.0 72587.6 72700.6 19313.4 19452.2 19518.2 19543.5 19552.6 14058.6 14696.7 14958.3 14990.4 15179.7 20157.7 20306.9 20367.8 20444.5 20452.3 7396.9 7475.3 7539.9 7558.8 7696.2 1055.4 1059.4 1126.5 1149.5 1199.6 30313.8 30750.4 30873.7 31280.4 31511.8 1207.6 1211.2 1242.4 1245.4 1260.4 16197.1 16672.8 16957.7 17175.1 17340.7 517361.0 521982.0 525337.0 526962.0 528079.0 63099.7 63781.7 63887.0 63906.7 63950.4 1393.7 1475.6 1526.5 1532.9 1592.6 30711.2 32507.2 32756.6 33079.8 33123.5 52774.0 53052.7 53516.5 53558.7 53575.5 366235.0 366907.0 366983.0 367085.0 368285.0 28026.0 31004.7 31011.7 31406.7 31798.4 45296.5 45552.3 45883.5 46838.3 46887.8 38821.2 40421.4 41812.6 42811.8 42871.8 40484.2 40579.8 40757.0 41475.6 42201.2 41654.6 42297.0 42406.4 42510.0 42681.6 34906.8 36393.3 36791.3 37275.6 37615.6 27647.6 28627.9 28701.3 28708.0 28726.1 12:32:42 INFO - PROCESS | 21788 | 12:32:42 INFO - PROCESS | 21788 | [#2] jquery.html Cycles:180 Average:29229.42 Median:449.13 stddev:85810.44 (19105.9%) stddev-sans-first:86023.94 12:32:42 INFO - PROCESS | 21788 | Values: 445.4 445.7 448.5 449.7 451.1 18589.4 18797.0 19293.6 19299.4 19422.8 18197.6 18803.0 18832.9 18839.7 18911.9 5670.1 5787.3 5791.9 5797.0 5889.6 4221.5 5699.0 5702.8 6052.1 6325.8 6260.4 6316.7 6325.8 6326.6 6340.5 6282.8 6349.2 6385.6 6478.3 6535.7 3989.4 5595.9 5788.8 5809.3 5868.1 21984.8 22164.3 22232.4 22285.9 22365.6 2436.6 2460.2 2488.0 2717.2 2881.0 13951.7 14162.7 14205.5 14230.1 14590.1 2078.6 2089.7 2091.1 2101.4 2138.3 76263.6 77551.6 77900.6 78159.0 79169.6 10302.5 10365.7 10565.7 10690.7 10710.7 14098.8 14166.2 14202.4 14241.4 14247.3 8655.5 8798.1 8824.8 8835.4 8958.5 8861.7 9017.9 9046.0 9122.8 9157.7 6554.7 6707.5 6804.7 6829.3 6843.5 1824.9 1832.9 1860.6 1894.9 1897.4 473.2 1107.2 1113.4 1140.2 1175.3 11372.9 11746.4 11987.3 12105.0 12192.8 507.1 508.5 511.3 521.8 529.7 6435.9 6473.4 6548.5 6641.8 6644.1 509212.0 514431.0 521797.0 530748.0 531398.0 87055.0 90930.0 91158.5 91826.0 91967.0 503.7 504.1 505.3 507.8 509.5 10668.6 10684.5 10752.3 10945.5 10995.5 37761.2 38313.0 38329.0 38500.6 38840.0 57294.0 57755.0 57866.7 57973.7 57980.0 8836.3 8840.7 8858.3 8882.6 9208.5 9614.9 13030.2 13374.5 13387.5 13431.5 9894.5 10236.6 11188.3 11249.9 11328.5 11206.7 11609.7 11749.9 11779.5 11950.0 11016.7 11195.0 11206.7 11479.2 11688.8 8509.5 8663.4 8785.9 8810.6 8852.0 9025.7 10872.9 11248.8 11499.5 11895.1 12:32:42 INFO - PROCESS | 21788 | 12:32:42 INFO - PROCESS | 21788 | [#3] mootools.html Cycles:180 Average:5895.70 Median:2670.86 stddev:3285.40 (123.0%) stddev-sans-first:3277.28 12:32:42 INFO - PROCESS | 21788 | Values: 1405.3 1573.9 1580.7 1774.3 1898.2 8341.2 8599.1 8607.3 8608.1 8618.6 8458.6 8617.9 8636.3 8639.9 8647.6 2388.6 2403.1 2408.5 2412.1 2416.0 2415.8 2455.9 2461.3 2462.0 2483.2 2373.4 2410.2 2412.6 2416.0 2418.0 2381.9 2428.9 2430.2 2437.8 2438.7 2411.9 2449.8 2473.3 2473.6 2473.9 7098.5 7844.1 8829.8 8866.5 8874.9 5393.3 5551.0 5552.8 5556.4 5560.8 3515.5 3546.3 3590.7 3609.5 3662.5 1190.7 1195.9 1197.6 1223.3 1228.9 12157.6 12615.8 12630.1 12673.9 12695.0 4777.2 4854.8 4910.9 4922.2 4924.1 10787.4 10811.6 10816.8 10837.9 10838.2 5536.9 5586.4 5594.0 5594.6 5597.4 4998.8 5065.6 5070.8 5073.8 5082.7 4030.2 4116.4 4128.7 4153.1 4153.4 1283.2 1288.6 1294.5 1295.3 1329.0 1074.9 1077.8 1084.7 1094.4 1120.4 6042.6 6143.1 6156.6 6195.9 6247.6 473.2 476.4 479.5 486.9 491.4 4270.9 4334.5 4400.6 4444.1 4448.2 10657.1 10985.2 11076.8 11175.3 11187.3 10943.8 10969.1 11031.2 11035.6 11038.5 8086.4 8174.5 8199.3 8285.0 8385.2 6145.9 6337.1 6401.7 6402.8 6518.6 9802.2 9877.4 9938.2 10105.4 10140.0 9988.6 10242.3 10420.2 10421.4 10446.6 7431.2 7631.2 7669.5 7676.1 7676.6 8321.0 8330.4 8369.9 8401.6 8418.9 7416.7 7420.4 7467.4 7480.9 7510.2 7497.3 7542.3 7646.4 7664.9 7783.1 7136.2 7164.8 7189.8 7194.9 7196.5 5389.6 5492.8 5493.0 5562.2 5602.2 5575.4 5589.6 5591.2 5649.3 5720.1 12:32:42 INFO - PROCESS | 21788 | 12:32:42 INFO - PROCESS | 21788 | [#4] prototype.html Cycles:180 Average:5557.43 Median:6347.65 stddev:1681.76 (26.5%) stddev-sans-first:1640.38 12:32:42 INFO - PROCESS | 21788 | Values: 347.4 348.0 352.4 371.6 373.2 6215.1 6217.3 6239.6 6251.0 6256.3 6218.3 6227.8 6240.6 6248.5 6298.8 4470.2 4633.9 4725.9 4738.4 4791.0 4751.6 4766.4 4790.4 4792.0 4794.8 4488.1 4763.1 4784.0 4789.3 4789.7 4588.2 4605.9 4606.8 4617.5 4790.1 4195.2 4201.5 4208.1 4211.4 4216.3 5966.2 5970.0 5990.4 5991.2 5999.9 5552.9 5554.1 5566.6 5573.7 5576.6 6428.7 6494.1 6558.8 6564.2 6568.4 4672.4 4678.7 4686.2 4686.8 4690.8 6809.8 6810.7 6857.9 6872.4 6876.3 4783.1 4788.0 4794.9 4796.0 4800.2 4851.7 4853.7 4856.2 4858.3 4858.5 5533.3 5547.3 5548.1 5554.4 5561.3 6429.5 6592.9 6594.8 6607.0 6608.9 1663.3 1695.7 1707.1 1707.8 1712.9 1016.5 1074.3 1107.0 1120.8 1141.1 6268.0 6409.6 6431.8 6548.9 6599.4 6883.7 6892.8 6893.9 6896.1 6901.9 6504.2 6513.5 6519.1 6524.3 6524.5 3666.6 3683.4 3706.8 3711.3 3712.6 7067.0 7122.5 7194.4 7219.4 7226.9 6963.5 6972.1 6972.8 6983.4 6988.2 7177.5 7178.8 7186.9 7187.1 7199.8 6862.2 6865.4 6866.4 6922.7 6946.4 6474.7 6754.8 6769.6 6797.5 6806.9 7180.8 7192.6 7204.9 7211.6 7219.0 4566.0 4569.3 4574.1 4585.7 4604.3 6826.9 6828.5 6834.6 6839.8 6843.2 6433.6 6648.1 6652.6 6653.4 6656.7 6588.3 6639.6 6640.7 6647.9 6648.5 6489.8 6524.3 6525.4 6529.5 6535.2 6668.3 6671.7 6675.8 6677.4 6679.9 6396.5 6504.4 6525.7 6531.0 6534.8 12:32:42 INFO - PROCESS | 21788 | 12:32:42 INFO - PROCESS | 21788 | [#5] yui.html Cycles:180 Average:15375.50 Median:25270.78 stddev:17470.26 (69.1%) stddev-sans-first:17485.07 12:32:42 INFO - PROCESS | 21788 | Values: 820.2 875.7 923.6 928.7 940.3 13745.0 14655.9 15516.7 15563.1 15590.4 14248.9 14469.9 14520.8 14523.9 14555.8 761.0 885.3 908.0 914.6 922.4 897.7 900.5 900.7 901.9 902.8 952.8 954.2 954.2 954.3 958.4 785.9 797.2 938.7 953.1 955.7 704.7 704.9 705.1 705.4 705.7 14648.0 14696.0 14767.3 14770.6 14771.8 14204.1 14679.3 14703.1 14759.7 14805.4 11618.7 11771.8 11849.2 11927.2 11931.9 4051.9 4058.1 4069.6 4116.8 4149.3 53326.5 53720.0 54851.7 55220.0 56261.4 11127.9 11217.8 11335.0 11464.2 11500.8 19824.5 19825.2 19847.2 19901.9 20193.8 8758.3 8880.6 8988.3 9011.2 9140.0 4837.5 4922.9 4975.6 4978.0 5009.6 3628.7 3675.2 3676.4 3678.4 3682.3 584.9 657.8 666.8 673.1 679.4 770.8 798.2 823.6 847.4 870.1 10271.3 10283.6 10388.7 10432.1 10456.6 668.6 803.5 812.3 836.6 851.2 4647.8 4703.4 4735.6 4818.7 4935.3 60132.0 60531.7 61429.7 61490.0 61663.4 55224.7 56043.0 56131.0 56146.4 57335.4 50469.0 50746.0 51524.7 51576.5 52390.7 9507.7 9546.9 9776.5 9797.8 9917.7 37965.0 38450.8 39063.6 39537.6 39787.0 45893.8 48179.3 50558.7 51219.5 51421.7 11195.3 11420.4 11467.8 11519.9 11804.8 12570.8 12839.5 12960.9 13081.5 13326.0 10200.6 12074.9 12509.8 13107.5 13300.8 12450.3 12707.6 12913.9 13007.7 13152.9 13105.2 13475.8 13506.5 13517.0 13591.6 11142.5 11255.2 11471.1 11561.4 11619.0 11186.3 11538.5 11610.8 11798.7 11807.5 12:32:42 INFO - PROCESS | 21788 | -------- Summary: end -------- 12:32:42 INFO - PROCESS | 21788 | 12:32:42 INFO - TEST-INFO | 21788: exit 0 12:32:42 INFO - TEST-OK | dromaeo_css | took 1111738ms 12:32:42 INFO - TEST-START | kraken 12:32:42 INFO - operating with platform_type : linux_ 12:32:42 INFO - Initialising browser for kraken test... 12:32:42 INFO - TEST-INFO | started process 21975 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpY9VfLn/profile http://localhost:59834/getInfo.html) 12:32:47 INFO - PROCESS | 21975 | __metrics Screen width/height:1600/1200 12:32:47 INFO - PROCESS | 21975 | colorDepth:24 12:32:47 INFO - PROCESS | 21975 | Browser inner width/height: 1024/697 12:32:47 INFO - PROCESS | 21975 | __metrics 12:32:48 ERROR - PROCESS | 21975 | JavaScript error: resource://app/modules/AboutNewTab.jsm, line 36: TypeError: this.pageListener is null 12:32:49 INFO - TEST-INFO | 21975: exit 0 12:32:49 INFO - Browser initialized. 12:32:49 INFO - Running cycle 1/1 for kraken test... 12:32:49 INFO - TEST-INFO | started process 22066 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpY9VfLn/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 12:33:00 INFO - PROCESS | 22066 | RSS: Main: 139571200 12:33:00 INFO - PROCESS | 22066 | 12:33:03 INFO - PROCESS | 22066 | Cycle 1(1): loaded http://localhost:59834/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:59834/tests/kraken/driver.html?testName=audio-beat-detection) 12:33:04 INFO - PROCESS | 22066 | RSS: Main: 198340608 12:33:04 INFO - PROCESS | 22066 | 12:33:06 INFO - PROCESS | 22066 | Cycle 1(1): loaded http://localhost:59834/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:59834/tests/kraken/driver.html?testName=audio-dft) 12:33:07 INFO - PROCESS | 22066 | RSS: Main: 186437632 12:33:07 INFO - PROCESS | 22066 | 12:33:10 INFO - PROCESS | 22066 | Cycle 1(1): loaded http://localhost:59834/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:59834/tests/kraken/driver.html?testName=audio-fft) 12:33:10 INFO - PROCESS | 22066 | RSS: Main: 274763776 12:33:10 INFO - PROCESS | 22066 | 12:33:12 INFO - PROCESS | 22066 | Cycle 1(1): loaded http://localhost:59834/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:59834/tests/kraken/driver.html?testName=audio-oscillator) 12:33:13 INFO - PROCESS | 22066 | RSS: Main: 180871168 12:33:13 INFO - PROCESS | 22066 | 12:33:15 INFO - PROCESS | 22066 | Cycle 1(1): loaded http://localhost:59834/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:59834/tests/kraken/driver.html?testName=imaging-gaussian-blur) 12:33:16 INFO - PROCESS | 22066 | RSS: Main: 178245632 12:33:16 INFO - PROCESS | 22066 | 12:33:19 INFO - PROCESS | 22066 | Cycle 1(1): loaded http://localhost:59834/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:59834/tests/kraken/driver.html?testName=imaging-darkroom) 12:33:19 INFO - PROCESS | 22066 | RSS: Main: 213630976 12:33:19 INFO - PROCESS | 22066 | 12:33:23 INFO - PROCESS | 22066 | Cycle 1(1): loaded http://localhost:59834/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:59834/tests/kraken/driver.html?testName=imaging-desaturate) 12:33:23 INFO - PROCESS | 22066 | RSS: Main: 213536768 12:33:23 INFO - PROCESS | 22066 | 12:33:26 INFO - PROCESS | 22066 | Cycle 1(1): loaded http://localhost:59834/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:59834/tests/kraken/driver.html?testName=json-parse-financial) 12:33:27 INFO - PROCESS | 22066 | RSS: Main: 213057536 12:33:27 INFO - PROCESS | 22066 | 12:33:28 INFO - PROCESS | 22066 | Cycle 1(1): loaded http://localhost:59834/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:59834/tests/kraken/driver.html?testName=json-stringify-tinderbox) 12:33:29 INFO - PROCESS | 22066 | RSS: Main: 194121728 12:33:29 INFO - PROCESS | 22066 | 12:33:30 INFO - PROCESS | 22066 | Cycle 1(1): loaded http://localhost:59834/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:59834/tests/kraken/driver.html?testName=stanford-crypto-aes) 12:33:31 INFO - PROCESS | 22066 | RSS: Main: 196116480 12:33:31 INFO - PROCESS | 22066 | 12:33:33 INFO - PROCESS | 22066 | Cycle 1(1): loaded http://localhost:59834/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:59834/tests/kraken/driver.html?testName=stanford-crypto-ccm) 12:33:34 INFO - PROCESS | 22066 | RSS: Main: 210251776 12:33:34 INFO - PROCESS | 22066 | 12:33:36 INFO - PROCESS | 22066 | Cycle 1(1): loaded http://localhost:59834/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:59834/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 12:33:37 INFO - PROCESS | 22066 | RSS: Main: 217694208 12:33:37 INFO - PROCESS | 22066 | 12:33:39 INFO - PROCESS | 22066 | Cycle 1(1): loaded http://localhost:59834/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:59834/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 12:33:40 INFO - PROCESS | 22066 | RSS: Main: 213708800 12:33:40 INFO - PROCESS | 22066 | 12:33:42 INFO - PROCESS | 22066 | Cycle 1(1): loaded http://localhost:59834/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:59834/tests/kraken/driver.html?testName=ai-astar) 12:33:42 INFO - PROCESS | 22066 | RSS: Main: 274440192 12:33:42 INFO - PROCESS | 22066 | 12:33:42 INFO - PROCESS | 22066 | __start_tp_report 12:33:42 INFO - PROCESS | 22066 | _x_x_mozilla_page_load 12:33:42 INFO - PROCESS | 22066 | _x_x_mozilla_page_load_details 12:33:42 INFO - PROCESS | 22066 | |i|pagename|runs| 12:33:42 INFO - PROCESS | 22066 | |0;ai-astar;110;110;109;110;110;111;106;109;110;110 12:33:42 INFO - PROCESS | 22066 | |1;audio-beat-detection;156;124;153;195;129;153;168;125;183;127 12:33:42 INFO - PROCESS | 22066 | |2;audio-dft;162;161;160;162;162;160;161;160;160;160 12:33:42 INFO - PROCESS | 22066 | |3;audio-fft;76;76;76;173;77;75;74;73;167;76 12:33:42 INFO - PROCESS | 22066 | |4;audio-oscillator;93;92;160;91;92;92;154;92;93;150 12:33:42 INFO - PROCESS | 22066 | |5;imaging-gaussian-blur;117;117;117;117;116;116;117;116;116;116 12:33:42 INFO - PROCESS | 22066 | |6;imaging-darkroom;146;146;144;145;145;146;145;145;145;146 12:33:42 INFO - PROCESS | 22066 | |7;imaging-desaturate;94;95;95;94;95;94;94;95;94;94 12:33:42 INFO - PROCESS | 22066 | |8;json-parse-financial;58;53;54;54;55;55;55;77;52;52 12:33:42 INFO - PROCESS | 22066 | |9;json-stringify-tinderbox;60;62;60;58;59;59;60;59;59;59 12:33:42 INFO - PROCESS | 22066 | |10;stanford-crypto-aes;80;73;71;79;72;73;74;74;74;73 12:33:42 INFO - PROCESS | 22066 | |11;stanford-crypto-ccm;117;115;112;112;114;110;115;118;128;135 12:33:42 INFO - PROCESS | 22066 | |12;stanford-crypto-pbkdf2;153;153;155;152;156;156;152;153;157;153 12:33:42 INFO - PROCESS | 22066 | |13;stanford-crypto-sha256-iterative;65;68;65;65;65;64;65;64;65;64 12:33:42 INFO - PROCESS | 22066 | __end_tp_report 12:33:42 INFO - PROCESS | 22066 | __start_cc_report 12:33:42 INFO - PROCESS | 22066 | _x_x_mozilla_cycle_collect,1569 12:33:42 INFO - PROCESS | 22066 | __end_cc_report 12:33:42 INFO - PROCESS | 22066 | __startTimestamp1467056022296__endTimestamp 12:33:42 INFO - PROCESS | 22066 | 12:33:42 INFO - PROCESS | 22066 | ------- Summary: start ------- 12:33:42 INFO - PROCESS | 22066 | Number of tests: 14 12:33:42 INFO - PROCESS | 22066 | 12:33:42 INFO - PROCESS | 22066 | [#0] ai-astar Cycles:10 Average:109.50 Median:110.00 stddev:1.35 (1.2%) stddev-sans-first:1.42 12:33:42 INFO - PROCESS | 22066 | Values: 110.0 110.0 109.0 110.0 110.0 111.0 106.0 109.0 110.0 110.0 12:33:42 INFO - PROCESS | 22066 | 12:33:42 INFO - PROCESS | 22066 | [#1] audio-beat-detection Cycles:10 Average:151.30 Median:154.50 stddev:25.27 (16.4%) stddev-sans-first:26.74 12:33:42 INFO - PROCESS | 22066 | Values: 156.0 124.0 153.0 195.0 129.0 153.0 168.0 125.0 183.0 127.0 12:33:42 INFO - PROCESS | 22066 | 12:33:42 INFO - PROCESS | 22066 | [#2] audio-dft Cycles:10 Average:160.80 Median:161.00 stddev:0.92 (0.6%) stddev-sans-first:0.87 12:33:42 INFO - PROCESS | 22066 | Values: 162.0 161.0 160.0 162.0 162.0 160.0 161.0 160.0 160.0 160.0 12:33:42 INFO - PROCESS | 22066 | 12:33:42 INFO - PROCESS | 22066 | [#3] audio-fft Cycles:10 Average:94.30 Median:76.00 stddev:39.94 (52.6%) stddev-sans-first:41.81 12:33:42 INFO - PROCESS | 22066 | Values: 76.0 76.0 76.0 173.0 77.0 75.0 74.0 73.0 167.0 76.0 12:33:42 INFO - PROCESS | 22066 | 12:33:42 INFO - PROCESS | 22066 | [#4] audio-oscillator Cycles:10 Average:110.90 Median:92.00 stddev:30.30 (32.9%) stddev-sans-first:31.44 12:33:42 INFO - PROCESS | 22066 | Values: 93.0 92.0 160.0 91.0 92.0 92.0 154.0 92.0 93.0 150.0 12:33:42 INFO - PROCESS | 22066 | 12:33:42 INFO - PROCESS | 22066 | [#5] imaging-gaussian-blur Cycles:10 Average:116.50 Median:117.00 stddev:0.53 (0.5%) stddev-sans-first:0.53 12:33:42 INFO - PROCESS | 22066 | Values: 117.0 117.0 117.0 117.0 116.0 116.0 117.0 116.0 116.0 116.0 12:33:42 INFO - PROCESS | 22066 | 12:33:42 INFO - PROCESS | 22066 | [#6] imaging-darkroom Cycles:10 Average:145.30 Median:145.50 stddev:0.67 (0.5%) stddev-sans-first:0.67 12:33:42 INFO - PROCESS | 22066 | Values: 146.0 146.0 144.0 145.0 145.0 146.0 145.0 145.0 145.0 146.0 12:33:42 INFO - PROCESS | 22066 | 12:33:42 INFO - PROCESS | 22066 | [#7] imaging-desaturate Cycles:10 Average:94.40 Median:94.50 stddev:0.52 (0.5%) stddev-sans-first:0.53 12:33:42 INFO - PROCESS | 22066 | Values: 94.0 95.0 95.0 94.0 95.0 94.0 94.0 95.0 94.0 94.0 12:33:42 INFO - PROCESS | 22066 | 12:33:42 INFO - PROCESS | 22066 | [#8] json-parse-financial Cycles:10 Average:56.50 Median:55.00 stddev:7.41 (13.5%) stddev-sans-first:7.84 12:33:42 INFO - PROCESS | 22066 | Values: 58.0 53.0 54.0 54.0 55.0 55.0 55.0 77.0 52.0 52.0 12:33:42 INFO - PROCESS | 22066 | 12:33:42 INFO - PROCESS | 22066 | [#9] json-stringify-tinderbox Cycles:10 Average:59.50 Median:59.50 stddev:1.08 (1.8%) stddev-sans-first:1.13 12:33:42 INFO - PROCESS | 22066 | Values: 60.0 62.0 60.0 58.0 59.0 59.0 60.0 59.0 59.0 59.0 12:33:42 INFO - PROCESS | 22066 | 12:33:42 INFO - PROCESS | 22066 | [#10] stanford-crypto-aes Cycles:10 Average:74.30 Median:74.00 stddev:2.91 (3.9%) stddev-sans-first:2.24 12:33:42 INFO - PROCESS | 22066 | Values: 80.0 73.0 71.0 79.0 72.0 73.0 74.0 74.0 74.0 73.0 12:33:42 INFO - PROCESS | 22066 | 12:33:42 INFO - PROCESS | 22066 | [#11] stanford-crypto-ccm Cycles:10 Average:117.60 Median:116.00 stddev:7.88 (6.8%) stddev-sans-first:8.35 12:33:42 INFO - PROCESS | 22066 | Values: 117.0 115.0 112.0 112.0 114.0 110.0 115.0 118.0 128.0 135.0 12:33:42 INFO - PROCESS | 22066 | 12:33:42 INFO - PROCESS | 22066 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:154.00 Median:154.00 stddev:1.83 (1.2%) stddev-sans-first:1.90 12:33:42 INFO - PROCESS | 22066 | Values: 153.0 153.0 155.0 152.0 156.0 156.0 152.0 153.0 157.0 153.0 12:33:42 INFO - PROCESS | 22066 | 12:33:42 INFO - PROCESS | 22066 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:65.00 Median:65.00 stddev:1.15 (1.8%) stddev-sans-first:1.22 12:33:42 INFO - PROCESS | 22066 | Values: 65.0 68.0 65.0 65.0 65.0 64.0 65.0 64.0 65.0 64.0 12:33:42 INFO - PROCESS | 22066 | -------- Summary: end -------- 12:33:42 INFO - PROCESS | 22066 | 12:33:43 INFO - TEST-INFO | 22066: exit 0 12:33:43 INFO - TEST-OK | kraken | took 60439ms 12:33:43 INFO - SUITE-END | took 1172s 12:33:43 INFO - Completed test suite (00:19:32) 12:33:43 INFO - javascript benchmark 12:33:43 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3259.6251431085425, 3311.3377324535086, 3321.9335613287735, 3354.916127096824, 3376.0378292186733, 5441.863953401162, 5474.72626368682, 5475.78096876125, 5480.04099282626, 5489.451054894508, 5460.535854452366, 5485.890282194354, 5496.725163741817, 5506.614536982403, 5532.170174473831, 4860.368152140217, 4920.065187614351, 5065.670731402447, 5108.259302401149, 5140.434552199255, 4910.0, 4946.0107978404285, 4971.925421118686, 5052.621053421009, 5067.594592432615, 4976.576990955755, 5064.341635587387, 5071.518205770446, 5100.795968161269, 5101.54086132248, 5093.643444958854, 5115.155999260118, 5118.206677964921, 5122.487751224848, 5162.148245539482, 4850.975745121287, 4864.854054378375, 4876.049170411771, 5045.41977672565, 5053.36832895888, 5239.266502689627, 5296.0, 5308.097623404031, 5331.866703332409, 5354.973225133888, 5664.830055098354, 5711.600187986843, 5716.256886604757, 5723.71381430931, 5729.140628905656, 5572.7770889164385, 5767.826965191051, 5776.566757493205, 5844.357120716718, 5865.032269675498, 5529.585281103933, 5541.612087153901, 5549.694766787825, 5551.084071128259, 5552.833414997597, 6038.0, 6038.607490513103, 6045.818625441244, 6064.969675151596, 6073.331933487313, 5610.102383618601, 5781.797637082682, 5841.678707671119, 5881.32364778056, 5886.529077673776, 5813.5349172066135, 5818.418158184232, 5818.941810581925, 5823.272090988627, 5839.562032847553, 5644.0, 5815.505682017076, 5817.7963771267805, 5818.796342128006, 5819.709014549256, 5821.388754180834, 5877.441643043904, 5906.40935906406, 5914.556408269311, 5921.703914804242, 4523.773811309487, 4533.5013148553635, 4535.841245556456, 4546.454425468899, 4547.909041819211, 3931.331673615492, 4058.6144316289906, 4059.8579049733116, 4066.8576599818866, 4084.959150408458, 5550.333959924835, 5596.048671725816, 5606.131049687305, 5613.915791263134, 5637.154426836008, 5807.941920580824, 5828.6211396259105, 5853.180554722342, 5861.413858614104, 5872.031114865999, 5408.0535906216255, 5567.331920169525, 5568.805091821848, 5575.0243707351865, 5590.357108932443, 4973.32860063894, 4978.477259887732, 4983.127952608279, 4999.800007999712, 5008.348914641073, 6093.847653808691, 6094.207752992172, 6096.72564734588, 6097.237845269341, 6099.481544068715, 5696.316442026983, 5830.53355731549, 5842.707864606753, 5845.1232315153065, 5918.437748413894, 6171.444569988723, 6187.597806142587, 6199.907001395073, 6203.2245969253845, 6210.5652604319075, 5813.76744930198, 5828.213191219301, 5828.94171058284, 5833.970830145822, 5862.824115276549, 5707.258056452801, 5840.299164100165, 5903.557233207613, 5904.232449781501, 5919.171316015847, 5740.569457290637, 5752.827415177551, 5757.683327417032, 5758.395368486249, 5759.65442073477, 5689.800856969986, 5726.055200891807, 5736.340320863154, 5744.655320680772, 5746.16680581305, 5449.972750136224, 5578.497935185853, 5595.160725891149, 5700.942990570207, 5715.971420142872, 5841.094630332305, 5850.268716410449, 5860.38465961068, 5874.882502350015, 5878.823635290948, 5745.482906538432, 5747.339056008445, 5754.367019627922, 5754.395788442153, 5754.482096611325], "value": 5421.232128505285, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [658.2101478226127, 683.9247682754897, 685.1162001018686, 740.8333125046865, 766.9271419215177, 35352.2929541409, 36044.45933310996, 36068.2786344273, 36100.819495902484, 40517.79741101298, 43077.56922430782, 43525.564744352545, 43627.56372436283, 43661.56338436615, 43732.3440148398, 8761.737147885542, 8898.510581917992, 8923.286137109015, 8939.776505587348, 8946.507942063217, 8044.115147333789, 10658.20063495237, 10919.617813376533, 10921.672349829478, 10922.781544369147, 10631.78736425271, 10715.464226788668, 10716.249862509627, 10718.0, 10719.0, 10575.576976920915, 10605.0, 10608.416537090457, 10629.0, 10638.521266543024, 10356.067953884187, 10476.842847357295, 10486.632967846088, 10489.108425783817, 10513.421761803098, 43779.78110109429, 44387.0, 44481.777591112164, 44484.55515444869, 44513.777431112634, 3698.167912219756, 3767.7296146730687, 3834.5973672764517, 3883.4757307763657, 4515.367848501212, 33475.83262083698, 33590.66409335924, 33843.830780845936, 34032.6596734032, 34230.14424639379, 4567.794449249758, 4600.240960241556, 4626.144163329761, 4635.420572428447, 4656.115338085787, 316557.0, 317061.4146929274, 317355.0, 318835.0, 319569.0, 63314.366856330846, 64269.0, 64280.0, 64301.35698643047, 64438.355616444176, 70722.29277707158, 71976.64011680013, 72553.0, 72587.63706181436, 72700.63649681718, 19313.4205973821, 19452.221911123397, 19518.219271229274, 19543.511412214808, 19552.60894782125, 14058.578242652737, 14696.706065878623, 14958.326875290639, 14990.400383984519, 15179.696406072038, 20157.697634535492, 20306.898465507576, 20367.79632203659, 20444.488887777923, 20452.284170053976, 7396.852062958711, 7475.2905669429, 7539.924600754032, 7558.848823023509, 7696.190890325103, 1055.3773273768513, 1059.369675043348, 1126.5099681638515, 1149.4594567813174, 1199.5561642192445, 30313.848430757706, 30750.384992300027, 30873.691263087083, 31280.37439251202, 31511.842440788107, 1207.5713121841795, 1211.2066596379386, 1242.4036462498052, 1245.3648639193896, 1260.426505939795, 16197.137329207291, 16672.833271667372, 16957.66084678324, 17175.141242937803, 17340.65318693619, 517361.0, 521982.0, 525337.0, 526962.0, 528079.0, 63099.6845015772, 63781.68109159425, 63887.0, 63906.6804665983, 63950.36049639537, 1393.749125157461, 1475.6310922269433, 1526.4809964611864, 1532.9080255184501, 1592.633694250329, 30711.2322191947, 32507.187320316236, 32756.603474260406, 33079.83460082684, 33123.50314745233, 52774.0, 53052.73473632761, 53516.46483535115, 53558.73220633872, 53575.464245358606, 366235.0, 366907.0, 366983.0, 367085.0, 368285.0, 28026.0, 31004.68995310018, 31011.689883101782, 31406.685933140376, 31798.364032719677, 45296.547034529234, 45552.31671524996, 45883.54116458793, 46838.29742553796, 46887.76556117334, 38821.22357552889, 40421.393679094246, 41812.57053823753, 42811.7859410701, 42871.7856410716, 40484.19031619292, 40579.82541607814, 40757.0, 41475.58524414838, 42201.15597687968, 41654.58345416507, 42297.0, 42406.36390454207, 42510.0, 42681.57318426776, 34906.825465872505, 36393.272134557694, 36791.26417471689, 37275.62724372721, 37615.6238437623, 27647.58528622032, 28627.85488580517, 28701.28246793847, 28708.0, 28726.138215853556], "value": 21169.447335368182, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [445.35645991542225, 445.7303331484452, 448.51784331843277, 449.7436461217106, 451.10905960727587, 18589.442316730485, 18797.0, 19293.614127717436, 19299.421017369503, 19422.805771942276, 18197.63604727908, 18803.0, 18832.90583547084, 18839.71740423895, 18911.90544047278, 5670.149477578355, 5787.334456537489, 5791.9284932287555, 5796.971015144918, 5889.64662120272, 4221.472315960505, 5699.03116470199, 5702.800401985931, 6052.092186172087, 6325.841853953665, 6260.405261500173, 6316.684165791715, 6325.778597749079, 6326.620402775825, 6340.461060809836, 6282.842928926768, 6349.174607301067, 6385.584936979105, 6478.255000674935, 6535.673216339164, 3989.40158976153, 5595.916061259084, 5788.768449262025, 5809.331926828427, 5868.061110222344, 21984.780152198433, 22164.335069947927, 22232.444188895246, 22285.888570557207, 22365.552688946293, 2436.561418944589, 2460.225029115823, 2488.0, 2717.225590706639, 2881.0, 13951.651208719763, 14162.71674566503, 14205.502807401796, 14230.146191228456, 14590.124592524482, 2078.646630072891, 2089.696993935871, 2091.0799248330686, 2101.4116047506723, 2138.2622995066677, 76263.6186819068, 77551.61224193899, 77900.61049694772, 78158.99999999943, 79169.60415197887, 10302.536385862653, 10365.689029329133, 10565.683029509128, 10690.732731681615, 10710.732231694114, 14098.788518172236, 14166.150030998173, 14202.431902723776, 14241.43034278638, 14247.287635618177, 8655.52394618302, 8798.076201998825, 8824.77938051541, 8835.381523293308, 8958.507282099417, 8861.689840855539, 9017.909820901707, 9045.954770226239, 9122.817543649222, 9157.725268241964, 6554.737810487527, 6707.49693772969, 6804.693788779517, 6829.282925292872, 6843.486738494633, 1824.908754562293, 1832.9442101961804, 1860.5627677495777, 1894.9147288372055, 1897.3643829317334, 473.1908436573429, 1107.1751545098953, 1113.4098927568402, 1140.2474366917795, 1175.3476820364779, 11372.943135284271, 11746.412679365998, 11987.280763154064, 12105.0, 12192.75614487723, 507.13533425509416, 508.461031306816, 511.2842021170391, 521.8460554136539, 529.6610169491529, 6435.871282574322, 6473.385028422293, 6548.508861835381, 6641.800745977628, 6644.103046088813, 509212.0, 514431.0, 521797.0, 530748.0, 531398.0, 87055.0, 90930.0, 91158.54420727986, 91826.0, 91967.0, 503.7355388421035, 504.1303751029518, 505.30520534265384, 507.84256880367207, 509.5261406891626, 10668.573257069631, 10684.519196636014, 10752.301100428447, 10945.45272736376, 10995.505202266077, 37761.2447751038, 38313.0, 38329.0, 38500.614993850824, 38840.028999275244, 57294.0, 57755.0, 57866.7106664464, 57973.71013145076, 57980.0, 8836.337274704552, 8840.734777956672, 8858.29133669292, 8882.60028298741, 9208.539573021457, 9614.855777163208, 13030.153040052746, 13374.531891383755, 13387.464501419834, 13431.529896453578, 9894.45580493051, 10236.641717539851, 11188.272762270426, 11249.943750281196, 11328.490217940047, 11206.719832004264, 11609.709757256136, 11749.941250293694, 11779.528818847493, 11950.043996480086, 11016.724581885517, 11195.0, 11206.719832004264, 11479.196456247982, 11688.824667630162, 8509.531975741394, 8663.393562450568, 8785.912140878765, 8810.647574096964, 8852.0, 9025.684101056431, 10872.945635271773, 11248.775024499628, 11499.482523286304, 11895.10786691019], "value": 8745.191789694038, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1405.2762827144015, 1573.8976966497178, 1580.652256503569, 1774.2636805725624, 1898.1932678611586, 8341.249287564118, 8599.054104048557, 8607.311415086793, 8608.13918608138, 8618.61216245269, 8458.577071146434, 8617.91382086179, 8636.265917397013, 8639.913600863989, 8647.610857511412, 2388.6417037444394, 2403.086827005744, 2408.51829634073, 2412.1316326122583, 2415.975840241593, 2415.7946574541184, 2455.8526488410753, 2461.2739241923587, 2461.9753802462014, 2483.1805504183667, 2373.371056669984, 2410.18053861687, 2412.6139817629182, 2415.9637605435933, 2417.9637305440433, 2381.880905954695, 2428.9149879754214, 2430.1980346485616, 2437.81716371272, 2438.67077944477, 2411.9397015074587, 2449.8040156787415, 2473.307473907309, 2473.567125753004, 2473.9010439582394, 7098.503104782667, 7844.097928738154, 8829.823403531893, 8866.512341821197, 8874.86687699685, 5393.2719082923695, 5551.0, 5552.750126244328, 5556.444355564452, 5560.833175004756, 3515.54297941266, 3546.3261980223674, 3590.676839084495, 3609.458581212813, 3662.450632405134, 1190.7023244188954, 1195.8923696867237, 1197.6407077876602, 1223.3088305107585, 1228.8648248692637, 12157.635270941886, 12615.810762838657, 12630.115891887572, 12673.873261267361, 12695.04787140968, 4777.1878780606685, 4854.80580776765, 4910.8772280693265, 4922.163232250526, 4924.064427758714, 10787.406692631823, 10811.567537298577, 10816.78366432667, 10837.891621083845, 10838.241323107464, 5536.861578460571, 5586.385497595261, 5594.0, 5594.552435805126, 5597.440255974451, 4998.750062496861, 5065.645404821701, 5070.797168113234, 5073.847784566469, 5082.695038297714, 4030.234255491447, 4116.382542618571, 4128.731632443882, 4153.127843152972, 4153.439285696452, 1283.1787655900232, 1288.606974872673, 1294.4822071171607, 1295.2746461981321, 1328.9734205316033, 1074.8602681651334, 1077.7628921637227, 1084.739662480999, 1094.4035500652165, 1120.3501968858043, 6042.637441753509, 6143.109249158847, 6156.630602163885, 6195.907061394083, 6247.5939063960695, 473.23572430524456, 476.3830839063421, 479.5061087080243, 486.9196582563908, 491.35632321658744, 4270.871873843789, 4334.523202447728, 4400.603945644907, 4444.066745983315, 4448.199324121689, 10657.094146997591, 10985.176111791647, 11076.778464430827, 11175.329480231212, 11187.32876027441, 10943.83584246237, 10969.067629251444, 11031.22781405294, 11035.613753518588, 11038.503267352988, 8086.353091752646, 8174.468659537111, 8199.262066413932, 8284.99999999988, 8385.245327920517, 6145.938540614537, 6337.082465940788, 6401.743930242738, 6402.839929001626, 6518.608883467007, 9802.215822734306, 9877.357971731815, 9938.155256803253, 10105.39367637944, 10140.0, 9988.550515226978, 10242.283040187116, 10420.218483613911, 10421.374717516974, 10446.63436779709, 7431.219721929336, 7631.1605723371495, 7669.501482403626, 7676.117246516722, 7676.577788221702, 8321.0, 8330.375221858263, 8369.874451883104, 8401.621927013177, 8418.873716894374, 7416.66625001887, 7420.40636749048, 7467.365273951775, 7480.887786683095, 7510.248975102446, 7497.2877576630135, 7542.321191092828, 7646.350060244719, 7664.885026724715, 7783.066032076187, 7136.215016348094, 7164.820879477847, 7189.820254493679, 7194.928050719426, 7196.460265480006, 5389.568834493152, 5492.780288788404, 5493.038718224215, 5562.16567514876, 5602.243697101002, 5575.4424557543925, 5589.608727389043, 5591.21722958778, 5649.293838270216, 5720.141978703228], "value": 4695.722079942757, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [347.44408945686894, 347.9652034796521, 352.4378616107308, 371.5578461630661, 373.23486851953487, 6215.129881816543, 6217.285012223596, 6239.56323057385, 6251.0, 6256.311805701369, 6218.284897236819, 6227.782027629022, 6240.56316057875, 6248.531360147996, 6298.842528936779, 4470.150671372437, 4633.9073218535605, 4725.9054818903605, 4738.384010078685, 4791.041791641668, 4751.619870410359, 4766.404199475066, 4790.401199850019, 4791.9520804791855, 4794.808207671689, 4488.0799436115685, 4763.095011947719, 4783.952160478403, 4789.257665061904, 4789.712617242959, 4588.1511920294515, 4605.930911036337, 4606.792694328747, 4617.538246175389, 4790.137775200463, 4195.181939521794, 4201.474815648044, 4208.095259519218, 4211.410402543646, 4216.262154123016, 5966.164736936832, 5970.0, 5990.430909063632, 5991.161237426763, 5999.940000599981, 5552.86117847053, 5554.0835762099205, 5566.610337276392, 5573.721313934287, 5576.609637325389, 6428.742850286029, 6494.058361537551, 6558.80323590293, 6564.179477565304, 6568.441682456997, 4672.439307283148, 4678.672492925462, 4686.2267725825195, 4686.789094490756, 4690.812367505296, 6809.795706128774, 6810.693518791666, 6857.931420685779, 6872.381485666264, 6876.346747059021, 4783.091212669582, 4787.952120478751, 4794.856154315376, 4795.95204047962, 4800.159972004885, 4851.708897466164, 4853.708777473363, 4856.150173719585, 4858.271259311132, 4858.514148585114, 5533.253010843485, 5547.334319881559, 5548.056830338852, 5554.389017208104, 5561.332640083216, 6429.54993150475, 6592.901106483407, 6594.802155935329, 6607.041978913031, 6608.933910660832, 1663.3180396037567, 1695.7202061659689, 1707.1123016031595, 1707.846293833561, 1712.86297096232, 1016.481594386868, 1074.2641290715885, 1106.9889301107046, 1120.7758448310371, 1141.1156353825852, 6267.96866015667, 6409.583377080475, 6431.807045788541, 6548.934510654833, 6599.406053455116, 6883.690233939485, 6892.827679307957, 6893.862122757517, 6896.137982752156, 6901.930980690229, 6504.1869766279215, 6513.544051916415, 6519.087327774116, 6524.314946930599, 6524.478041756648, 3666.5783434904793, 3683.4474828775897, 3706.8331925063435, 3711.31340701971, 3712.554493460802, 7067.0, 7122.501424900311, 7194.424446044304, 7219.422446204291, 7226.891596626055, 6963.547369420971, 6972.1284839395075, 6972.825679357955, 6983.406410455066, 6988.161420629557, 7177.533460324958, 7178.784636460915, 7186.928130718626, 7187.065681461377, 7199.820004499825, 6862.245153033063, 6865.382115609619, 6866.416354609914, 6922.723091076301, 6946.37482626566, 6474.741010359533, 6754.763583274562, 6769.559978601375, 6797.524173307821, 6806.93193068063, 7180.820479487846, 7192.568445893263, 7204.9279507204255, 7211.567305961659, 7219.014770938034, 4565.954340456553, 4569.337446070234, 4574.085182963354, 4585.72485650862, 4604.309353596987, 6826.8634627308165, 6828.487863410165, 6834.624095674786, 6839.794806155824, 6843.178818541807, 6433.613983161025, 6648.1025061616065, 6652.567583107082, 6653.434458071119, 6656.667166641745, 6588.308227636221, 6639.568428052161, 6640.701168447528, 6647.867042659216, 6648.534602577966, 6489.772857949949, 6524.347565243627, 6525.3800888915475, 6529.542931994714, 6535.202819224751, 6668.3331666834865, 6671.733130674718, 6675.7997260082275, 6677.399034086956, 6679.866402672016, 6396.456301214449, 6504.447121994494, 6525.673716314261, 6531.0, 6534.803955881332], "value": 5010.751606721221, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [820.2371794231366, 875.7153924974381, 923.5751554285029, 928.7260258223824, 940.2947789158131, 13745.0, 14655.926720366397, 15516.689666206668, 15563.066216027019, 15590.376384944602, 14248.928755356235, 14469.92765036176, 14520.782188267185, 14523.854761452383, 14555.781663275033, 760.9695612175507, 885.2917665867312, 907.9636814527411, 914.634146341462, 922.423485321674, 897.6544030548254, 900.5407242306405, 900.7072701372048, 901.8782464367292, 902.7833320003185, 952.8237276103908, 954.1555723184997, 954.1889394015101, 954.3271993244746, 958.4345236310576, 785.8624740670389, 797.1669605262485, 938.737153596994, 953.0993211415215, 955.6750704760415, 704.7181127549021, 704.8660754456688, 705.0869124483805, 705.400409651797, 705.696550483292, 14648.0, 14696.044757090755, 14767.26163691811, 14770.556883293519, 14771.778423323658, 14204.147751134966, 14679.339429725687, 14703.117812931152, 14759.70480590393, 14805.407783688639, 11618.709532261677, 11771.823422648667, 11849.17055806094, 11927.224730392496, 11931.94034029833, 4051.9189616207805, 4058.0666446717123, 4069.6133867282856, 4116.773577453238, 4149.315362965107, 53326.466735332535, 53720.0, 54851.72574137104, 55220.0, 56261.43738562603, 11127.944360278147, 11217.831732524019, 11335.036521895567, 11464.197506174654, 11500.827487587692, 19824.504387390432, 19825.206991720457, 19847.20611175566, 19901.900490497454, 20193.798062019487, 8758.255548278341, 8880.600372983232, 8988.32587555936, 9011.23404510624, 9139.95430022859, 4837.516248375135, 4922.876928076755, 4975.577075948512, 4978.0, 5009.5741861941415, 3628.7097032237357, 3675.22820207754, 3676.3933950898336, 3678.448232765053, 3682.3187710273687, 584.8888711144868, 657.7500549791049, 666.8466252761892, 673.0577191931237, 679.3715812873171, 770.8256862531166, 798.2057852436747, 823.6499487717696, 847.3983471735137, 870.1429092344036, 10271.281010329354, 10283.640072597573, 10388.740281493023, 10432.113270371952, 10456.581736730446, 668.6055227415848, 803.477739469338, 812.3379445751693, 836.6277006732067, 851.1573542193184, 4647.790849411717, 4703.396346212056, 4735.621150308036, 4818.7108773473, 4935.3090567320605, 60132.0, 60531.69734151301, 61429.69285153546, 61490.0, 61663.38336616576, 55224.72387638116, 56043.0, 56131.0, 56146.43853561412, 57335.426645733845, 50469.0, 50746.0, 51524.742376287875, 51576.48423515717, 52390.738046309525, 9507.66723164686, 9546.856797148188, 9776.462294573583, 9797.755949529022, 9917.65288214909, 37965.0, 38450.807745961094, 39063.60936390713, 39537.60462395339, 39787.0, 45893.77053114713, 48179.27731084107, 50558.74720626373, 51219.48780512296, 51421.74289128531, 11195.2723073, 11420.428978551205, 11467.827982580102, 11519.88480115188, 11804.82292765592, 12570.811437828623, 12839.486420543448, 12960.935195323964, 13081.542146024844, 13326.0, 10200.642977495752, 12074.879251207376, 12509.812352814897, 13107.475700971854, 13300.800487992494, 12450.25298482094, 12707.569736966318, 12913.870861291267, 13007.674808129872, 13152.934235328763, 13105.2136871788, 13475.797863032258, 13506.527271545448, 13517.0, 13591.592252232449, 11142.498587563741, 11255.155863310121, 11471.139664525028, 11561.364124972872, 11619.012383947122, 11186.32882027081, 11538.48076836561, 11610.76778464443, 11798.705032373917, 11807.527698892292], "value": 7146.299146533853, "unit": "score"}], "name": "dromaeo_css", "value": 7433.907726605267, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [110.0, 110.0, 109.0, 110.0, 110.0, 111.0, 106.0, 109.0, 110.0, 110.0], "value": 109.5, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [156.0, 124.0, 153.0, 195.0, 129.0, 153.0, 168.0, 125.0, 183.0, 127.0], "value": 151.3, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [162.0, 161.0, 160.0, 162.0, 162.0, 160.0, 161.0, 160.0, 160.0, 160.0], "value": 160.8, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 76.0, 76.0, 173.0, 77.0, 75.0, 74.0, 73.0, 167.0, 76.0], "value": 94.3, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [93.0, 92.0, 160.0, 91.0, 92.0, 92.0, 154.0, 92.0, 93.0, 150.0], "value": 110.9, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 117.0, 117.0, 117.0, 116.0, 116.0, 117.0, 116.0, 116.0, 116.0], "value": 116.5, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 146.0, 144.0, 145.0, 145.0, 146.0, 145.0, 145.0, 145.0, 146.0], "value": 145.3, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [94.0, 95.0, 95.0, 94.0, 95.0, 94.0, 94.0, 95.0, 94.0, 94.0], "value": 94.4, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [58.0, 53.0, 54.0, 54.0, 55.0, 55.0, 55.0, 77.0, 52.0, 52.0], "value": 56.5, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [60.0, 62.0, 60.0, 58.0, 59.0, 59.0, 60.0, 59.0, 59.0, 59.0], "value": 59.5, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [80.0, 73.0, 71.0, 79.0, 72.0, 73.0, 74.0, 74.0, 74.0, 73.0], "value": 74.3, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 115.0, 112.0, 112.0, 114.0, 110.0, 115.0, 118.0, 128.0, 135.0], "value": 117.6, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [153.0, 153.0, 155.0, 152.0, 156.0, 156.0, 152.0, 153.0, 157.0, 153.0], "value": 154.0, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [65.0, 68.0, 65.0, 65.0, 65.0, 64.0, 65.0, 64.0, 65.0, 64.0], "value": 65.0, "unit": "score"}], "name": "kraken", "value": 1509.8999999999999, "alertThreshold": 2.0}]} 12:33:43 INFO - Return code: 0 12:33:43 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 12:33:43 ERROR - # TBPL SUCCESS # 12:33:43 INFO - Running post-action listener: _resource_record_post_action 12:33:43 INFO - Running post-run listener: _resource_record_post_run 12:33:44 INFO - Total resource usage - Wall time: 1187s; CPU: 13.0%; Read bytes: 0; Write bytes: 467234816; Read time: 0; Write time: 931472 12:33:44 INFO - install - Wall time: 14s; CPU: 17.0%; Read bytes: 0; Write bytes: 253788160; Read time: 0; Write time: 635708 12:33:44 INFO - run-tests - Wall time: 1174s; CPU: 13.0%; Read bytes: 0; Write bytes: 213446656; Read time: 0; Write time: 295764 12:33:44 INFO - Running post-run listener: _upload_blobber_files 12:33:44 INFO - Blob upload gear active. 12:33:44 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 12:33:44 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 12:33:44 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', 'Mozilla-Beta', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 12:33:44 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 Mozilla-Beta -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 12:33:45 INFO - (blobuploader) - INFO - Open directory for files ... 12:33:45 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 12:33:45 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 12:33:45 INFO - (blobuploader) - INFO - Uploading, attempt #1. 12:33:46 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 12:33:46 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 12:33:46 INFO - (blobuploader) - INFO - Done attempting. 12:33:46 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 12:33:46 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 12:33:46 INFO - (blobuploader) - INFO - Uploading, attempt #1. 12:33:47 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 12:33:47 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 12:33:47 INFO - (blobuploader) - INFO - Done attempting. 12:33:47 INFO - (blobuploader) - INFO - Iteration through files over. 12:33:47 INFO - Return code: 0 12:33:47 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 12:33:47 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 12:33:47 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/2bd92d188cac5b0ccaa31f38d14e415b171fd84c37302cdd122fce0f58c469a64e5e8e1e221517b1009cfa3d743bdd45a4efbc043a578eef76c8b318bfb95f30", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/f041f25aadc764f8408c7808644c35498c913af9941e5385a5b116ae8d365259c3fe1eaaa3f554c19039cf66d9062bdbef981a7b8dbc40d4c2e9cf7042b361ed"} 12:33:47 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 12:33:47 INFO - Writing to file /builds/slave/test/properties/blobber_files 12:33:47 INFO - Contents: 12:33:47 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/2bd92d188cac5b0ccaa31f38d14e415b171fd84c37302cdd122fce0f58c469a64e5e8e1e221517b1009cfa3d743bdd45a4efbc043a578eef76c8b318bfb95f30", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/f041f25aadc764f8408c7808644c35498c913af9941e5385a5b116ae8d365259c3fe1eaaa3f554c19039cf66d9062bdbef981a7b8dbc40d4c2e9cf7042b361ed"} 12:33:47 INFO - Running post-run listener: copy_logs_to_upload_dir 12:33:47 INFO - Copying logs to upload dir... 12:33:47 INFO - mkdir: /builds/slave/test/build/upload/logs 12:33:47 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1227.078991 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 27 secs) (at 2016-06-27 12:33:46.967536) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-27 12:33:46.971885) ========= 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=af724c981e2a0f424dbabf99000001e7-1467054798.548444-1639179931 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/2bd92d188cac5b0ccaa31f38d14e415b171fd84c37302cdd122fce0f58c469a64e5e8e1e221517b1009cfa3d743bdd45a4efbc043a578eef76c8b318bfb95f30", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/f041f25aadc764f8408c7808644c35498c913af9941e5385a5b116ae8d365259c3fe1eaaa3f554c19039cf66d9062bdbef981a7b8dbc40d4c2e9cf7042b361ed"} build_url:https://queue.taskcluster.net/v1/task/W4a73pTTQLqHwmdQHMlENw/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011415 build_url: 'https://queue.taskcluster.net/v1/task/W4a73pTTQLqHwmdQHMlENw/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/2bd92d188cac5b0ccaa31f38d14e415b171fd84c37302cdd122fce0f58c469a64e5e8e1e221517b1009cfa3d743bdd45a4efbc043a578eef76c8b318bfb95f30", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/f041f25aadc764f8408c7808644c35498c913af9941e5385a5b116ae8d365259c3fe1eaaa3f554c19039cf66d9062bdbef981a7b8dbc40d4c2e9cf7042b361ed"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-27 12:33:46.998700) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-27 12:33:46.999187) ========= 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=af724c981e2a0f424dbabf99000001e7-1467054798.548444-1639179931 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004528 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-27 12:33:47.082622) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-27 12:33:47.083013) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-27 12:33:47.083376) ========= ========= Total master_lag: 0.18 =========