builder: mozilla-central_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-030 starttime: 1461431732.93 results: success (0) buildid: 20160423073734 builduid: a812aa36b7c248e5849bad210b7b3205 revision: 2be765b599b2d90103013526ef8ebe684b66b218 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-04-23 10:15:32.926457) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-04-23 10:15:32.926834) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-23 10:15:32.927119) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-23 10:15:32.962837) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-23 10:15:32.963137) ========= 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=4ac8d263c7293b36a1be1aed000001be-1461426355.958197-518667313 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-04-23 10:15:33-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 224M=0s 2016-04-23 10:15:33 (224 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.088240 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-23 10:15:33.068247) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-23 10:15:33.068555) ========= 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=4ac8d263c7293b36a1be1aed000001be-1461426355.958197-518667313 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.019635 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-23 10:15:33.125705) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-23 10:15:33.126030) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 2be765b599b2d90103013526ef8ebe684b66b218 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo mozilla-central --rev 2be765b599b2d90103013526ef8ebe684b66b218 --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=4ac8d263c7293b36a1be1aed000001be-1461426355.958197-518667313 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-04-23 10:15:33,227 truncating revision to first 12 chars 2016-04-23 10:15:33,227 Setting DEBUG logging. 2016-04-23 10:15:33,227 attempt 1/10 2016-04-23 10:15:33,227 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/2be765b599b2?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-04-23 10:15:33,589 unpacking tar archive at: mozilla-central-2be765b599b2/testing/mozharness/ program finished with exit code 0 elapsedTime=0.617471 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-23 10:15:33.756651) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-23 10:15:33.756914) ========= script_repo_revision: 2be765b599b2d90103013526ef8ebe684b66b218 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-23 10:15:33.757305) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-23 10:15:33.757558) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-23 10:15:33.802735) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 46 secs) (at 2016-04-23 10:15:33.803509) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 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', 'Firefox', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox'] 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=4ac8d263c7293b36a1be1aed000001be-1461426355.958197-518667313 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 10:15:33 INFO - MultiFileLogger online at 20160423 10:15:33 in /builds/slave/test 10:15:33 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 10:15:33 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 10:15:33 INFO - {'append_to_log': False, 10:15:33 INFO - 'base_work_dir': '/builds/slave/test', 10:15:33 INFO - 'blob_upload_branch': 'Firefox', 10:15:33 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 10:15:33 INFO - 'branch': 'Firefox', 10:15:33 INFO - 'buildbot_json_path': 'buildprops.json', 10:15:33 INFO - 'config_files': ('talos/linux_config.py',), 10:15:33 INFO - 'default_actions': ('clobber', 10:15:33 INFO - 'read-buildbot-config', 10:15:33 INFO - 'download-and-extract', 10:15:33 INFO - 'populate-webroot', 10:15:33 INFO - 'create-virtualenv', 10:15:33 INFO - 'install', 10:15:33 INFO - 'run-tests'), 10:15:33 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 10:15:33 INFO - 'download_minidump_stackwalk': True, 10:15:33 INFO - 'download_symbols': 'ondemand', 10:15:33 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 10:15:33 INFO - 'tooltool.py': '/tools/tooltool.py', 10:15:33 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 10:15:33 INFO - '/tools/misc-python/virtualenv.py')}, 10:15:33 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 10:15:33 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 10:15:33 INFO - 'installer_path': 'installer.exe', 10:15:33 INFO - 'log_level': 'info', 10:15:33 INFO - 'log_name': 'talos', 10:15:33 INFO - 'log_to_console': True, 10:15:33 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 10:15:33 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 10:15:33 INFO - 'opt_config_files': (), 10:15:33 INFO - 'pip_index': False, 10:15:33 INFO - 'sps_profile': False, 10:15:33 INFO - 'sps_profile_interval': 0, 10:15:33 INFO - 'suite': 'dromaeojs', 10:15:33 INFO - 'system_bits': '32', 10:15:33 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 10:15:33 INFO - 'title': 'talos-linux64-ix-030', 10:15:33 INFO - 'tooltool_cache': '/builds/tooltool_cache', 10:15:33 INFO - 'use_talos_json': True, 10:15:33 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 10:15:33 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 10:15:33 INFO - 'work_dir': 'build'} 10:15:33 INFO - ##### 10:15:33 INFO - ##### Running clobber step. 10:15:33 INFO - ##### 10:15:33 INFO - Running pre-action listener: _resource_record_pre_action 10:15:33 INFO - Running main action method: clobber 10:15:33 INFO - rmtree: /builds/slave/test/build 10:15:34 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 10:15:34 INFO - Running post-action listener: _resource_record_post_action 10:15:34 INFO - ##### 10:15:34 INFO - ##### Running read-buildbot-config step. 10:15:34 INFO - ##### 10:15:34 INFO - Running pre-action listener: _resource_record_pre_action 10:15:34 INFO - Running main action method: read_buildbot_config 10:15:34 INFO - Using buildbot properties: 10:15:34 INFO - { 10:15:34 INFO - "project": "", 10:15:34 INFO - "product": "firefox", 10:15:34 INFO - "script_repo_revision": "production", 10:15:34 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs", 10:15:34 INFO - "repository": "", 10:15:34 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central pgo talos dromaeojs", 10:15:34 INFO - "buildid": "20160423073734", 10:15:34 INFO - "pgo_build": "True", 10:15:34 INFO - "basedir": "/builds/slave/test", 10:15:34 INFO - "buildnumber": 416, 10:15:34 INFO - "slavename": "talos-linux64-ix-030", 10:15:34 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 10:15:34 INFO - "platform": "ubuntu64_hw", 10:15:34 INFO - "scheduler": "tests-mozilla-central-linux64-pgo-talos", 10:15:34 INFO - "branch": "mozilla-central", 10:15:34 INFO - "repo_path": "mozilla-central", 10:15:34 INFO - "revision": "2be765b599b2d90103013526ef8ebe684b66b218", 10:15:34 INFO - "stage_platform": "linux64-pgo", 10:15:34 INFO - "builduid": "a812aa36b7c248e5849bad210b7b3205", 10:15:34 INFO - "slavebuilddir": "test" 10:15:34 INFO - } 10:15:34 INFO - Found installer url https://queue.taskcluster.net/v1/task/b0Xfub06QRuOOWFfunc99g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2. 10:15:34 INFO - Running post-action listener: _resource_record_post_action 10:15:34 INFO - ##### 10:15:34 INFO - ##### Running download-and-extract step. 10:15:34 INFO - ##### 10:15:34 INFO - Running pre-action listener: _resource_record_pre_action 10:15:34 INFO - Running main action method: download_and_extract 10:15:34 INFO - mkdir: /builds/slave/test/build/tests 10:15: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')]} 10:15:34 INFO - https://queue.taskcluster.net/v1/task/b0Xfub06QRuOOWFfunc99g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 10:15:34 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b0Xfub06QRuOOWFfunc99g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 10:15:34 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b0Xfub06QRuOOWFfunc99g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 10:15:34 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b0Xfub06QRuOOWFfunc99g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 10:15:34 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b0Xfub06QRuOOWFfunc99g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 10:15:46 INFO - Downloaded 1361 bytes. 10:15:46 INFO - Reading from file /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 10:15:46 INFO - Using the following test package requirements: 10:15:46 INFO - {u'common': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'], 10:15:46 INFO - u'cppunittest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 10:15:46 INFO - u'firefox-48.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 10:15:46 INFO - u'gtest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 10:15:46 INFO - u'firefox-48.0a1.en-US.linux-x86_64.gtest.tests.zip'], 10:15:46 INFO - u'jittest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 10:15:46 INFO - u'jsshell-linux-x86_64.zip'], 10:15:46 INFO - u'mochitest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 10:15:46 INFO - u'firefox-48.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 10:15:46 INFO - u'mozbase': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'], 10:15:46 INFO - u'reftest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 10:15:46 INFO - u'firefox-48.0a1.en-US.linux-x86_64.reftest.tests.zip'], 10:15:46 INFO - u'talos': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 10:15:46 INFO - u'firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'], 10:15:46 INFO - u'web-platform': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 10:15:46 INFO - u'firefox-48.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 10:15:46 INFO - u'xpcshell': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 10:15:46 INFO - u'firefox-48.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 10:15:46 INFO - Downloading packages: [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 10:15: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')]} 10:15:46 INFO - https://queue.taskcluster.net/v1/task/b0Xfub06QRuOOWFfunc99g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 10:15:46 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b0Xfub06QRuOOWFfunc99g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 10:15:46 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b0Xfub06QRuOOWFfunc99g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 10:15:46 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b0Xfub06QRuOOWFfunc99g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 10:15:46 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b0Xfub06QRuOOWFfunc99g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 10:15:52 INFO - Downloaded 23857933 bytes. 10:15:52 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 10:15:52 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 10:15:53 INFO - Return code: 0 10:15:53 INFO - Downloading packages: [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 10:15:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:15:53 INFO - https://queue.taskcluster.net/v1/task/b0Xfub06QRuOOWFfunc99g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 10:15:53 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b0Xfub06QRuOOWFfunc99g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 10:15:53 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b0Xfub06QRuOOWFfunc99g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 10:15:53 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b0Xfub06QRuOOWFfunc99g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 10:15:53 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b0Xfub06QRuOOWFfunc99g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 10:15:56 INFO - Downloaded 23857933 bytes. 10:15:56 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 10:15:56 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 10:15:57 INFO - Return code: 0 10:15:57 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')]} 10:15:57 INFO - https://queue.taskcluster.net/v1/task/b0Xfub06QRuOOWFfunc99g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 10:15:57 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b0Xfub06QRuOOWFfunc99g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 10:15:57 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b0Xfub06QRuOOWFfunc99g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 10:15:57 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b0Xfub06QRuOOWFfunc99g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 10:15:57 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b0Xfub06QRuOOWFfunc99g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 10:15:58 INFO - Downloaded 10840145 bytes. 10:15:58 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 10:15:58 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 10:15:58 INFO - Return code: 0 10:15:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:15:58 INFO - https://queue.taskcluster.net/v1/task/b0Xfub06QRuOOWFfunc99g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 10:15:58 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b0Xfub06QRuOOWFfunc99g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 10:15:58 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b0Xfub06QRuOOWFfunc99g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 10:15:58 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b0Xfub06QRuOOWFfunc99g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 10:15:58 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b0Xfub06QRuOOWFfunc99g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 10:16:00 INFO - Downloaded 58356255 bytes. 10:16:00 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/b0Xfub06QRuOOWFfunc99g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 10:16:00 INFO - mkdir: /builds/slave/test/properties 10:16:00 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 10:16:00 INFO - Writing to file /builds/slave/test/properties/build_url 10:16:00 INFO - Contents: 10:16:00 INFO - build_url:https://queue.taskcluster.net/v1/task/b0Xfub06QRuOOWFfunc99g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 10:16:01 INFO - Running post-action listener: _resource_record_post_action 10:16:01 INFO - Running post-action listener: set_extra_try_arguments 10:16:01 INFO - ##### 10:16:01 INFO - ##### Running populate-webroot step. 10:16:01 INFO - ##### 10:16:01 INFO - Running pre-action listener: _resource_record_pre_action 10:16:01 INFO - Running main action method: populate_webroot 10:16:01 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 10:16:01 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 10:16:01 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 10:16:01 INFO - '--tppagecycles', 10:16:01 INFO - '7'], 10:16:01 INFO - 'tests': ['tsvgm']}}, 10:16:01 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 10:16:01 INFO - 'tests': ['tresize', 'tcanvasmark']}, 10:16:01 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 10:16:01 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 10:16:01 INFO - 'tests': ['dromaeo_css', 'kraken']}, 10:16:01 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 10:16:01 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:16:01 INFO - 'talos_options': ['--disable-e10s'], 10:16:01 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 10:16:01 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:16:01 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 10:16:01 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:16:01 INFO - 'talos_options': ['--disable-e10s'], 10:16:01 INFO - 'tests': ['damp', 'tps']}, 10:16:01 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:16:01 INFO - 'tests': ['damp', 'tps']}, 10:16:01 INFO - 'g3': {'talos_options': ['--disable-e10s'], 10:16:01 INFO - 'tests': ['dromaeo_dom']}, 10:16:01 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 10:16:01 INFO - 'other': {'talos_options': ['--disable-e10s'], 10:16:01 INFO - 'tests': ['a11yr', 10:16:01 INFO - 'ts_paint', 10:16:01 INFO - 'tpaint', 10:16:01 INFO - 'sessionrestore', 10:16:01 INFO - 'sessionrestore_no_auto_restore', 10:16:01 INFO - 'tabpaint']}, 10:16:01 INFO - 'other-e10s': {'tests': ['a11yr', 10:16:01 INFO - 'ts_paint', 10:16:01 INFO - 'tpaint', 10:16:01 INFO - 'sessionrestore', 10:16:01 INFO - 'sessionrestore_no_auto_restore', 10:16:01 INFO - 'tabpaint']}, 10:16:01 INFO - 'other-e10s_l64': {'tests': ['a11yr', 10:16:01 INFO - 'ts_paint', 10:16:01 INFO - 'tpaint', 10:16:01 INFO - 'sessionrestore', 10:16:01 INFO - 'sessionrestore_no_auto_restore', 10:16:01 INFO - 'tabpaint']}, 10:16:01 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 10:16:01 INFO - 'ts_paint', 10:16:01 INFO - 'tpaint', 10:16:01 INFO - 'sessionrestore', 10:16:01 INFO - 'sessionrestore_no_auto_restore', 10:16:01 INFO - 'tabpaint']}, 10:16:01 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 10:16:01 INFO - 'tests': ['a11yr', 10:16:01 INFO - 'ts_paint', 10:16:01 INFO - 'tpaint', 10:16:01 INFO - 'sessionrestore', 10:16:01 INFO - 'sessionrestore_no_auto_restore', 10:16:01 INFO - 'tabpaint']}, 10:16:01 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 10:16:01 INFO - 'tests': ['a11yr', 10:16:01 INFO - 'ts_paint', 10:16:01 INFO - 'tpaint', 10:16:01 INFO - 'sessionrestore', 10:16:01 INFO - 'sessionrestore_no_auto_restore', 10:16:01 INFO - 'tabpaint']}, 10:16:01 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 10:16:01 INFO - 'tests': ['tsvgx', 10:16:01 INFO - 'tsvgr_opacity', 10:16:01 INFO - 'tart', 10:16:01 INFO - 'tscrollx', 10:16:01 INFO - 'cart']}, 10:16:01 INFO - 'svgr-e10s': {'tests': ['tsvgx', 10:16:01 INFO - 'tsvgr_opacity', 10:16:01 INFO - 'tart', 10:16:01 INFO - 'tscrollx', 10:16:01 INFO - 'cart']}, 10:16:01 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:16:01 INFO - 'talos_options': ['--disable-e10s'], 10:16:01 INFO - 'tests': ['tp5o']}, 10:16:01 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:16:01 INFO - 'tests': ['tp5o']}, 10:16:01 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:16:01 INFO - 'talos_options': ['--disable-e10s', 10:16:01 INFO - '--xperf_path', 10:16:01 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 10:16:01 INFO - 'tests': ['tp5n']}, 10:16:01 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:16:01 INFO - 'talos_options': ['--xperf_path', 10:16:01 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 10:16:01 INFO - 'tests': ['tp5n']}}, 10:16:01 INFO - 'talos.zip': {'path': '', 10:16:01 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 10:16:01 INFO - Running post-action listener: _resource_record_post_action 10:16:01 INFO - ##### 10:16:01 INFO - ##### Running create-virtualenv step. 10:16:01 INFO - ##### 10:16:01 INFO - Running pre-action listener: _resource_record_pre_action 10:16:01 INFO - Running main action method: create_virtualenv 10:16:01 INFO - Creating virtualenv /builds/slave/test/build/venv 10:16:01 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 10:16:01 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 10:16:01 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 10:16:01 INFO - Using real prefix '/usr' 10:16:01 INFO - New python executable in /builds/slave/test/build/venv/bin/python 10:16:01 INFO - Installing distribute.............................................................................................................................................................................................done. 10:16:04 INFO - Installing pip.................done. 10:16:04 INFO - Return code: 0 10:16:04 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 10:16:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:16:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:16:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:16:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:16:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:16:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:16:04 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 0x7f2ddf90ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x149b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15669a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15f5810>, '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 0x15f6710>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15f6ba0>, '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': '4ac8d263c7293b36a1be1aed000001be-1461426355.958197-518667313', '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 10:16:04 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 10:16:04 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 10:16:04 INFO - Using env: {'DISPLAY': ':0', 10:16:04 INFO - 'HOME': '/home/cltbld', 10:16:04 INFO - 'LANG': 'en_US.UTF-8', 10:16:04 INFO - 'LANGUAGE': 'en_US:en', 10:16:04 INFO - 'LOGNAME': 'cltbld', 10:16:04 INFO - 'MAIL': '/var/mail/cltbld', 10:16:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:16:04 INFO - 'MOZ_NO_REMOTE': '1', 10:16:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:16:04 INFO - 'NO_EM_RESTART': '1', 10:16:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:16:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:16:04 INFO - 'PWD': '/builds/slave/test', 10:16:04 INFO - 'SHELL': '/bin/bash', 10:16:04 INFO - 'SHLVL': '1', 10:16:04 INFO - 'TERM': 'linux', 10:16:04 INFO - 'TMOUT': '86400', 10:16:04 INFO - 'USER': 'cltbld', 10:16:04 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1461426355.958197-518667313', 10:16:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:16:04 INFO - '_': '/tools/buildbot/bin/python'} 10:16:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:16:04 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 10:16:04 INFO - Cleaning up... 10:16:04 INFO - Return code: 0 10:16:04 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 10:16:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:16:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:16:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:16:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:16:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:16:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:16:04 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 0x7f2ddf90ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x149b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15669a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15f5810>, '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 0x15f6710>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15f6ba0>, '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': '4ac8d263c7293b36a1be1aed000001be-1461426355.958197-518667313', '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 10:16:04 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 10:16:04 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 10:16:04 INFO - Using env: {'DISPLAY': ':0', 10:16:04 INFO - 'HOME': '/home/cltbld', 10:16:04 INFO - 'LANG': 'en_US.UTF-8', 10:16:04 INFO - 'LANGUAGE': 'en_US:en', 10:16:04 INFO - 'LOGNAME': 'cltbld', 10:16:04 INFO - 'MAIL': '/var/mail/cltbld', 10:16:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:16:04 INFO - 'MOZ_NO_REMOTE': '1', 10:16:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:16:04 INFO - 'NO_EM_RESTART': '1', 10:16:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:16:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:16:04 INFO - 'PWD': '/builds/slave/test', 10:16:04 INFO - 'SHELL': '/bin/bash', 10:16:04 INFO - 'SHLVL': '1', 10:16:04 INFO - 'TERM': 'linux', 10:16:04 INFO - 'TMOUT': '86400', 10:16:04 INFO - 'USER': 'cltbld', 10:16:04 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1461426355.958197-518667313', 10:16:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:16:04 INFO - '_': '/tools/buildbot/bin/python'} 10:16:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:16:04 INFO - Downloading/unpacking psutil>=0.7.1 10:16:04 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:16:04 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:16:04 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:16:04 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:16:04 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:16:04 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:16:06 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 10:16:06 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 10:16:06 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 10:16:06 INFO - Installing collected packages: psutil 10:16:06 INFO - Running setup.py install for psutil 10:16:06 INFO - building 'psutil._psutil_linux' extension 10:16:06 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 10:16:06 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 10:16:06 INFO - building 'psutil._psutil_posix' extension 10:16:06 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 10:16:06 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 10:16:07 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 10:16:07 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 10:16:07 INFO - Successfully installed psutil 10:16:07 INFO - Cleaning up... 10:16:07 INFO - Return code: 0 10:16:07 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 10:16:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:16:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:16:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:16:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:16:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:16:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:16:07 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 0x7f2ddf90ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x149b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15669a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15f5810>, '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 0x15f6710>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15f6ba0>, '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': '4ac8d263c7293b36a1be1aed000001be-1461426355.958197-518667313', '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 10:16:07 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 10:16:07 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 10:16:07 INFO - Using env: {'DISPLAY': ':0', 10:16:07 INFO - 'HOME': '/home/cltbld', 10:16:07 INFO - 'LANG': 'en_US.UTF-8', 10:16:07 INFO - 'LANGUAGE': 'en_US:en', 10:16:07 INFO - 'LOGNAME': 'cltbld', 10:16:07 INFO - 'MAIL': '/var/mail/cltbld', 10:16:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:16:07 INFO - 'MOZ_NO_REMOTE': '1', 10:16:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:16:07 INFO - 'NO_EM_RESTART': '1', 10:16:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:16:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:16:07 INFO - 'PWD': '/builds/slave/test', 10:16:07 INFO - 'SHELL': '/bin/bash', 10:16:07 INFO - 'SHLVL': '1', 10:16:07 INFO - 'TERM': 'linux', 10:16:07 INFO - 'TMOUT': '86400', 10:16:07 INFO - 'USER': 'cltbld', 10:16:07 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1461426355.958197-518667313', 10:16:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:16:07 INFO - '_': '/tools/buildbot/bin/python'} 10:16:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:16:07 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 10:16:07 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 10:16:07 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 10:16:07 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 10:16:07 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 10:16:07 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 10:16:07 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 10:16:09 INFO - Downloading mozsystemmonitor-0.0.tar.gz 10:16:09 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 10:16:09 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 10:16:09 INFO - Installing collected packages: mozsystemmonitor 10:16:09 INFO - Running setup.py install for mozsystemmonitor 10:16:09 INFO - Successfully installed mozsystemmonitor 10:16:09 INFO - Cleaning up... 10:16:10 INFO - Return code: 0 10:16:10 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 10:16:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:16:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:16:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:16:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:16:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:16:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:16:10 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 0x7f2ddf90ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x149b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15669a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15f5810>, '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 0x15f6710>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15f6ba0>, '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': '4ac8d263c7293b36a1be1aed000001be-1461426355.958197-518667313', '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 10:16:10 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 10:16:10 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 10:16:10 INFO - Using env: {'DISPLAY': ':0', 10:16:10 INFO - 'HOME': '/home/cltbld', 10:16:10 INFO - 'LANG': 'en_US.UTF-8', 10:16:10 INFO - 'LANGUAGE': 'en_US:en', 10:16:10 INFO - 'LOGNAME': 'cltbld', 10:16:10 INFO - 'MAIL': '/var/mail/cltbld', 10:16:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:16:10 INFO - 'MOZ_NO_REMOTE': '1', 10:16:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:16:10 INFO - 'NO_EM_RESTART': '1', 10:16:10 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:16:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:16:10 INFO - 'PWD': '/builds/slave/test', 10:16:10 INFO - 'SHELL': '/bin/bash', 10:16:10 INFO - 'SHLVL': '1', 10:16:10 INFO - 'TERM': 'linux', 10:16:10 INFO - 'TMOUT': '86400', 10:16:10 INFO - 'USER': 'cltbld', 10:16:10 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1461426355.958197-518667313', 10:16:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:16:10 INFO - '_': '/tools/buildbot/bin/python'} 10:16:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:16:10 INFO - Downloading/unpacking blobuploader==1.2.4 10:16:10 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 10:16:10 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 10:16:10 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 10:16:10 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 10:16:10 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 10:16:10 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 10:16:12 INFO - Downloading blobuploader-1.2.4.tar.gz 10:16:12 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 10:16:12 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 10:16:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:16:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:16:12 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:16:12 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:16:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:16:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:16:12 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 10:16:12 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 10:16:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:16:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:16:12 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:16:12 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:16:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:16:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:16:12 INFO - Downloading docopt-0.6.1.tar.gz 10:16:12 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 10:16:12 INFO - Installing collected packages: blobuploader, requests, docopt 10:16:12 INFO - Running setup.py install for blobuploader 10:16:13 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 10:16:13 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 10:16:13 INFO - Running setup.py install for requests 10:16:13 INFO - Running setup.py install for docopt 10:16:13 INFO - Successfully installed blobuploader requests docopt 10:16:13 INFO - Cleaning up... 10:16:13 INFO - Return code: 0 10:16:13 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:16:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:16:13 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:16:13 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:16:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:16:13 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:16:13 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:16:13 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 0x7f2ddf90ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x149b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15669a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15f5810>, '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 0x15f6710>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15f6ba0>, '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': '4ac8d263c7293b36a1be1aed000001be-1461426355.958197-518667313', '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 10:16:13 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 10:16:13 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 10:16:13 INFO - Using env: {'DISPLAY': ':0', 10:16:13 INFO - 'HOME': '/home/cltbld', 10:16:13 INFO - 'LANG': 'en_US.UTF-8', 10:16:13 INFO - 'LANGUAGE': 'en_US:en', 10:16:13 INFO - 'LOGNAME': 'cltbld', 10:16:13 INFO - 'MAIL': '/var/mail/cltbld', 10:16:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:16:13 INFO - 'MOZ_NO_REMOTE': '1', 10:16:13 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:16:13 INFO - 'NO_EM_RESTART': '1', 10:16:13 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:16:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:16:13 INFO - 'PWD': '/builds/slave/test', 10:16:13 INFO - 'SHELL': '/bin/bash', 10:16:13 INFO - 'SHLVL': '1', 10:16:13 INFO - 'TERM': 'linux', 10:16:13 INFO - 'TMOUT': '86400', 10:16:13 INFO - 'USER': 'cltbld', 10:16:13 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1461426355.958197-518667313', 10:16:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:16:13 INFO - '_': '/tools/buildbot/bin/python'} 10:16:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:16:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 10:16:13 INFO - Running setup.py (path:/tmp/pip-8SSLhp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 10:16:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 10:16:13 INFO - Running setup.py (path:/tmp/pip-BffLjG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 10:16:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 10:16:13 INFO - Running setup.py (path:/tmp/pip-yDasg2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 10:16:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 10:16:14 INFO - Running setup.py (path:/tmp/pip-go9xkQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 10:16:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 10:16:14 INFO - Running setup.py (path:/tmp/pip-L4nC1D-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 10:16:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 10:16:14 INFO - Running setup.py (path:/tmp/pip-tIxKl5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 10:16:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 10:16:14 INFO - Running setup.py (path:/tmp/pip-4JO3yT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 10:16:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 10:16:14 INFO - Running setup.py (path:/tmp/pip-c2RMDi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 10:16:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 10:16:14 INFO - Running setup.py (path:/tmp/pip-C7ROO5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 10:16:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 10:16:14 INFO - Running setup.py (path:/tmp/pip-rrrO7J-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 10:16:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 10:16:14 INFO - Running setup.py (path:/tmp/pip-VQgrsl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 10:16:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 10:16:14 INFO - Running setup.py (path:/tmp/pip-A59wxg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 10:16:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 10:16:14 INFO - Running setup.py (path:/tmp/pip-HxSveZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 10:16:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 10:16:14 INFO - Running setup.py (path:/tmp/pip-w49ywB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 10:16:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 10:16:14 INFO - Running setup.py (path:/tmp/pip-s09Uq5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 10:16:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 10:16:14 INFO - Running setup.py (path:/tmp/pip-ihh9JG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 10:16:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 10:16:14 INFO - Running setup.py (path:/tmp/pip-RnCa8L-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 10:16:15 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 10:16:15 INFO - Running setup.py install for manifestparser 10:16:15 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 10:16:15 INFO - Running setup.py install for mozcrash 10:16:15 INFO - Running setup.py install for mozdebug 10:16:15 INFO - Running setup.py install for mozdevice 10:16:15 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 10:16:15 INFO - Installing dm script to /builds/slave/test/build/venv/bin 10:16:15 INFO - Running setup.py install for mozfile 10:16:15 INFO - Running setup.py install for mozhttpd 10:16:15 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 10:16:15 INFO - Running setup.py install for mozinfo 10:16:15 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 10:16:15 INFO - Running setup.py install for mozInstall 10:16:15 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 10:16:15 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 10:16:15 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 10:16:15 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 10:16:15 INFO - Running setup.py install for mozleak 10:16:15 INFO - Running setup.py install for mozlog 10:16:16 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 10:16:16 INFO - Running setup.py install for moznetwork 10:16:16 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 10:16:16 INFO - Running setup.py install for mozprocess 10:16:16 INFO - Running setup.py install for mozprofile 10:16:16 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 10:16:16 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 10:16:16 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 10:16:16 INFO - Running setup.py install for mozrunner 10:16:16 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 10:16:16 INFO - Running setup.py install for mozscreenshot 10:16:16 INFO - Running setup.py install for moztest 10:16:16 INFO - Running setup.py install for mozversion 10:16:16 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 10:16:16 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 10:16:16 INFO - Cleaning up... 10:16:16 INFO - Return code: 0 10:16:16 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:16:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:16:16 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:16:16 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:16:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:16:16 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:16:16 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:16:16 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 0x7f2ddf90ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x149b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15669a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15f5810>, '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 0x15f6710>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15f6ba0>, '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': '4ac8d263c7293b36a1be1aed000001be-1461426355.958197-518667313', '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 10:16:16 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 10:16:16 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 10:16:16 INFO - Using env: {'DISPLAY': ':0', 10:16:16 INFO - 'HOME': '/home/cltbld', 10:16:16 INFO - 'LANG': 'en_US.UTF-8', 10:16:16 INFO - 'LANGUAGE': 'en_US:en', 10:16:16 INFO - 'LOGNAME': 'cltbld', 10:16:16 INFO - 'MAIL': '/var/mail/cltbld', 10:16:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:16:16 INFO - 'MOZ_NO_REMOTE': '1', 10:16:16 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:16:16 INFO - 'NO_EM_RESTART': '1', 10:16:16 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:16:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:16:16 INFO - 'PWD': '/builds/slave/test', 10:16:16 INFO - 'SHELL': '/bin/bash', 10:16:16 INFO - 'SHLVL': '1', 10:16:16 INFO - 'TERM': 'linux', 10:16:16 INFO - 'TMOUT': '86400', 10:16:16 INFO - 'USER': 'cltbld', 10:16:16 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1461426355.958197-518667313', 10:16:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:16:16 INFO - '_': '/tools/buildbot/bin/python'} 10:16:16 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:16:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 10:16:17 INFO - Running setup.py (path:/tmp/pip-PLj0VA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 10:16:17 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)) 10:16:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 10:16:17 INFO - Running setup.py (path:/tmp/pip-nXo7cr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 10:16:17 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)) 10:16:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 10:16:17 INFO - Running setup.py (path:/tmp/pip-JvVl7o-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 10:16:17 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)) 10:16:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 10:16:17 INFO - Running setup.py (path:/tmp/pip-kbnrhi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 10:16:17 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)) 10:16:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 10:16:17 INFO - Running setup.py (path:/tmp/pip-hSYlvz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 10:16:17 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)) 10:16:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 10:16:17 INFO - Running setup.py (path:/tmp/pip-KAYuOy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 10:16:17 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)) 10:16:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 10:16:17 INFO - Running setup.py (path:/tmp/pip-UcPVJh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 10:16:17 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)) 10:16:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 10:16:17 INFO - Running setup.py (path:/tmp/pip-rAVcA9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 10:16:17 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)) 10:16:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 10:16:17 INFO - Running setup.py (path:/tmp/pip-ZRTh8Q-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 10:16:17 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)) 10:16:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 10:16:17 INFO - Running setup.py (path:/tmp/pip-suNR9L-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 10:16:17 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)) 10:16:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 10:16:17 INFO - Running setup.py (path:/tmp/pip-KMlooH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 10:16:17 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)) 10:16:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 10:16:17 INFO - Running setup.py (path:/tmp/pip-PrRuNw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 10:16:17 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)) 10:16:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 10:16:17 INFO - Running setup.py (path:/tmp/pip-7cdzro-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 10:16:17 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)) 10:16:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 10:16:17 INFO - Running setup.py (path:/tmp/pip-N74Vac-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 10:16:18 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)) 10:16:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 10:16:18 INFO - Running setup.py (path:/tmp/pip-RLmJTG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 10:16:18 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)) 10:16:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 10:16:18 INFO - Running setup.py (path:/tmp/pip-SKeStf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 10:16:18 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)) 10:16:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 10:16:18 INFO - Running setup.py (path:/tmp/pip-LoLTGw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 10:16:18 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)) 10:16:18 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)) 10:16:18 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)) 10:16:18 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)) 10:16:18 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)) 10:16:18 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)) 10:16:18 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 10:16:18 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:16:18 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:16:18 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:16:18 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:16:18 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:16:18 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:16:20 INFO - Downloading blessings-1.6.tar.gz 10:16:20 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 10:16:20 INFO - Installing collected packages: blessings 10:16:20 INFO - Running setup.py install for blessings 10:16:20 INFO - Successfully installed blessings 10:16:20 INFO - Cleaning up... 10:16:20 INFO - Return code: 0 10:16:20 INFO - Done creating virtualenv /builds/slave/test/build/venv. 10:16:20 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 10:16:20 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 10:16:20 INFO - Reading from file tmpfile_stdout 10:16:20 INFO - Current package versions: 10:16:20 INFO - argparse == 1.2.1 10:16:20 INFO - blessings == 1.6 10:16:20 INFO - blobuploader == 1.2.4 10:16:20 INFO - docopt == 0.6.1 10:16:20 INFO - manifestparser == 1.1 10:16:20 INFO - mozInstall == 1.12 10:16:20 INFO - mozcrash == 0.17 10:16:20 INFO - mozdebug == 0.1 10:16:20 INFO - mozdevice == 0.48 10:16:20 INFO - mozfile == 1.2 10:16:20 INFO - mozhttpd == 0.7 10:16:20 INFO - mozinfo == 0.9 10:16:20 INFO - mozleak == 0.1 10:16:20 INFO - mozlog == 3.1 10:16:20 INFO - moznetwork == 0.27 10:16:20 INFO - mozprocess == 0.22 10:16:20 INFO - mozprofile == 0.28 10:16:20 INFO - mozrunner == 6.11 10:16:20 INFO - mozscreenshot == 0.1 10:16:20 INFO - mozsystemmonitor == 0.0 10:16:20 INFO - moztest == 0.7 10:16:20 INFO - mozversion == 1.4 10:16:20 INFO - psutil == 3.1.1 10:16:20 INFO - requests == 1.2.3 10:16:20 INFO - wsgiref == 0.1.2 10:16:20 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:16: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')]} 10:16:20 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:16:20 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:16: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')]} 10:16:20 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:16:20 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:16:20 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 0x7f2ddf90ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x149b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15669a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15f5810>, '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 0x15f6710>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15f6ba0>, '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': '4ac8d263c7293b36a1be1aed000001be-1461426355.958197-518667313', '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 10:16:20 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 10:16:20 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 10:16:20 INFO - Using env: {'DISPLAY': ':0', 10:16:20 INFO - 'HOME': '/home/cltbld', 10:16:20 INFO - 'LANG': 'en_US.UTF-8', 10:16:20 INFO - 'LANGUAGE': 'en_US:en', 10:16:20 INFO - 'LOGNAME': 'cltbld', 10:16:20 INFO - 'MAIL': '/var/mail/cltbld', 10:16:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:16:20 INFO - 'MOZ_NO_REMOTE': '1', 10:16:20 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:16:20 INFO - 'NO_EM_RESTART': '1', 10:16:20 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:16:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:16:20 INFO - 'PWD': '/builds/slave/test', 10:16:20 INFO - 'SHELL': '/bin/bash', 10:16:20 INFO - 'SHLVL': '1', 10:16:20 INFO - 'TERM': 'linux', 10:16:20 INFO - 'TMOUT': '86400', 10:16:20 INFO - 'USER': 'cltbld', 10:16:20 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1461426355.958197-518667313', 10:16:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:16:20 INFO - '_': '/tools/buildbot/bin/python'} 10:16:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:16:20 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)) 10:16:20 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)) 10:16:20 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)) 10:16:20 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)) 10:16:20 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)) 10:16:20 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)) 10:16:20 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)) 10:16:20 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)) 10:16:20 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)) 10:16:20 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)) 10:16:20 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)) 10:16:20 INFO - Cleaning up... 10:16:20 INFO - Return code: 0 10:16:20 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 10:16: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')]} 10:16:20 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:16:20 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:16: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')]} 10:16:20 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:16:20 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:16:20 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f2ddf90ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x149b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15669a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15f5810>, '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 0x15f6710>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15f6ba0>, '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': '4ac8d263c7293b36a1be1aed000001be-1461426355.958197-518667313', '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 10:16:20 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 10:16:20 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 10:16:20 INFO - Using env: {'DISPLAY': ':0', 10:16:20 INFO - 'HOME': '/home/cltbld', 10:16:20 INFO - 'LANG': 'en_US.UTF-8', 10:16:20 INFO - 'LANGUAGE': 'en_US:en', 10:16:20 INFO - 'LOGNAME': 'cltbld', 10:16:20 INFO - 'MAIL': '/var/mail/cltbld', 10:16:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:16:20 INFO - 'MOZ_NO_REMOTE': '1', 10:16:20 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:16:20 INFO - 'NO_EM_RESTART': '1', 10:16:20 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:16:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:16:20 INFO - 'PWD': '/builds/slave/test', 10:16:20 INFO - 'SHELL': '/bin/bash', 10:16:20 INFO - 'SHLVL': '1', 10:16:20 INFO - 'TERM': 'linux', 10:16:20 INFO - 'TMOUT': '86400', 10:16:20 INFO - 'USER': 'cltbld', 10:16:20 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1461426355.958197-518667313', 10:16:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:16:20 INFO - '_': '/tools/buildbot/bin/python'} 10:16:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:16:21 INFO - Downloading/unpacking jsonschema 10:16:21 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 10:16:21 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 10:16:21 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 10:16:21 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 10:16:21 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 10:16:21 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 10:16:22 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 10:16:22 INFO - Downloading/unpacking functools32 (from jsonschema) 10:16:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:16:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:16:22 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:16:22 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:16:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:16:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:16:23 INFO - Downloading functools32-3.2.3-2.tar.gz 10:16:23 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 10:16:23 INFO - warning: no files found matching '*.txt' 10:16:23 INFO - no previously-included directories found matching 'build' 10:16:23 INFO - no previously-included directories found matching 'dist' 10:16:23 INFO - no previously-included directories found matching '.git*' 10:16:23 INFO - Installing collected packages: jsonschema, functools32 10:16:23 INFO - Running setup.py install for functools32 10:16:23 INFO - warning: no files found matching '*.txt' 10:16:23 INFO - no previously-included directories found matching 'build' 10:16:23 INFO - no previously-included directories found matching 'dist' 10:16:23 INFO - no previously-included directories found matching '.git*' 10:16:23 INFO - Successfully installed jsonschema functools32 10:16:23 INFO - Cleaning up... 10:16:23 INFO - Return code: 0 10:16:23 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 10:16:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:16:23 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:16:23 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:16:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:16:23 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:16:23 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:16:23 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 0x7f2ddf90ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x149b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15669a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15f5810>, '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 0x15f6710>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15f6ba0>, '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': '4ac8d263c7293b36a1be1aed000001be-1461426355.958197-518667313', '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 10:16:23 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 10:16:23 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 10:16:23 INFO - Using env: {'DISPLAY': ':0', 10:16:23 INFO - 'HOME': '/home/cltbld', 10:16:23 INFO - 'LANG': 'en_US.UTF-8', 10:16:23 INFO - 'LANGUAGE': 'en_US:en', 10:16:23 INFO - 'LOGNAME': 'cltbld', 10:16:23 INFO - 'MAIL': '/var/mail/cltbld', 10:16:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:16:23 INFO - 'MOZ_NO_REMOTE': '1', 10:16:23 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:16:23 INFO - 'NO_EM_RESTART': '1', 10:16:23 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:16:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:16:23 INFO - 'PWD': '/builds/slave/test', 10:16:23 INFO - 'SHELL': '/bin/bash', 10:16:23 INFO - 'SHLVL': '1', 10:16:23 INFO - 'TERM': 'linux', 10:16:23 INFO - 'TMOUT': '86400', 10:16:23 INFO - 'USER': 'cltbld', 10:16:23 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1461426355.958197-518667313', 10:16:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:16:23 INFO - '_': '/tools/buildbot/bin/python'} 10:16:23 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:16:23 INFO - Downloading/unpacking flake8 10:16:23 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 10:16:23 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 10:16:23 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 10:16:23 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 10:16:23 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 10:16:23 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 10:16:25 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 10:16:25 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 10:16:25 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 10:16:25 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 10:16:25 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 10:16:25 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 10:16:25 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 10:16:25 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 10:16:25 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 10:16:25 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 10:16:25 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 10:16:25 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 10:16:25 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 10:16:25 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 10:16:25 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 10:16:25 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 10:16:25 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 10:16:25 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 10:16:25 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 10:16:25 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 10:16:25 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 10:16:25 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 10:16:25 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 10:16:26 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 10:16:26 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 10:16:26 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 10:16:26 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 10:16:26 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 10:16:26 INFO - no previously-included directories found matching 'docs/_build' 10:16:26 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 10:16:26 INFO - Running setup.py install for pep8 10:16:26 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 10:16:26 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 10:16:26 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 10:16:26 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 10:16:26 INFO - no previously-included directories found matching 'docs/_build' 10:16:26 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 10:16:26 INFO - Successfully installed flake8 mccabe pyflakes pep8 10:16:26 INFO - Cleaning up... 10:16:26 INFO - Return code: 0 10:16:26 INFO - Running post-action listener: _resource_record_post_action 10:16:26 INFO - Running post-action listener: _start_resource_monitoring 10:16:26 INFO - Starting resource monitoring. 10:16:26 INFO - ##### 10:16:26 INFO - ##### Running install step. 10:16:26 INFO - ##### 10:16:26 INFO - Running pre-action listener: _resource_record_pre_action 10:16:26 INFO - Running main action method: install 10:16:26 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 10:16:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 10:16:26 INFO - Reading from file tmpfile_stdout 10:16:26 INFO - Detecting whether we're running mozinstall >=1.0... 10:16:26 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 10:16:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 10:16:26 INFO - Reading from file tmpfile_stdout 10:16:26 INFO - Output received: 10:16:26 INFO - Usage: mozinstall [options] installer 10:16:26 INFO - Options: 10:16:26 INFO - -h, --help show this help message and exit 10:16:26 INFO - -d DEST, --destination=DEST 10:16:26 INFO - Directory to install application into. [default: 10:16:26 INFO - "/builds/slave/test"] 10:16:26 INFO - --app=APP Application being installed. [default: firefox] 10:16:26 INFO - mkdir: /builds/slave/test/build/application 10:16:26 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 10:16:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 10:16:43 INFO - Reading from file tmpfile_stdout 10:16:43 INFO - Output received: 10:16:43 INFO - /builds/slave/test/build/application/firefox/firefox 10:16:43 INFO - Running post-action listener: _resource_record_post_action 10:16:43 INFO - ##### 10:16:43 INFO - ##### Running run-tests step. 10:16:43 INFO - ##### 10:16:43 INFO - Running pre-action listener: _resource_record_pre_action 10:16:43 INFO - Running main action method: run_tests 10:16:43 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 10:16:43 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 10:16:43 INFO - Python 2.7.3 10:16:43 INFO - Return code: 0 10:16:43 INFO - grabbing minidump binary from tooltool 10:16:43 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')]} 10:16:43 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 0x15f5810>, '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 0x15f6710>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15f6ba0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 10:16:43 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 10:16:43 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 10:16:43 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 10:16:43 INFO - Return code: 0 10:16:43 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 10:16:43 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 10:16:43 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 10:16:43 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 10:16:43 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 10:16:43 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 10:16:43 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 10:16:44 INFO - Return code: 0 10:16:44 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/b0Xfub06QRuOOWFfunc99g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-030', '--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 10:16:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/b0Xfub06QRuOOWFfunc99g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-030 --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 10:16:44 INFO - Using env: {'DISPLAY': ':0', 10:16:44 INFO - 'HOME': '/home/cltbld', 10:16:44 INFO - 'LANG': 'en_US.UTF-8', 10:16:44 INFO - 'LANGUAGE': 'en_US:en', 10:16:44 INFO - 'LOGNAME': 'cltbld', 10:16:44 INFO - 'MAIL': '/var/mail/cltbld', 10:16:44 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 10:16:44 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 10:16:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:16:44 INFO - 'MOZ_NO_REMOTE': '1', 10:16:44 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 10:16:44 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:16:44 INFO - 'NO_EM_RESTART': '1', 10:16:44 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:16:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:16:44 INFO - 'PWD': '/builds/slave/test', 10:16:44 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 10:16:44 INFO - 'SHELL': '/bin/bash', 10:16:44 INFO - 'SHLVL': '1', 10:16:44 INFO - 'TERM': 'linux', 10:16:44 INFO - 'TMOUT': '86400', 10:16:44 INFO - 'USER': 'cltbld', 10:16:44 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1461426355.958197-518667313', 10:16:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:16:44 INFO - '_': '/tools/buildbot/bin/python'} 10:16:44 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/b0Xfub06QRuOOWFfunc99g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-030', '--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 10:16:44 INFO - mozversion application_buildid: 20160423073734 10:16:44 INFO - mozversion application_changeset: 2be765b599b2d90103013526ef8ebe684b66b218 10:16:44 INFO - mozversion application_display_name: Nightly 10:16:44 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 10:16:44 INFO - mozversion application_name: Firefox 10:16:44 INFO - mozversion application_remotingname: firefox 10:16:44 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 10:16:44 INFO - mozversion application_vendor: Mozilla 10:16:44 INFO - mozversion application_version: 48.0a1 10:16:44 INFO - mozversion platform_buildid: 20160423073734 10:16:44 INFO - mozversion platform_changeset: 2be765b599b2d90103013526ef8ebe684b66b218 10:16:44 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 10:16:44 INFO - mozversion platform_version: 48.0a1 10:16:44 INFO - using testdate: 1461431804 10:16:44 INFO - actual date: 1461431804 10:16:44 INFO - starting webserver on 'localhost:58583' 10:16:44 INFO - SUITE-START | Running 2 tests 10:16:44 INFO - TEST-START | dromaeo_css 10:16:44 INFO - operating with platform_type : linux_ 10:16:44 INFO - Initialising browser for dromaeo_css test... 10:16:44 INFO - TEST-INFO | started process 5394 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpdKrLEZ/profile http://localhost:58583/getInfo.html) 10:16:48 INFO - PROCESS | 5394 | __metrics Screen width/height:1600/1200 10:16:48 INFO - PROCESS | 5394 | colorDepth:24 10:16:48 INFO - PROCESS | 5394 | Browser inner width/height: 1024/697 10:16:48 INFO - PROCESS | 5394 | __metrics 10:16:50 ERROR - PROCESS | 5394 | JavaScript error: resource://app/modules/AboutNewTab.jsm, line 36: TypeError: this.pageListener is null 10:16:51 INFO - TEST-INFO | 5394: exit 0 10:16:51 INFO - Browser initialized. 10:16:51 INFO - Running cycle 1/1 for dromaeo_css test... 10:16:51 INFO - TEST-INFO | started process 5478 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpdKrLEZ/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 10:17:02 INFO - PROCESS | 5478 | RSS: Main: 154058752 10:17:02 INFO - PROCESS | 5478 | 10:17:53 INFO - PROCESS | 5478 | 1461431873924 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] 10:20:01 INFO - PROCESS | 5478 | Cycle 1(1): loaded http://localhost:58583/tests/dromaeo/cssquery-dojo.html (next: http://localhost:58583/tests/dromaeo/cssquery-ext.html) 10:20:02 INFO - PROCESS | 5478 | RSS: Main: 252575744 10:20:02 INFO - PROCESS | 5478 | 10:23:04 INFO - PROCESS | 5478 | Cycle 1(1): loaded http://localhost:58583/tests/dromaeo/cssquery-ext.html (next: http://localhost:58583/tests/dromaeo/cssquery-jquery.html) 10:23:05 INFO - PROCESS | 5478 | RSS: Main: 238292992 10:23:05 INFO - PROCESS | 5478 | 10:26:07 INFO - PROCESS | 5478 | Cycle 1(1): loaded http://localhost:58583/tests/dromaeo/cssquery-jquery.html (next: http://localhost:58583/tests/dromaeo/cssquery-mootools.html) 10:26:07 INFO - PROCESS | 5478 | RSS: Main: 237260800 10:26:07 INFO - PROCESS | 5478 | 10:29:09 INFO - PROCESS | 5478 | Cycle 1(1): loaded http://localhost:58583/tests/dromaeo/cssquery-mootools.html (next: http://localhost:58583/tests/dromaeo/cssquery-prototype.html) 10:29:10 INFO - PROCESS | 5478 | RSS: Main: 233586688 10:29:10 INFO - PROCESS | 5478 | 10:32:12 INFO - PROCESS | 5478 | Cycle 1(1): loaded http://localhost:58583/tests/dromaeo/cssquery-prototype.html (next: http://localhost:58583/tests/dromaeo/cssquery-yui.html) 10:32:13 INFO - PROCESS | 5478 | RSS: Main: 225394688 10:32:13 INFO - PROCESS | 5478 | 10:35:15 INFO - PROCESS | 5478 | Cycle 1(1): loaded http://localhost:58583/tests/dromaeo/cssquery-yui.html (next: http://localhost:58583/tests/dromaeo/cssquery-dojo.html) 10:35:15 INFO - PROCESS | 5478 | RSS: Main: 262914048 10:35:15 INFO - PROCESS | 5478 | 10:35:15 INFO - PROCESS | 5478 | __start_tp_report 10:35:15 INFO - PROCESS | 5478 | _x_x_mozilla_page_load 10:35:15 INFO - PROCESS | 5478 | _x_x_mozilla_page_load_details 10:35:15 INFO - PROCESS | 5478 | |i|pagename|runs| 10:35:15 INFO - PROCESS | 5478 | |0;dojo.html;3103.208681786145;3127.765417593678;3169.286910445149;3169.7464202863757;3197.2965947491552;5144.048351055048;5262.473752624735;5312.096943519601;5326.866828329294;5328.520433161015;5242.239875218091;5254.842354729355;5257.7108259045735;5351.678899266037;5374.516293533581;4766.642501812361;4807.711537307773;4808.302796094564;4865.075635629237;4894.094592500381;4789.497102804207;4800.159972004885;4839.685420447659;4841.830535931225;4862.14912390332;4703.106409782147;4796.304535842318;4813.229883218686;4826.058918510892;4870.5860001900055;4820.060088282787;4840.298156767249;4848.684835485682;4848.781804818792;4878.048780487807;4744.383230180089;4808.062427826575;4813.807447702123;4817.277408388734;4832.275158726184;5162.535371816554;5214.713190774506;5217.791288348461;5248.343957005374;5283.339582552181;5622.493975542221;5627.6060675752715;5648.661080335193;5650.971745141289;5655.321361436613;5614.803481878155;5622.465865742748;5669.518090962232;5674.773009079632;5692.231548740909;5181.766820493049;5192.948070519285;5202.375714914235;5224.190250511177;5238.292830467876;5671.432856714378;5672.688002159838;5677.829665110054;5680.233168522279;5686.545076393879;5457.945420545823;5470.781168753285;5471.7264136793;5544.861378465571;5607.158926161109;5624.97187514068;5630.60585758993;5631.352394474688;5632.718364081779;5664.433556644302;5594.636348637407;5599.188117722907;5599.80400685974;5600.27196464457;5603.3836278009385;5363.115086010843;5497.285352904177;5591.133374326986;5612.831615051473;5617.157426385993;4289.592488713567;4292.9570704292555;4293.677974151951;4297.119090586422;4327.112941846976;3847.672947799412;3860.208657225262;3871.4192871069563;3886.436466712311;3887.8250478728523;5161.819336323286;5239.214117882272;5281.366236051698;5364.195370694427;5374.731263436891;5653.547716182696;5654.97172514143;5659.434056594308;5665.3201615806365;5672.744726487318;5295.285136506523;5310;5316.521513063843;5336.279602253724;5377.7311134443125;4744.7627618618935;4836.540528649773;4858.854234372974;4917.926231106536;4925.630577706686;5752.395998420106;5769.68266745333;5777.104548794943;5779.306483222041;5779.566532509994;5435.619506634498;5586.1062230043;5590.189422533791;5594.636348637326;5633.8309850704545;5705.885882282414;5733.226014487991;5735.139729040678;5788.623739456922;5792.681402522901;5545.445455454423;5564.443555644403;5572.554195664256;5577.0797818359515;5577.6653400796085;5483.122700367922;5552.416996215501;5640.4077571856005;5650.63270887391;5653.915191272216;5557.1108622621805;5565.165225216088;5568.582356323211;5571.860703482445;5613.242212301287;5543.223948647112;5554.055810512142;5554.75003624846;5555;5558.194061861089;5376.19357096423;5387.892242155213;5453.590980676386;5462.262594549685;5469.316335458067;5553.444655534414;5558.055130627722;5561.6663000220115;5574.832755017356;5602.327720673546;5392.110301800316;5438.075527160313;5441.918371224514;5443.646162999393;5449.509544141047 10:35:15 INFO - PROCESS | 5478 | |1;ext.html;595.7081030295154;633.3444884544498;637.7735903754167;651.2575663743332;658.7134596450547;30777.692223077764;31166.376672466566;31443.213919651993;32421;32521.51217731736;41206.38190427146;41856.79071604645;41861.581384186225;41927;41976;8427.831443371113;8615.741527754177;8638.956805215965;8639.049704532496;8639.179277968615;7925.722599708983;9792.804143917117;10167.898321016806;10167.949160254188;10174.54214560343;10257.743556411075;10383.636572719955;10397.480125993708;10407.739806504822;10408.791824163513;7868.803279917991;10131.189504839595;10231.590736370574;10376.118029967462;10382.169426445866;10164.186865050779;10314.896851031544;10327.948360258226;10335.173186145166;10336.483175841178;37092.629073709184;37631.81184094089;37801.62198378036;37820.62179378198;37831;3216.5818443602416;3219.710226079664;3272.754543409254;3398.1334759636384;3920.15716620925;29659.258518537208;30731;31053;31149.221269468446;31426.528602070986;4189.2668782963165;4194.182134483777;4250.914981700349;4268.59448352406;4290.184864875664;329331;329642;331584;332342;335025.99999999756;54136;54947.72526137344;55034.72482637561;55035.44964550383;55052.72473637606;58271.125933111034;58480;58495.12257316144;58619.4138058614;58763.41236587665;16284.26720797567;16742.24659890308;16765.664686706197;16768.748468772734;16770.496885093467;13082.738345233041;13165.934170329087;13165.934170329087;13166.210027398387;13170.539031133865;15516.844831551765;15598.844011559966;15737;15747.976381535163;15775.29011194499;6415.1981002374705;6502.284748677736;6563.573367731082;6570.145881035435;6659.101021362054;1058.8517607534952;1092.191778084212;1099.9560017599206;1169.1640477058943;1188.4295538141741;28028.43943121126;28310.15069547917;28482.430351392857;28584.857075714488;28689.426211475653;1037.1513175902626;1135.3698697222956;1160.3502038858267;1179.6932797472718;1191.8867707567767;15353.720125661042;16011.27949242287;16130;16190;16216.513504594881;473090;476358;478370;478895;479317;56793;57170.714146429;57266;57270.14094788582;57338.71330643404;1216.318861437598;1393.9930300348635;1420.7371636247121;1428.957131286063;1480.9851901481063;25402.74597254078;26617.600735988588;27410.45179096367;27609.86195069012;27694.72305277002;41962;41962.79018604887;42283.7885810569;42409;42560.5743942569;285993;286485;287249;288639;289117;23754;27807.497325240827;28722.569161463012;28769.42461150807;28800.567991480562;44037.779811100736;44907;45956.7702161487;46050;46111.07777844492;37957.81021094987;38102.618973809906;38306.61693383031;38610;38889.22221555497;38205;38777.61222387853;38925.416118757676;39030.316362036734;39451.60548394594;38993.610063898996;39809.2038159241;40082.799586001885;40171.79914100411;40233;28182.71817281883;29395;29612.407751845272;29663;29685.85157074201;23756;23895.402614934766;24459.820647965855;24824.627630585193;24959.875200624607 10:35:15 INFO - PROCESS | 5478 | |2;jquery.html;378.12436421018145;382.8870483207452;387.67822707153067;389.40809968847356;398.3228511530399;17456.738148927776;18494.352697655602;18520.536986575342;18528.166232519536;18540.536486587844;18022.639547209048;18113;18752.718709219374;18847.62304753904;18990.90504547479;5496.285482887219;5548.278723765905;5627.437256274381;5671.744771485272;5676.176954341618;5480.780768769245;5536;5551.1673249012765;5558.360788509332;5561.860953476155;5575.526080283161;5612;5635.5491560675255;5648.802291919784;5649.096144616862;5564.582656300773;5721.856953576153;5745.052066409037;5758.42415758425;5759.68321742304;5106.029854327666;5114.207297868837;5118.6416950813455;5120.667156634807;5466.617336786427;12908.548200812926;13066.934665326613;13191.2744799036;13191.538296159684;17679.911600442043;2245.6856040154394;2282.4065742906796;2329.906803727849;2333.9066437342485;2387.582173119697;9278.1649651531;9391.154796068318;9779.755506112333;9855.753606159831;10152.898471015269;1822.772153480815;1891.366392258595;1929.2861641192708;1940.5633732410236;1992.501874531367;73088.63455682741;75215.62392188005;75964;76667.99999999945;76822;10047.899521004843;10077.445740484198;10215.489225538693;10221;10427.791444171226;14331.928340358232;14393.208373539346;14426.567202983928;14428.278586070655;14434.494792682206;7750.496217745828;7969.800754981055;7987.081485629227;8120.309773669304;8166;7656.310932016146;7731.729389471341;7818.218178182136;7819.3744500439825;7842.372610191171;4334.696571240046;4336.3278691802825;4372.497162826252;4382.627476664519;4393.406890069864;1873.7751469823709;1951.6096780643927;1952.6485232657974;1989.6120256549834;1991.3030439346403;851.7019043334907;982.3761911186448;982.6167794560128;1036.23836480187;1103.784761971424;18107.909460452614;18233.817661823476;18807.247710091717;18823.211794879466;18945.621087578173;996.1460415908371;1014.497823577334;1020.7295066807302;1042.3224903812431;1055.5988724284723;8426.915730842613;10347.534360953776;10409.063184313296;10726.785464290826;10780.191485638608;454014;474169;508538;516251;517579;51216;54882.72558637261;55992;88654;94527;1058.0953284941418;1072.2279958429917;1093.1254996003324;1112.6884472347756;1113.5935383585095;12111.152219344915;15726.29231684554;16080.597985050468;16652.417165399154;16959.406420775213;36834;37719.81140094282;38086.42870356891;38421;39372.80313598413;46265;48374.51625483841;48609.270860936405;48617.270740938206;49898.251526226406;8086.6361013755695;8264.135238510531;8451.577421128795;8477.067522572635;8559.95720021396;9199.908000919904;12793.552225672056;13164.934175329063;13212.933935330262;13236.338183091;10217.33587316822;10945;11104;11466.140039496904;11693.298402095901;10422.635207767691;10581.259311848406;11125.388103654377;11136.38749868765;11202.775944481227;11693.181477296508;11830.11274154459;11901.761964760482;12014.879851201726;12361.567345142877;8342;8387.66449342044;8419.158084191531;8585.613647386008;8611.397202195787;11813.291202527877;11829.17195796286;11833.82249266279;11997.040236781211;12290.569830055905 10:35:15 INFO - PROCESS | 5478 | |3;mootools.html;1153.348358177629;1444.5088669852248;1479.4895760962468;1607.2124658917135;1745.9912700436503;7655.732049378273;7902.604869756511;7914.722984695537;7929.088154862186;7934.365250779938;8073.515589064646;8330.875036874437;8335.91664083359;8349.666013359474;8355.623996920138;1992.4620352504814;2229.5429436965383;2276.7609401012946;2279.5326957973575;2302.251768175341;2240.955180896381;2268.6143355629583;2268.739095004079;2269.5914735347633;2274.3404412720292;2219.6004719150546;2252.8085112765434;2258.525709600986;2259.5706815705043;2263.2531264682616;1996.4908948218183;2223.7776222377793;2277.954440911189;2279.8290128240365;2283.4177284792436;2175.4996350839237;2185.3880913344287;2187.453136715821;2188.595109904673;2247.3370355745096;8266.380021498411;8366.790830229233;8381.874271885865;8389.95805020971;8406.327493800482;4954.950450495485;5073.340465739467;5082.33929589151;5106.336176297094;5129.563987061104;3308.669133086672;3317.5189597508224;3351.581052368454;3393.6267010628812;3399.847006884696;1128.8588926384202;1145.3643228008452;1148.2192109365628;1161.5934422951984;1163.8254261860789;11186.384748838811;11233.831492527537;11243.437828108561;11279.943600281946;11308.264962777394;4169.10364271683;4284.507281662586;4401.779911004501;4466.39703640011;4472.172648060119;9522.571484283224;9533.046695330411;9533.809323813484;9535.2371810255;9548.1884039856;4608.723476591415;4995.650304478724;5004.874878128003;5033.194688849767;5045.192769156917;4525.7510836904285;4598.563136502027;4599.724016559017;4611.792469338888;4654.813807447732;3790.7156963227867;3839.6736277416176;3858.2862170498547;3877.9806100969877;3900.1809619979554;1203.825445310425;1215.489494412349;1234.796258617336;1236.344737289238;1250.331072876007;937.315759495572;985.930265661765;992.8758905136858;1009.3590569988111;1009.6012075230243;5736.282964629421;5770.422957704196;5958.46373826349;6005.39946005396;6077.17958075663;946.9952650236705;960.1262850805733;972.5186032913612;981.9214462842956;995.2187532786728;4093.97953010239;4117.3206420940805;4127.277726397869;4135.0902801383645;4136.834526618902;9685;10128.493575321352;10166.745831354126;10196.286259961731;10197.031282028196;10288.794224115476;10376;10419.218558608134;10431;10438.895611043945;7450.217727138681;7730.574818385043;7790.961045194737;7797.532148071021;8002.279794818494;5665.915011274752;5720.170575266647;5821.505172060422;5864.149698293809;5883.0881213411985;8964;9411.764705882408;9528.52357382142;9587.952060239653;9698.660546880825;9360.859587106062;9616.9038309616;9742.95128524353;9776.071273229032;9870.062344077302;6420.101185834081;7101.396381307647;7193.280671932974;7297.014902988029;7344.192138864613;7745.806354841174;7751.341136003277;7756.689732410866;7780.49426787257;7786.727464538714;6966.12923384577;7031.1211098612675;7145.285471452813;7177.892331614926;7192.280771922766;7042.471814614027;7045.26024767392;7056.188538317954;7117.288271172842;7123.893141602776;6478.255000674794;6651.102101216274;6684.16447944007;6686.063951046955;6877.243503214742;5125.461826508163;5198.532132108128;5206.55744261742;5215.191645294985;5229.869253268699;5209.479052094912;5246.213068039825;5255.553277971415;5263.736813159403;5339.679619222859 10:35:15 INFO - PROCESS | 5478 | |4;prototype.html;303.9407315573464;319.2593183813553;321.0705008998948;322.24272958547414;323.9222586579219;5645.661260324383;5748.683822389767;5813.563982701298;5875.118732190168;5892.440218179277;5825.126231065342;5853.209816674747;5857.364186116243;5869.471747542721;5892.941070589292;4443.622292105175;4454.465464144308;4463.263561512363;4468.798904049309;4470.82116715331;4367.934480982772;4439.556044395551;4498.50516443191;4507.391502147201;4511.661625378093;4407.699728580076;4412.40432541606;4427.977860110695;4446;4450.488193857699;4427.269500532424;4450.176717307292;4467.240569103228;4468.575485328888;4472.08322293929;3651.926961460756;3851.114243723959;3913.8434462621462;3918.3338832398563;3924.7841368724708;5575.968445837492;5587.217789509472;5602.803901863415;5616.803411880605;5628.409017053192;5016.398032236155;5032.345795046621;5034.565148932536;5051.292819005343;5082.110630639623;5715.3998830122655;6002.459778619901;6017.06735456005;6063.969680151615;6082.270127584674;4194.266003449415;4208.979689748938;4210.389493523453;4217.472815898012;4232.746035237896;6306.527010474233;6340.841478963062;6367.936320636781;6388.584741991802;6402.647854368008;4250.681198910094;4336.674749393745;4339;4345.804438800262;4370.562943705604;4359.367891655692;4397.494288156839;4398.978005109954;4399.560043995575;4401.163778882066;5046.949530504648;5076.644634875597;5078.796848126108;5085.186370180753;5095.668781529189;5824.737886795105;5900.695610458071;5965.522758179422;6087.777961044187;6088.756449742049;1508.0122519749361;1514.9091054536764;1521;1525.0392252880615;1528.4497580870877;975.8194733974095;1001.3341128149845;1007.8437842134481;1016.506994107857;1019.6176433837311;5852.473277405054;5857.736401861926;5865.296164460292;5868.354481007086;5894.469497745138;6247.3440288769025;6250.218722659668;6258.655773932386;6267.373262673696;6292.244930608356;5664.575156863251;5859.472647461749;5965.821025369246;5968.104784282305;5975.163477113208;3335.4163021471145;3347.0962840033053;3370.76404651672;3395.168183794986;3401.5748031496064;6297.559170858088;6488.188976377953;6492.72814447812;6494.64279464634;6495.1556297681;6396.392342727433;6402.423781859655;6423.903641445382;6477.125588045554;6480.092787009822;6190.628562286187;6440.935590644127;6443.806685799434;6484.805455836333;6516.380943810331;6273.404026617464;6311.463525600192;6313.1477250572425;6323.691852473722;6407.9038814418755;6271.247450305992;6273.153124328157;6277.717502712298;6287.2140982377205;6296.181496405438;6266.811995640138;6485.632744048294;6517.8696426072165;6538.901916471352;6540.258312723237;4249.745015299092;4285.035866929916;4290.57094290581;4302.419173411549;4309.84915527955;5935.554833387427;6185;6358.618482891041;6373.458256048102;6379.553431259767;6142.078688196806;6151.200343955257;6158.168647232566;6164.3835616438;6184.165137706532;6028.608140470856;6158.3225845157895;6163.260408750979;6174.66039367839;6178.289496707936;5976.6712830792985;5986.640801551921;5995.850103747267;6030.3668114847305;6031.306399763907;6127.3259941407305;6153.246324797411;6164.691765411621;6178.320384757583;6202.658853763086;5940.346561878104;6007.48936340416;6016.278046634432;6020.8795824084145;6052.757889684363 10:35:15 INFO - PROCESS | 5478 | |5;yui.html;731.8572878288734;760.9315161635452;774.9341305988991;779.8518281526509;802.6789284286289;14461.927690361546;14561.490347837827;14619.342129604167;14844.88663350249;14863.40546378145;13363.331833408314;13402.329883505834;13481.39333729982;13496.932515337434;13552.728945421086;681.2778454837863;797.8603744344746;815.302916006813;826.8801023851538;828.5815663090161;829.050736906242;835.7200337886816;835.9916400836005;836.6235194162621;836.9163083691643;863.7840539865034;870.6343335798948;871.4379225399614;871.5642178910545;873.1879352202449;693.9132608423922;837.1001173738256;863.6890719341033;866.1079088538752;866.4411454611771;630.7256343490596;631.3497097989078;631.356016862802;632.0550776589029;634.7016902056026;14400.927995360062;14402.135871847722;14405.78391324131;14406.279686015761;14443.711125777425;13860.237686927216;14014.229217393142;14038.789418158736;14158.858411415857;14237.430502779876;10981.780364392747;11211.103111751041;11335.886641133648;11361.142964937604;11393.902203659014;3844.826982785781;3870.6599206783144;3901.2392583445953;3955.7626542407547;3988.3020471417385;54975.17537236945;55024;55175;55881.72059139719;56284.15573766397;10480.528376223088;10715.571377144983;10757.784844303227;10807.513661885234;10888.183386246063;18309.725354119433;19101.331453399063;19167.424977250706;19173.808261917482;19191.32830350931;8383.496990180609;8443.873341899876;8478.660853565912;8510.872336914952;8604.913950860537;4860.198067318853;4901.411830580353;4935.136351138536;4938;5023.372078490189;3374.5106959490736;3427.8800241991908;3428.8285585720614;3429.3998550253605;3431.897043088711;599.7570983751588;602.4337123104356;611.4405319132943;614.2322097378277;617.8548041210312;686.9484788640872;750.159821000472;757.8408534207767;763.4007304266124;772.4669977715358;9306.86039709405;9311.394759340621;9333.579988900516;9433.386829856174;9603.47180905043;585.9033259512132;587.6251309004506;669.2805234373069;703.9394869459331;704.112817849503;4564.2012647786505;4580.931286030712;4607.7004994675235;4618.214903466419;4676.9750068253725;62892.056619150746;62972.370276297566;64068.35931640717;64395.356046439876;64461;55582;55949.44050559524;56075.15887261694;56749.14876276859;57461;44653.77673111614;45243.32135017977;46972.999999999316;47508.5249147511;49070.50929490731;8963.983103801593;9235.307351948497;9257.444553326823;9530.761730956505;9557.761055973657;31325.686743132275;31615.525767113973;32186.83906580452;32582.67417325891;33359;45423.54576454193;45597.316040260084;45867.31199032084;46075.61773146811;47075;11183.217174798012;11304.60433884843;11308.943455282671;11419.486123124314;11706.239094458833;13175.2753598553;13227.074104812571;13257.204567725967;13313.134646247963;13436.596902092953;9434.528273586431;12783.296918669563;12904.290264035568;13014.691284494815;13226.537071202461;12461.688457788629;12678;12772.361381930681;12835.229886206484;12871.356432178167;12734.87265127374;12839.293838838954;12949.741005180033;12950.158239714388;13162.14446061003;11094.223404361617;11116.833247501456;11267.154963377616;11309.547618095185;11479.598214062467;11303;11367.886321137014;11452.312861228353;11553.422328883355;11584.304941703525 10:35:15 INFO - PROCESS | 5478 | __end_tp_report 10:35:15 INFO - PROCESS | 5478 | __start_cc_report 10:35:15 INFO - PROCESS | 5478 | _x_x_mozilla_cycle_collect,844 10:35:15 INFO - PROCESS | 5478 | __end_cc_report 10:35:15 INFO - PROCESS | 5478 | __startTimestamp1461432915927__endTimestamp 10:35:15 INFO - PROCESS | 5478 | 10:35:15 INFO - PROCESS | 5478 | ------- Summary: start ------- 10:35:15 INFO - PROCESS | 5478 | Number of tests: 6 10:35:15 INFO - PROCESS | 5478 | 10:35:15 INFO - PROCESS | 5478 | [#0] dojo.html Cycles:165 Average:5231.43 Median:5443.65 stddev:569.40 (10.5%) stddev-sans-first:546.12 10:35:15 INFO - PROCESS | 5478 | Values: 3103.2 3127.8 3169.3 3169.7 3197.3 5144.0 5262.5 5312.1 5326.9 5328.5 5242.2 5254.8 5257.7 5351.7 5374.5 4766.6 4807.7 4808.3 4865.1 4894.1 4789.5 4800.2 4839.7 4841.8 4862.1 4703.1 4796.3 4813.2 4826.1 4870.6 4820.1 4840.3 4848.7 4848.8 4878.0 4744.4 4808.1 4813.8 4817.3 4832.3 5162.5 5214.7 5217.8 5248.3 5283.3 5622.5 5627.6 5648.7 5651.0 5655.3 5614.8 5622.5 5669.5 5674.8 5692.2 5181.8 5192.9 5202.4 5224.2 5238.3 5671.4 5672.7 5677.8 5680.2 5686.5 5457.9 5470.8 5471.7 5544.9 5607.2 5625.0 5630.6 5631.4 5632.7 5664.4 5594.6 5599.2 5599.8 5600.3 5603.4 5363.1 5497.3 5591.1 5612.8 5617.2 4289.6 4293.0 4293.7 4297.1 4327.1 3847.7 3860.2 3871.4 3886.4 3887.8 5161.8 5239.2 5281.4 5364.2 5374.7 5653.5 5655.0 5659.4 5665.3 5672.7 5295.3 5310.0 5316.5 5336.3 5377.7 4744.8 4836.5 4858.9 4917.9 4925.6 5752.4 5769.7 5777.1 5779.3 5779.6 5435.6 5586.1 5590.2 5594.6 5633.8 5705.9 5733.2 5735.1 5788.6 5792.7 5545.4 5564.4 5572.6 5577.1 5577.7 5483.1 5552.4 5640.4 5650.6 5653.9 5557.1 5565.2 5568.6 5571.9 5613.2 5543.2 5554.1 5554.8 5555.0 5558.2 5376.2 5387.9 5453.6 5462.3 5469.3 5553.4 5558.1 5561.7 5574.8 5602.3 5392.1 5438.1 5441.9 5443.6 5449.5 10:35:15 INFO - PROCESS | 5478 | 10:35:15 INFO - PROCESS | 5478 | [#1] ext.html Cycles:180 Average:52186.72 Median:3218.15 stddev:98987.83 (3075.9%) stddev-sans-first:99189.73 10:35:15 INFO - PROCESS | 5478 | Values: 595.7 633.3 637.8 651.3 658.7 30777.7 31166.4 31443.2 32421.0 32521.5 41206.4 41856.8 41861.6 41927.0 41976.0 8427.8 8615.7 8639.0 8639.0 8639.2 7925.7 9792.8 10167.9 10167.9 10174.5 10257.7 10383.6 10397.5 10407.7 10408.8 7868.8 10131.2 10231.6 10376.1 10382.2 10164.2 10314.9 10327.9 10335.2 10336.5 37092.6 37631.8 37801.6 37820.6 37831.0 3216.6 3219.7 3272.8 3398.1 3920.2 29659.3 30731.0 31053.0 31149.2 31426.5 4189.3 4194.2 4250.9 4268.6 4290.2 329331.0 329642.0 331584.0 332342.0 335026.0 54136.0 54947.7 55034.7 55035.4 55052.7 58271.1 58480.0 58495.1 58619.4 58763.4 16284.3 16742.2 16765.7 16768.7 16770.5 13082.7 13165.9 13165.9 13166.2 13170.5 15516.8 15598.8 15737.0 15748.0 15775.3 6415.2 6502.3 6563.6 6570.1 6659.1 1058.9 1092.2 1100.0 1169.2 1188.4 28028.4 28310.2 28482.4 28584.9 28689.4 1037.2 1135.4 1160.4 1179.7 1191.9 15353.7 16011.3 16130.0 16190.0 16216.5 473090.0 476358.0 478370.0 478895.0 479317.0 56793.0 57170.7 57266.0 57270.1 57338.7 1216.3 1394.0 1420.7 1429.0 1481.0 25402.7 26617.6 27410.5 27609.9 27694.7 41962.0 41962.8 42283.8 42409.0 42560.6 285993.0 286485.0 287249.0 288639.0 289117.0 23754.0 27807.5 28722.6 28769.4 28800.6 44037.8 44907.0 45956.8 46050.0 46111.1 37957.8 38102.6 38306.6 38610.0 38889.2 38205.0 38777.6 38925.4 39030.3 39451.6 38993.6 39809.2 40082.8 40171.8 40233.0 28182.7 29395.0 29612.4 29663.0 29685.9 23756.0 23895.4 24459.8 24824.6 24959.9 10:35:15 INFO - PROCESS | 5478 | 10:35:15 INFO - PROCESS | 5478 | [#2] jquery.html Cycles:180 Average:27418.39 Median:37276.91 stddev:81099.24 (217.6%) stddev-sans-first:81301.33 10:35:15 INFO - PROCESS | 5478 | Values: 378.1 382.9 387.7 389.4 398.3 17456.7 18494.4 18520.5 18528.2 18540.5 18022.6 18113.0 18752.7 18847.6 18990.9 5496.3 5548.3 5627.4 5671.7 5676.2 5480.8 5536.0 5551.2 5558.4 5561.9 5575.5 5612.0 5635.5 5648.8 5649.1 5564.6 5721.9 5745.1 5758.4 5759.7 5106.0 5114.2 5118.6 5120.7 5466.6 12908.5 13066.9 13191.3 13191.5 17679.9 2245.7 2282.4 2329.9 2333.9 2387.6 9278.2 9391.2 9779.8 9855.8 10152.9 1822.8 1891.4 1929.3 1940.6 1992.5 73088.6 75215.6 75964.0 76668.0 76822.0 10047.9 10077.4 10215.5 10221.0 10427.8 14331.9 14393.2 14426.6 14428.3 14434.5 7750.5 7969.8 7987.1 8120.3 8166.0 7656.3 7731.7 7818.2 7819.4 7842.4 4334.7 4336.3 4372.5 4382.6 4393.4 1873.8 1951.6 1952.6 1989.6 1991.3 851.7 982.4 982.6 1036.2 1103.8 18107.9 18233.8 18807.2 18823.2 18945.6 996.1 1014.5 1020.7 1042.3 1055.6 8426.9 10347.5 10409.1 10726.8 10780.2 454014.0 474169.0 508538.0 516251.0 517579.0 51216.0 54882.7 55992.0 88654.0 94527.0 1058.1 1072.2 1093.1 1112.7 1113.6 12111.2 15726.3 16080.6 16652.4 16959.4 36834.0 37719.8 38086.4 38421.0 39372.8 46265.0 48374.5 48609.3 48617.3 49898.3 8086.6 8264.1 8451.6 8477.1 8560.0 9199.9 12793.6 13164.9 13212.9 13236.3 10217.3 10945.0 11104.0 11466.1 11693.3 10422.6 10581.3 11125.4 11136.4 11202.8 11693.2 11830.1 11901.8 12014.9 12361.6 8342.0 8387.7 8419.2 8585.6 8611.4 11813.3 11829.2 11833.8 11997.0 12290.6 10:35:15 INFO - PROCESS | 5478 | 10:35:15 INFO - PROCESS | 5478 | [#3] mootools.html Cycles:180 Average:5492.78 Median:5127.51 stddev:3027.85 (59.1%) stddev-sans-first:3018.78 10:35:15 INFO - PROCESS | 5478 | Values: 1153.3 1444.5 1479.5 1607.2 1746.0 7655.7 7902.6 7914.7 7929.1 7934.4 8073.5 8330.9 8335.9 8349.7 8355.6 1992.5 2229.5 2276.8 2279.5 2302.3 2241.0 2268.6 2268.7 2269.6 2274.3 2219.6 2252.8 2258.5 2259.6 2263.3 1996.5 2223.8 2278.0 2279.8 2283.4 2175.5 2185.4 2187.5 2188.6 2247.3 8266.4 8366.8 8381.9 8390.0 8406.3 4955.0 5073.3 5082.3 5106.3 5129.6 3308.7 3317.5 3351.6 3393.6 3399.8 1128.9 1145.4 1148.2 1161.6 1163.8 11186.4 11233.8 11243.4 11279.9 11308.3 4169.1 4284.5 4401.8 4466.4 4472.2 9522.6 9533.0 9533.8 9535.2 9548.2 4608.7 4995.7 5004.9 5033.2 5045.2 4525.8 4598.6 4599.7 4611.8 4654.8 3790.7 3839.7 3858.3 3878.0 3900.2 1203.8 1215.5 1234.8 1236.3 1250.3 937.3 985.9 992.9 1009.4 1009.6 5736.3 5770.4 5958.5 6005.4 6077.2 947.0 960.1 972.5 981.9 995.2 4094.0 4117.3 4127.3 4135.1 4136.8 9685.0 10128.5 10166.7 10196.3 10197.0 10288.8 10376.0 10419.2 10431.0 10438.9 7450.2 7730.6 7791.0 7797.5 8002.3 5665.9 5720.2 5821.5 5864.1 5883.1 8964.0 9411.8 9528.5 9588.0 9698.7 9360.9 9616.9 9743.0 9776.1 9870.1 6420.1 7101.4 7193.3 7297.0 7344.2 7745.8 7751.3 7756.7 7780.5 7786.7 6966.1 7031.1 7145.3 7177.9 7192.3 7042.5 7045.3 7056.2 7117.3 7123.9 6478.3 6651.1 6684.2 6686.1 6877.2 5125.5 5198.5 5206.6 5215.2 5229.9 5209.5 5246.2 5255.6 5263.7 5339.7 10:35:15 INFO - PROCESS | 5478 | 10:35:15 INFO - PROCESS | 5478 | [#4] prototype.html Cycles:180 Average:5108.51 Median:5862.38 stddev:1538.97 (26.3%) stddev-sans-first:1500.44 10:35:15 INFO - PROCESS | 5478 | Values: 303.9 319.3 321.1 322.2 323.9 5645.7 5748.7 5813.6 5875.1 5892.4 5825.1 5853.2 5857.4 5869.5 5892.9 4443.6 4454.5 4463.3 4468.8 4470.8 4367.9 4439.6 4498.5 4507.4 4511.7 4407.7 4412.4 4428.0 4446.0 4450.5 4427.3 4450.2 4467.2 4468.6 4472.1 3651.9 3851.1 3913.8 3918.3 3924.8 5576.0 5587.2 5602.8 5616.8 5628.4 5016.4 5032.3 5034.6 5051.3 5082.1 5715.4 6002.5 6017.1 6064.0 6082.3 4194.3 4209.0 4210.4 4217.5 4232.7 6306.5 6340.8 6367.9 6388.6 6402.6 4250.7 4336.7 4339.0 4345.8 4370.6 4359.4 4397.5 4399.0 4399.6 4401.2 5046.9 5076.6 5078.8 5085.2 5095.7 5824.7 5900.7 5965.5 6087.8 6088.8 1508.0 1514.9 1521.0 1525.0 1528.4 975.8 1001.3 1007.8 1016.5 1019.6 5852.5 5857.7 5865.3 5868.4 5894.5 6247.3 6250.2 6258.7 6267.4 6292.2 5664.6 5859.5 5965.8 5968.1 5975.2 3335.4 3347.1 3370.8 3395.2 3401.6 6297.6 6488.2 6492.7 6494.6 6495.2 6396.4 6402.4 6423.9 6477.1 6480.1 6190.6 6440.9 6443.8 6484.8 6516.4 6273.4 6311.5 6313.1 6323.7 6407.9 6271.2 6273.2 6277.7 6287.2 6296.2 6266.8 6485.6 6517.9 6538.9 6540.3 4249.7 4285.0 4290.6 4302.4 4309.8 5935.6 6185.0 6358.6 6373.5 6379.6 6142.1 6151.2 6158.2 6164.4 6184.2 6028.6 6158.3 6163.3 6174.7 6178.3 5976.7 5986.6 5995.9 6030.4 6031.3 6127.3 6153.2 6164.7 6178.3 6202.7 5940.3 6007.5 6016.3 6020.9 6052.8 10:35:15 INFO - PROCESS | 5478 | 10:35:15 INFO - PROCESS | 5478 | [#5] yui.html Cycles:180 Average:14837.95 Median:25237.51 stddev:17131.06 (67.9%) stddev-sans-first:17146.37 10:35:15 INFO - PROCESS | 5478 | Values: 731.9 760.9 774.9 779.9 802.7 14461.9 14561.5 14619.3 14844.9 14863.4 13363.3 13402.3 13481.4 13496.9 13552.7 681.3 797.9 815.3 826.9 828.6 829.1 835.7 836.0 836.6 836.9 863.8 870.6 871.4 871.6 873.2 693.9 837.1 863.7 866.1 866.4 630.7 631.3 631.4 632.1 634.7 14400.9 14402.1 14405.8 14406.3 14443.7 13860.2 14014.2 14038.8 14158.9 14237.4 10981.8 11211.1 11335.9 11361.1 11393.9 3844.8 3870.7 3901.2 3955.8 3988.3 54975.2 55024.0 55175.0 55881.7 56284.2 10480.5 10715.6 10757.8 10807.5 10888.2 18309.7 19101.3 19167.4 19173.8 19191.3 8383.5 8443.9 8478.7 8510.9 8604.9 4860.2 4901.4 4935.1 4938.0 5023.4 3374.5 3427.9 3428.8 3429.4 3431.9 599.8 602.4 611.4 614.2 617.9 686.9 750.2 757.8 763.4 772.5 9306.9 9311.4 9333.6 9433.4 9603.5 585.9 587.6 669.3 703.9 704.1 4564.2 4580.9 4607.7 4618.2 4677.0 62892.1 62972.4 64068.4 64395.4 64461.0 55582.0 55949.4 56075.2 56749.1 57461.0 44653.8 45243.3 46973.0 47508.5 49070.5 8964.0 9235.3 9257.4 9530.8 9557.8 31325.7 31615.5 32186.8 32582.7 33359.0 45423.5 45597.3 45867.3 46075.6 47075.0 11183.2 11304.6 11308.9 11419.5 11706.2 13175.3 13227.1 13257.2 13313.1 13436.6 9434.5 12783.3 12904.3 13014.7 13226.5 12461.7 12678.0 12772.4 12835.2 12871.4 12734.9 12839.3 12949.7 12950.2 13162.1 11094.2 11116.8 11267.2 11309.5 11479.6 11303.0 11367.9 11452.3 11553.4 11584.3 10:35:15 INFO - PROCESS | 5478 | -------- Summary: end -------- 10:35:15 INFO - PROCESS | 5478 | 10:35:16 INFO - TEST-INFO | 5478: exit 0 10:35:16 INFO - TEST-OK | dromaeo_css | took 1112241ms 10:35:16 INFO - TEST-START | kraken 10:35:16 INFO - operating with platform_type : linux_ 10:35:16 INFO - Initialising browser for kraken test... 10:35:16 INFO - TEST-INFO | started process 5660 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpD5882y/profile http://localhost:58583/getInfo.html) 10:35:20 INFO - PROCESS | 5660 | __metrics Screen width/height:1600/1200 10:35:20 INFO - PROCESS | 5660 | colorDepth:24 10:35:20 INFO - PROCESS | 5660 | Browser inner width/height: 1024/697 10:35:20 INFO - PROCESS | 5660 | __metrics 10:35:21 ERROR - PROCESS | 5660 | JavaScript error: resource://app/modules/AboutNewTab.jsm, line 36: TypeError: this.pageListener is null 10:35:22 INFO - TEST-INFO | 5660: exit 0 10:35:22 INFO - Browser initialized. 10:35:22 INFO - Running cycle 1/1 for kraken test... 10:35:22 INFO - TEST-INFO | started process 5739 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpD5882y/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 10:35:34 INFO - PROCESS | 5739 | RSS: Main: 153735168 10:35:34 INFO - PROCESS | 5739 | 10:35:36 INFO - PROCESS | 5739 | Cycle 1(1): loaded http://localhost:58583/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:58583/tests/kraken/driver.html?testName=audio-beat-detection) 10:35:37 INFO - PROCESS | 5739 | RSS: Main: 208605184 10:35:37 INFO - PROCESS | 5739 | 10:35:40 INFO - PROCESS | 5739 | Cycle 1(1): loaded http://localhost:58583/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:58583/tests/kraken/driver.html?testName=audio-dft) 10:35:40 INFO - PROCESS | 5739 | RSS: Main: 195416064 10:35:40 INFO - PROCESS | 5739 | 10:35:43 INFO - PROCESS | 5739 | Cycle 1(1): loaded http://localhost:58583/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:58583/tests/kraken/driver.html?testName=audio-fft) 10:35:44 INFO - PROCESS | 5739 | RSS: Main: 263847936 10:35:44 INFO - PROCESS | 5739 | 10:35:46 INFO - PROCESS | 5739 | Cycle 1(1): loaded http://localhost:58583/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:58583/tests/kraken/driver.html?testName=audio-oscillator) 10:35:47 INFO - PROCESS | 5739 | RSS: Main: 173772800 10:35:47 INFO - PROCESS | 5739 | 10:35:49 INFO - PROCESS | 5739 | Cycle 1(1): loaded http://localhost:58583/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:58583/tests/kraken/driver.html?testName=imaging-gaussian-blur) 10:35:49 INFO - PROCESS | 5739 | RSS: Main: 177844224 10:35:49 INFO - PROCESS | 5739 | 10:35:52 INFO - PROCESS | 5739 | Cycle 1(1): loaded http://localhost:58583/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:58583/tests/kraken/driver.html?testName=imaging-darkroom) 10:35:53 INFO - PROCESS | 5739 | RSS: Main: 213913600 10:35:53 INFO - PROCESS | 5739 | 10:35:56 INFO - PROCESS | 5739 | Cycle 1(1): loaded http://localhost:58583/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:58583/tests/kraken/driver.html?testName=imaging-desaturate) 10:35:57 INFO - PROCESS | 5739 | RSS: Main: 214142976 10:35:57 INFO - PROCESS | 5739 | 10:36:00 INFO - PROCESS | 5739 | Cycle 1(1): loaded http://localhost:58583/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:58583/tests/kraken/driver.html?testName=json-parse-financial) 10:36:00 INFO - PROCESS | 5739 | RSS: Main: 214323200 10:36:00 INFO - PROCESS | 5739 | 10:36:02 INFO - PROCESS | 5739 | Cycle 1(1): loaded http://localhost:58583/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:58583/tests/kraken/driver.html?testName=json-stringify-tinderbox) 10:36:02 INFO - PROCESS | 5739 | RSS: Main: 203378688 10:36:02 INFO - PROCESS | 5739 | 10:36:04 INFO - PROCESS | 5739 | Cycle 1(1): loaded http://localhost:58583/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:58583/tests/kraken/driver.html?testName=stanford-crypto-aes) 10:36:05 INFO - PROCESS | 5739 | RSS: Main: 202797056 10:36:05 INFO - PROCESS | 5739 | 10:36:07 INFO - PROCESS | 5739 | Cycle 1(1): loaded http://localhost:58583/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:58583/tests/kraken/driver.html?testName=stanford-crypto-ccm) 10:36:07 INFO - PROCESS | 5739 | RSS: Main: 214990848 10:36:07 INFO - PROCESS | 5739 | 10:36:10 INFO - PROCESS | 5739 | Cycle 1(1): loaded http://localhost:58583/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:58583/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 10:36:11 INFO - PROCESS | 5739 | RSS: Main: 223309824 10:36:11 INFO - PROCESS | 5739 | 10:36:13 INFO - PROCESS | 5739 | Cycle 1(1): loaded http://localhost:58583/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:58583/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 10:36:14 INFO - PROCESS | 5739 | RSS: Main: 218189824 10:36:14 INFO - PROCESS | 5739 | 10:36:16 INFO - PROCESS | 5739 | Cycle 1(1): loaded http://localhost:58583/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:58583/tests/kraken/driver.html?testName=ai-astar) 10:36:16 INFO - PROCESS | 5739 | RSS: Main: 281726976 10:36:16 INFO - PROCESS | 5739 | 10:36:16 INFO - PROCESS | 5739 | __start_tp_report 10:36:16 INFO - PROCESS | 5739 | _x_x_mozilla_page_load 10:36:16 INFO - PROCESS | 5739 | _x_x_mozilla_page_load_details 10:36:16 INFO - PROCESS | 5739 | |i|pagename|runs| 10:36:16 INFO - PROCESS | 5739 | |0;ai-astar;113;114;106;110;112;110;102;112;111;110 10:36:16 INFO - PROCESS | 5739 | |1;audio-beat-detection;160;127;157;177;130;154;158;129;190;138 10:36:16 INFO - PROCESS | 5739 | |2;audio-dft;161;161;163;161;160;161;160;161;162;161 10:36:16 INFO - PROCESS | 5739 | |3;audio-fft;76;71;112;105;76;75;74;124;101;75 10:36:16 INFO - PROCESS | 5739 | |4;audio-oscillator;92;92;153;93;93;92;151;92;92;145 10:36:16 INFO - PROCESS | 5739 | |5;imaging-gaussian-blur;117;117;117;117;116;117;117;117;116;117 10:36:16 INFO - PROCESS | 5739 | |6;imaging-darkroom;145;145;145;152;145;145;145;146;146;145 10:36:16 INFO - PROCESS | 5739 | |7;imaging-desaturate;95;94;94;96;95;94;94;94;94;95 10:36:16 INFO - PROCESS | 5739 | |8;json-parse-financial;56;57;58;56;55;55;57;82;62;56 10:36:16 INFO - PROCESS | 5739 | |9;json-stringify-tinderbox;61;62;61;61;62;61;61;62;64;61 10:36:16 INFO - PROCESS | 5739 | |10;stanford-crypto-aes;77;76;76;76;82;77;79;77;78;78 10:36:16 INFO - PROCESS | 5739 | |11;stanford-crypto-ccm;124;138;124;128;122;123;124;128;168;124 10:36:16 INFO - PROCESS | 5739 | |12;stanford-crypto-pbkdf2;170;169;172;165;172;167;162;169;166;166 10:36:16 INFO - PROCESS | 5739 | |13;stanford-crypto-sha256-iterative;72;68;67;71;70;68;68;66;67;67 10:36:16 INFO - PROCESS | 5739 | __end_tp_report 10:36:16 INFO - PROCESS | 5739 | __start_cc_report 10:36:16 INFO - PROCESS | 5739 | _x_x_mozilla_cycle_collect,1609 10:36:16 INFO - PROCESS | 5739 | __end_cc_report 10:36:16 INFO - PROCESS | 5739 | __startTimestamp1461432976448__endTimestamp 10:36:16 INFO - PROCESS | 5739 | 10:36:16 INFO - PROCESS | 5739 | ------- Summary: start ------- 10:36:16 INFO - PROCESS | 5739 | Number of tests: 14 10:36:16 INFO - PROCESS | 5739 | 10:36:16 INFO - PROCESS | 5739 | [#0] ai-astar Cycles:10 Average:110.00 Median:111.50 stddev:3.56 (3.2%) stddev-sans-first:3.61 10:36:16 INFO - PROCESS | 5739 | Values: 113.0 114.0 106.0 110.0 112.0 110.0 102.0 112.0 111.0 110.0 10:36:16 INFO - PROCESS | 5739 | 10:36:16 INFO - PROCESS | 5739 | [#1] audio-beat-detection Cycles:10 Average:152.00 Median:157.50 stddev:21.17 (13.4%) stddev-sans-first:22.25 10:36:16 INFO - PROCESS | 5739 | Values: 160.0 127.0 157.0 177.0 130.0 154.0 158.0 129.0 190.0 138.0 10:36:16 INFO - PROCESS | 5739 | 10:36:16 INFO - PROCESS | 5739 | [#2] audio-dft Cycles:10 Average:161.10 Median:161.00 stddev:0.88 (0.5%) stddev-sans-first:0.93 10:36:16 INFO - PROCESS | 5739 | Values: 161.0 161.0 163.0 161.0 160.0 161.0 160.0 161.0 162.0 161.0 10:36:16 INFO - PROCESS | 5739 | 10:36:16 INFO - PROCESS | 5739 | [#3] audio-fft Cycles:10 Average:88.90 Median:74.50 stddev:19.53 (26.2%) stddev-sans-first:20.15 10:36:16 INFO - PROCESS | 5739 | Values: 76.0 71.0 112.0 105.0 76.0 75.0 74.0 124.0 101.0 75.0 10:36:16 INFO - PROCESS | 5739 | 10:36:16 INFO - PROCESS | 5739 | [#4] audio-oscillator Cycles:10 Average:109.50 Median:92.00 stddev:27.79 (30.2%) stddev-sans-first:28.75 10:36:16 INFO - PROCESS | 5739 | Values: 92.0 92.0 153.0 93.0 93.0 92.0 151.0 92.0 92.0 145.0 10:36:16 INFO - PROCESS | 5739 | 10:36:16 INFO - PROCESS | 5739 | [#5] imaging-gaussian-blur Cycles:10 Average:116.80 Median:117.00 stddev:0.42 (0.4%) stddev-sans-first:0.44 10:36:16 INFO - PROCESS | 5739 | Values: 117.0 117.0 117.0 117.0 116.0 117.0 117.0 117.0 116.0 117.0 10:36:16 INFO - PROCESS | 5739 | 10:36:16 INFO - PROCESS | 5739 | [#6] imaging-darkroom Cycles:10 Average:145.90 Median:145.00 stddev:2.18 (1.5%) stddev-sans-first:2.29 10:36:16 INFO - PROCESS | 5739 | Values: 145.0 145.0 145.0 152.0 145.0 145.0 145.0 146.0 146.0 145.0 10:36:16 INFO - PROCESS | 5739 | 10:36:16 INFO - PROCESS | 5739 | [#7] imaging-desaturate Cycles:10 Average:94.50 Median:94.50 stddev:0.71 (0.7%) stddev-sans-first:0.73 10:36:16 INFO - PROCESS | 5739 | Values: 95.0 94.0 94.0 96.0 95.0 94.0 94.0 94.0 94.0 95.0 10:36:16 INFO - PROCESS | 5739 | 10:36:16 INFO - PROCESS | 5739 | [#8] json-parse-financial Cycles:10 Average:59.40 Median:57.00 stddev:8.19 (14.4%) stddev-sans-first:8.60 10:36:16 INFO - PROCESS | 5739 | Values: 56.0 57.0 58.0 56.0 55.0 55.0 57.0 82.0 62.0 56.0 10:36:16 INFO - PROCESS | 5739 | 10:36:16 INFO - PROCESS | 5739 | [#9] json-stringify-tinderbox Cycles:10 Average:61.60 Median:61.50 stddev:0.97 (1.6%) stddev-sans-first:1.00 10:36:16 INFO - PROCESS | 5739 | Values: 61.0 62.0 61.0 61.0 62.0 61.0 61.0 62.0 64.0 61.0 10:36:16 INFO - PROCESS | 5739 | 10:36:16 INFO - PROCESS | 5739 | [#10] stanford-crypto-aes Cycles:10 Average:77.60 Median:77.50 stddev:1.84 (2.4%) stddev-sans-first:1.94 10:36:16 INFO - PROCESS | 5739 | Values: 77.0 76.0 76.0 76.0 82.0 77.0 79.0 77.0 78.0 78.0 10:36:16 INFO - PROCESS | 5739 | 10:36:16 INFO - PROCESS | 5739 | [#11] stanford-crypto-ccm Cycles:10 Average:130.30 Median:126.00 stddev:14.03 (11.1%) stddev-sans-first:14.70 10:36:16 INFO - PROCESS | 5739 | Values: 124.0 138.0 124.0 128.0 122.0 123.0 124.0 128.0 168.0 124.0 10:36:16 INFO - PROCESS | 5739 | 10:36:16 INFO - PROCESS | 5739 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:167.80 Median:169.00 stddev:3.19 (1.9%) stddev-sans-first:3.28 10:36:16 INFO - PROCESS | 5739 | Values: 170.0 169.0 172.0 165.0 172.0 167.0 162.0 169.0 166.0 166.0 10:36:16 INFO - PROCESS | 5739 | 10:36:16 INFO - PROCESS | 5739 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:68.40 Median:68.00 stddev:1.96 (2.9%) stddev-sans-first:1.58 10:36:16 INFO - PROCESS | 5739 | Values: 72.0 68.0 67.0 71.0 70.0 68.0 68.0 66.0 67.0 67.0 10:36:16 INFO - PROCESS | 5739 | -------- Summary: end -------- 10:36:16 INFO - PROCESS | 5739 | 10:36:17 INFO - TEST-INFO | 5739: exit 0 10:36:17 INFO - TEST-OK | kraken | took 60731ms 10:36:17 INFO - SUITE-END | took 1172s 10:36:17 INFO - Completed test suite (00:19:33) 10:36:17 INFO - javascript benchmark 10:36:17 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3103.208681786145, 3127.765417593678, 3169.286910445149, 3169.7464202863757, 3197.2965947491552, 5144.048351055048, 5262.473752624735, 5312.096943519601, 5326.866828329294, 5328.520433161015, 5242.239875218091, 5254.842354729355, 5257.7108259045735, 5351.678899266037, 5374.516293533581, 4766.642501812361, 4807.711537307773, 4808.302796094564, 4865.075635629237, 4894.094592500381, 4789.497102804207, 4800.159972004885, 4839.685420447659, 4841.830535931225, 4862.14912390332, 4703.106409782147, 4796.304535842318, 4813.229883218686, 4826.058918510892, 4870.5860001900055, 4820.060088282787, 4840.298156767249, 4848.684835485682, 4848.781804818792, 4878.048780487807, 4744.383230180089, 4808.062427826575, 4813.807447702123, 4817.277408388734, 4832.275158726184, 5162.535371816554, 5214.713190774506, 5217.791288348461, 5248.343957005374, 5283.339582552181, 5622.493975542221, 5627.6060675752715, 5648.661080335193, 5650.971745141289, 5655.321361436613, 5614.803481878155, 5622.465865742748, 5669.518090962232, 5674.773009079632, 5692.231548740909, 5181.766820493049, 5192.948070519285, 5202.375714914235, 5224.190250511177, 5238.292830467876, 5671.432856714378, 5672.688002159838, 5677.829665110054, 5680.233168522279, 5686.545076393879, 5457.945420545823, 5470.781168753285, 5471.7264136793, 5544.861378465571, 5607.158926161109, 5624.97187514068, 5630.60585758993, 5631.352394474688, 5632.718364081779, 5664.433556644302, 5594.636348637407, 5599.188117722907, 5599.80400685974, 5600.27196464457, 5603.3836278009385, 5363.115086010843, 5497.285352904177, 5591.133374326986, 5612.831615051473, 5617.157426385993, 4289.592488713567, 4292.9570704292555, 4293.677974151951, 4297.119090586422, 4327.112941846976, 3847.672947799412, 3860.208657225262, 3871.4192871069563, 3886.436466712311, 3887.8250478728523, 5161.819336323286, 5239.214117882272, 5281.366236051698, 5364.195370694427, 5374.731263436891, 5653.547716182696, 5654.97172514143, 5659.434056594308, 5665.3201615806365, 5672.744726487318, 5295.285136506523, 5310.0, 5316.521513063843, 5336.279602253724, 5377.7311134443125, 4744.7627618618935, 4836.540528649773, 4858.854234372974, 4917.926231106536, 4925.630577706686, 5752.395998420106, 5769.68266745333, 5777.104548794943, 5779.306483222041, 5779.566532509994, 5435.619506634498, 5586.1062230043, 5590.189422533791, 5594.636348637326, 5633.8309850704545, 5705.885882282414, 5733.226014487991, 5735.139729040678, 5788.623739456922, 5792.681402522901, 5545.445455454423, 5564.443555644403, 5572.554195664256, 5577.0797818359515, 5577.6653400796085, 5483.122700367922, 5552.416996215501, 5640.4077571856005, 5650.63270887391, 5653.915191272216, 5557.1108622621805, 5565.165225216088, 5568.582356323211, 5571.860703482445, 5613.242212301287, 5543.223948647112, 5554.055810512142, 5554.75003624846, 5555.0, 5558.194061861089, 5376.19357096423, 5387.892242155213, 5453.590980676386, 5462.262594549685, 5469.316335458067, 5553.444655534414, 5558.055130627722, 5561.6663000220115, 5574.832755017356, 5602.327720673546, 5392.110301800316, 5438.075527160313, 5441.918371224514, 5443.646162999393, 5449.509544141047], "value": 5194.8650263086965, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [595.7081030295154, 633.3444884544498, 637.7735903754167, 651.2575663743332, 658.7134596450547, 30777.692223077764, 31166.376672466566, 31443.213919651993, 32421.0, 32521.51217731736, 41206.38190427146, 41856.79071604645, 41861.581384186225, 41927.0, 41976.0, 8427.831443371113, 8615.741527754177, 8638.956805215965, 8639.049704532496, 8639.179277968615, 7925.722599708983, 9792.804143917117, 10167.898321016806, 10167.949160254188, 10174.54214560343, 10257.743556411075, 10383.636572719955, 10397.480125993708, 10407.739806504822, 10408.791824163513, 7868.803279917991, 10131.189504839595, 10231.590736370574, 10376.118029967462, 10382.169426445866, 10164.186865050779, 10314.896851031544, 10327.948360258226, 10335.173186145166, 10336.483175841178, 37092.629073709184, 37631.81184094089, 37801.62198378036, 37820.62179378198, 37831.0, 3216.5818443602416, 3219.710226079664, 3272.754543409254, 3398.1334759636384, 3920.15716620925, 29659.258518537208, 30731.0, 31053.0, 31149.221269468446, 31426.528602070986, 4189.2668782963165, 4194.182134483777, 4250.914981700349, 4268.59448352406, 4290.184864875664, 329331.0, 329642.0, 331584.0, 332342.0, 335025.99999999756, 54136.0, 54947.72526137344, 55034.72482637561, 55035.44964550383, 55052.72473637606, 58271.125933111034, 58480.0, 58495.12257316144, 58619.4138058614, 58763.41236587665, 16284.26720797567, 16742.24659890308, 16765.664686706197, 16768.748468772734, 16770.496885093467, 13082.738345233041, 13165.934170329087, 13165.934170329087, 13166.210027398387, 13170.539031133865, 15516.844831551765, 15598.844011559966, 15737.0, 15747.976381535163, 15775.29011194499, 6415.1981002374705, 6502.284748677736, 6563.573367731082, 6570.145881035435, 6659.101021362054, 1058.8517607534952, 1092.191778084212, 1099.9560017599206, 1169.1640477058943, 1188.4295538141741, 28028.43943121126, 28310.15069547917, 28482.430351392857, 28584.857075714488, 28689.426211475653, 1037.1513175902626, 1135.3698697222956, 1160.3502038858267, 1179.6932797472718, 1191.8867707567767, 15353.720125661042, 16011.27949242287, 16130.0, 16190.0, 16216.513504594881, 473090.0, 476358.0, 478370.0, 478895.0, 479317.0, 56793.0, 57170.714146429, 57266.0, 57270.14094788582, 57338.71330643404, 1216.318861437598, 1393.9930300348635, 1420.7371636247121, 1428.957131286063, 1480.9851901481063, 25402.74597254078, 26617.600735988588, 27410.45179096367, 27609.86195069012, 27694.72305277002, 41962.0, 41962.79018604887, 42283.7885810569, 42409.0, 42560.5743942569, 285993.0, 286485.0, 287249.0, 288639.0, 289117.0, 23754.0, 27807.497325240827, 28722.569161463012, 28769.42461150807, 28800.567991480562, 44037.779811100736, 44907.0, 45956.7702161487, 46050.0, 46111.07777844492, 37957.81021094987, 38102.618973809906, 38306.61693383031, 38610.0, 38889.22221555497, 38205.0, 38777.61222387853, 38925.416118757676, 39030.316362036734, 39451.60548394594, 38993.610063898996, 39809.2038159241, 40082.799586001885, 40171.79914100411, 40233.0, 28182.71817281883, 29395.0, 29612.407751845272, 29663.0, 29685.85157074201, 23756.0, 23895.402614934766, 24459.820647965855, 24824.627630585193, 24959.875200624607], "value": 19018.028531570242, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [378.12436421018145, 382.8870483207452, 387.67822707153067, 389.40809968847356, 398.3228511530399, 17456.738148927776, 18494.352697655602, 18520.536986575342, 18528.166232519536, 18540.536486587844, 18022.639547209048, 18113.0, 18752.718709219374, 18847.62304753904, 18990.90504547479, 5496.285482887219, 5548.278723765905, 5627.437256274381, 5671.744771485272, 5676.176954341618, 5480.780768769245, 5536.0, 5551.1673249012765, 5558.360788509332, 5561.860953476155, 5575.526080283161, 5612.0, 5635.5491560675255, 5648.802291919784, 5649.096144616862, 5564.582656300773, 5721.856953576153, 5745.052066409037, 5758.42415758425, 5759.68321742304, 5106.029854327666, 5114.207297868837, 5118.6416950813455, 5120.667156634807, 5466.617336786427, 12908.548200812926, 13066.934665326613, 13191.2744799036, 13191.538296159684, 17679.911600442043, 2245.6856040154394, 2282.4065742906796, 2329.906803727849, 2333.9066437342485, 2387.582173119697, 9278.1649651531, 9391.154796068318, 9779.755506112333, 9855.753606159831, 10152.898471015269, 1822.772153480815, 1891.366392258595, 1929.2861641192708, 1940.5633732410236, 1992.501874531367, 73088.63455682741, 75215.62392188005, 75964.0, 76667.99999999945, 76822.0, 10047.899521004843, 10077.445740484198, 10215.489225538693, 10221.0, 10427.791444171226, 14331.928340358232, 14393.208373539346, 14426.567202983928, 14428.278586070655, 14434.494792682206, 7750.496217745828, 7969.800754981055, 7987.081485629227, 8120.309773669304, 8166.0, 7656.310932016146, 7731.729389471341, 7818.218178182136, 7819.3744500439825, 7842.372610191171, 4334.696571240046, 4336.3278691802825, 4372.497162826252, 4382.627476664519, 4393.406890069864, 1873.7751469823709, 1951.6096780643927, 1952.6485232657974, 1989.6120256549834, 1991.3030439346403, 851.7019043334907, 982.3761911186448, 982.6167794560128, 1036.23836480187, 1103.784761971424, 18107.909460452614, 18233.817661823476, 18807.247710091717, 18823.211794879466, 18945.621087578173, 996.1460415908371, 1014.497823577334, 1020.7295066807302, 1042.3224903812431, 1055.5988724284723, 8426.915730842613, 10347.534360953776, 10409.063184313296, 10726.785464290826, 10780.191485638608, 454014.0, 474169.0, 508538.0, 516251.0, 517579.0, 51216.0, 54882.72558637261, 55992.0, 88654.0, 94527.0, 1058.0953284941418, 1072.2279958429917, 1093.1254996003324, 1112.6884472347756, 1113.5935383585095, 12111.152219344915, 15726.29231684554, 16080.597985050468, 16652.417165399154, 16959.406420775213, 36834.0, 37719.81140094282, 38086.42870356891, 38421.0, 39372.80313598413, 46265.0, 48374.51625483841, 48609.270860936405, 48617.270740938206, 49898.251526226406, 8086.6361013755695, 8264.135238510531, 8451.577421128795, 8477.067522572635, 8559.95720021396, 9199.908000919904, 12793.552225672056, 13164.934175329063, 13212.933935330262, 13236.338183091, 10217.33587316822, 10945.0, 11104.0, 11466.140039496904, 11693.298402095901, 10422.635207767691, 10581.259311848406, 11125.388103654377, 11136.38749868765, 11202.775944481227, 11693.181477296508, 11830.11274154459, 11901.761964760482, 12014.879851201726, 12361.567345142877, 8342.0, 8387.66449342044, 8419.158084191531, 8585.613647386008, 8611.397202195787, 11813.291202527877, 11829.17195796286, 11833.82249266279, 11997.040236781211, 12290.569830055905], "value": 8726.509922869122, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1153.348358177629, 1444.5088669852248, 1479.4895760962468, 1607.2124658917135, 1745.9912700436503, 7655.732049378273, 7902.604869756511, 7914.722984695537, 7929.088154862186, 7934.365250779938, 8073.515589064646, 8330.875036874437, 8335.91664083359, 8349.666013359474, 8355.623996920138, 1992.4620352504814, 2229.5429436965383, 2276.7609401012946, 2279.5326957973575, 2302.251768175341, 2240.955180896381, 2268.6143355629583, 2268.739095004079, 2269.5914735347633, 2274.3404412720292, 2219.6004719150546, 2252.8085112765434, 2258.525709600986, 2259.5706815705043, 2263.2531264682616, 1996.4908948218183, 2223.7776222377793, 2277.954440911189, 2279.8290128240365, 2283.4177284792436, 2175.4996350839237, 2185.3880913344287, 2187.453136715821, 2188.595109904673, 2247.3370355745096, 8266.380021498411, 8366.790830229233, 8381.874271885865, 8389.95805020971, 8406.327493800482, 4954.950450495485, 5073.340465739467, 5082.33929589151, 5106.336176297094, 5129.563987061104, 3308.669133086672, 3317.5189597508224, 3351.581052368454, 3393.6267010628812, 3399.847006884696, 1128.8588926384202, 1145.3643228008452, 1148.2192109365628, 1161.5934422951984, 1163.8254261860789, 11186.384748838811, 11233.831492527537, 11243.437828108561, 11279.943600281946, 11308.264962777394, 4169.10364271683, 4284.507281662586, 4401.779911004501, 4466.39703640011, 4472.172648060119, 9522.571484283224, 9533.046695330411, 9533.809323813484, 9535.2371810255, 9548.1884039856, 4608.723476591415, 4995.650304478724, 5004.874878128003, 5033.194688849767, 5045.192769156917, 4525.7510836904285, 4598.563136502027, 4599.724016559017, 4611.792469338888, 4654.813807447732, 3790.7156963227867, 3839.6736277416176, 3858.2862170498547, 3877.9806100969877, 3900.1809619979554, 1203.825445310425, 1215.489494412349, 1234.796258617336, 1236.344737289238, 1250.331072876007, 937.315759495572, 985.930265661765, 992.8758905136858, 1009.3590569988111, 1009.6012075230243, 5736.282964629421, 5770.422957704196, 5958.46373826349, 6005.39946005396, 6077.17958075663, 946.9952650236705, 960.1262850805733, 972.5186032913612, 981.9214462842956, 995.2187532786728, 4093.97953010239, 4117.3206420940805, 4127.277726397869, 4135.0902801383645, 4136.834526618902, 9685.0, 10128.493575321352, 10166.745831354126, 10196.286259961731, 10197.031282028196, 10288.794224115476, 10376.0, 10419.218558608134, 10431.0, 10438.895611043945, 7450.217727138681, 7730.574818385043, 7790.961045194737, 7797.532148071021, 8002.279794818494, 5665.915011274752, 5720.170575266647, 5821.505172060422, 5864.149698293809, 5883.0881213411985, 8964.0, 9411.764705882408, 9528.52357382142, 9587.952060239653, 9698.660546880825, 9360.859587106062, 9616.9038309616, 9742.95128524353, 9776.071273229032, 9870.062344077302, 6420.101185834081, 7101.396381307647, 7193.280671932974, 7297.014902988029, 7344.192138864613, 7745.806354841174, 7751.341136003277, 7756.689732410866, 7780.49426787257, 7786.727464538714, 6966.12923384577, 7031.1211098612675, 7145.285471452813, 7177.892331614926, 7192.280771922766, 7042.471814614027, 7045.26024767392, 7056.188538317954, 7117.288271172842, 7123.893141602776, 6478.255000674794, 6651.102101216274, 6684.16447944007, 6686.063951046955, 6877.243503214742, 5125.461826508163, 5198.532132108128, 5206.55744261742, 5215.191645294985, 5229.869253268699, 5209.479052094912, 5246.213068039825, 5255.553277971415, 5263.736813159403, 5339.679619222859], "value": 4451.060687598199, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [303.9407315573464, 319.2593183813553, 321.0705008998948, 322.24272958547414, 323.9222586579219, 5645.661260324383, 5748.683822389767, 5813.563982701298, 5875.118732190168, 5892.440218179277, 5825.126231065342, 5853.209816674747, 5857.364186116243, 5869.471747542721, 5892.941070589292, 4443.622292105175, 4454.465464144308, 4463.263561512363, 4468.798904049309, 4470.82116715331, 4367.934480982772, 4439.556044395551, 4498.50516443191, 4507.391502147201, 4511.661625378093, 4407.699728580076, 4412.40432541606, 4427.977860110695, 4446.0, 4450.488193857699, 4427.269500532424, 4450.176717307292, 4467.240569103228, 4468.575485328888, 4472.08322293929, 3651.926961460756, 3851.114243723959, 3913.8434462621462, 3918.3338832398563, 3924.7841368724708, 5575.968445837492, 5587.217789509472, 5602.803901863415, 5616.803411880605, 5628.409017053192, 5016.398032236155, 5032.345795046621, 5034.565148932536, 5051.292819005343, 5082.110630639623, 5715.3998830122655, 6002.459778619901, 6017.06735456005, 6063.969680151615, 6082.270127584674, 4194.266003449415, 4208.979689748938, 4210.389493523453, 4217.472815898012, 4232.746035237896, 6306.527010474233, 6340.841478963062, 6367.936320636781, 6388.584741991802, 6402.647854368008, 4250.681198910094, 4336.674749393745, 4339.0, 4345.804438800262, 4370.562943705604, 4359.367891655692, 4397.494288156839, 4398.978005109954, 4399.560043995575, 4401.163778882066, 5046.949530504648, 5076.644634875597, 5078.796848126108, 5085.186370180753, 5095.668781529189, 5824.737886795105, 5900.695610458071, 5965.522758179422, 6087.777961044187, 6088.756449742049, 1508.0122519749361, 1514.9091054536764, 1521.0, 1525.0392252880615, 1528.4497580870877, 975.8194733974095, 1001.3341128149845, 1007.8437842134481, 1016.506994107857, 1019.6176433837311, 5852.473277405054, 5857.736401861926, 5865.296164460292, 5868.354481007086, 5894.469497745138, 6247.3440288769025, 6250.218722659668, 6258.655773932386, 6267.373262673696, 6292.244930608356, 5664.575156863251, 5859.472647461749, 5965.821025369246, 5968.104784282305, 5975.163477113208, 3335.4163021471145, 3347.0962840033053, 3370.76404651672, 3395.168183794986, 3401.5748031496064, 6297.559170858088, 6488.188976377953, 6492.72814447812, 6494.64279464634, 6495.1556297681, 6396.392342727433, 6402.423781859655, 6423.903641445382, 6477.125588045554, 6480.092787009822, 6190.628562286187, 6440.935590644127, 6443.806685799434, 6484.805455836333, 6516.380943810331, 6273.404026617464, 6311.463525600192, 6313.1477250572425, 6323.691852473722, 6407.9038814418755, 6271.247450305992, 6273.153124328157, 6277.717502712298, 6287.2140982377205, 6296.181496405438, 6266.811995640138, 6485.632744048294, 6517.8696426072165, 6538.901916471352, 6540.258312723237, 4249.745015299092, 4285.035866929916, 4290.57094290581, 4302.419173411549, 4309.84915527955, 5935.554833387427, 6185.0, 6358.618482891041, 6373.458256048102, 6379.553431259767, 6142.078688196806, 6151.200343955257, 6158.168647232566, 6164.3835616438, 6184.165137706532, 6028.608140470856, 6158.3225845157895, 6163.260408750979, 6174.66039367839, 6178.289496707936, 5976.6712830792985, 5986.640801551921, 5995.850103747267, 6030.3668114847305, 6031.306399763907, 6127.3259941407305, 6153.246324797411, 6164.691765411621, 6178.320384757583, 6202.658853763086, 5940.346561878104, 6007.48936340416, 6016.278046634432, 6020.8795824084145, 6052.757889684363], "value": 4602.0189593418345, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [731.8572878288734, 760.9315161635452, 774.9341305988991, 779.8518281526509, 802.6789284286289, 14461.927690361546, 14561.490347837827, 14619.342129604167, 14844.88663350249, 14863.40546378145, 13363.331833408314, 13402.329883505834, 13481.39333729982, 13496.932515337434, 13552.728945421086, 681.2778454837863, 797.8603744344746, 815.302916006813, 826.8801023851538, 828.5815663090161, 829.050736906242, 835.7200337886816, 835.9916400836005, 836.6235194162621, 836.9163083691643, 863.7840539865034, 870.6343335798948, 871.4379225399614, 871.5642178910545, 873.1879352202449, 693.9132608423922, 837.1001173738256, 863.6890719341033, 866.1079088538752, 866.4411454611771, 630.7256343490596, 631.3497097989078, 631.356016862802, 632.0550776589029, 634.7016902056026, 14400.927995360062, 14402.135871847722, 14405.78391324131, 14406.279686015761, 14443.711125777425, 13860.237686927216, 14014.229217393142, 14038.789418158736, 14158.858411415857, 14237.430502779876, 10981.780364392747, 11211.103111751041, 11335.886641133648, 11361.142964937604, 11393.902203659014, 3844.826982785781, 3870.6599206783144, 3901.2392583445953, 3955.7626542407547, 3988.3020471417385, 54975.17537236945, 55024.0, 55175.0, 55881.72059139719, 56284.15573766397, 10480.528376223088, 10715.571377144983, 10757.784844303227, 10807.513661885234, 10888.183386246063, 18309.725354119433, 19101.331453399063, 19167.424977250706, 19173.808261917482, 19191.32830350931, 8383.496990180609, 8443.873341899876, 8478.660853565912, 8510.872336914952, 8604.913950860537, 4860.198067318853, 4901.411830580353, 4935.136351138536, 4938.0, 5023.372078490189, 3374.5106959490736, 3427.8800241991908, 3428.8285585720614, 3429.3998550253605, 3431.897043088711, 599.7570983751588, 602.4337123104356, 611.4405319132943, 614.2322097378277, 617.8548041210312, 686.9484788640872, 750.159821000472, 757.8408534207767, 763.4007304266124, 772.4669977715358, 9306.86039709405, 9311.394759340621, 9333.579988900516, 9433.386829856174, 9603.47180905043, 585.9033259512132, 587.6251309004506, 669.2805234373069, 703.9394869459331, 704.112817849503, 4564.2012647786505, 4580.931286030712, 4607.7004994675235, 4618.214903466419, 4676.9750068253725, 62892.056619150746, 62972.370276297566, 64068.35931640717, 64395.356046439876, 64461.0, 55582.0, 55949.44050559524, 56075.15887261694, 56749.14876276859, 57461.0, 44653.77673111614, 45243.32135017977, 46972.999999999316, 47508.5249147511, 49070.50929490731, 8963.983103801593, 9235.307351948497, 9257.444553326823, 9530.761730956505, 9557.761055973657, 31325.686743132275, 31615.525767113973, 32186.83906580452, 32582.67417325891, 33359.0, 45423.54576454193, 45597.316040260084, 45867.31199032084, 46075.61773146811, 47075.0, 11183.217174798012, 11304.60433884843, 11308.943455282671, 11419.486123124314, 11706.239094458833, 13175.2753598553, 13227.074104812571, 13257.204567725967, 13313.134646247963, 13436.596902092953, 9434.528273586431, 12783.296918669563, 12904.290264035568, 13014.691284494815, 13226.537071202461, 12461.688457788629, 12678.0, 12772.361381930681, 12835.229886206484, 12871.356432178167, 12734.87265127374, 12839.293838838954, 12949.741005180033, 12950.158239714388, 13162.14446061003, 11094.223404361617, 11116.833247501456, 11267.154963377616, 11309.547618095185, 11479.598214062467, 11303.0, 11367.886321137014, 11452.312861228353, 11553.422328883355, 11584.304941703525], "value": 6764.3301411776065, "unit": "score"}], "name": "dromaeo_css", "value": 7017.940528877634, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [113.0, 114.0, 106.0, 110.0, 112.0, 110.0, 102.0, 112.0, 111.0, 110.0], "value": 110.0, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [160.0, 127.0, 157.0, 177.0, 130.0, 154.0, 158.0, 129.0, 190.0, 138.0], "value": 152.0, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [161.0, 161.0, 163.0, 161.0, 160.0, 161.0, 160.0, 161.0, 162.0, 161.0], "value": 161.1, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 71.0, 112.0, 105.0, 76.0, 75.0, 74.0, 124.0, 101.0, 75.0], "value": 88.9, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [92.0, 92.0, 153.0, 93.0, 93.0, 92.0, 151.0, 92.0, 92.0, 145.0], "value": 109.5, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 117.0, 117.0, 117.0, 116.0, 117.0, 117.0, 117.0, 116.0, 117.0], "value": 116.8, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [145.0, 145.0, 145.0, 152.0, 145.0, 145.0, 145.0, 146.0, 146.0, 145.0], "value": 145.9, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 94.0, 94.0, 96.0, 95.0, 94.0, 94.0, 94.0, 94.0, 95.0], "value": 94.5, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [56.0, 57.0, 58.0, 56.0, 55.0, 55.0, 57.0, 82.0, 62.0, 56.0], "value": 59.4, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [61.0, 62.0, 61.0, 61.0, 62.0, 61.0, 61.0, 62.0, 64.0, 61.0], "value": 61.6, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [77.0, 76.0, 76.0, 76.0, 82.0, 77.0, 79.0, 77.0, 78.0, 78.0], "value": 77.6, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [124.0, 138.0, 124.0, 128.0, 122.0, 123.0, 124.0, 128.0, 168.0, 124.0], "value": 130.3, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [170.0, 169.0, 172.0, 165.0, 172.0, 167.0, 162.0, 169.0, 166.0, 166.0], "value": 167.8, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [72.0, 68.0, 67.0, 71.0, 70.0, 68.0, 68.0, 66.0, 67.0, 67.0], "value": 68.4, "unit": "score"}], "name": "kraken", "value": 1543.7999999999997, "alertThreshold": 2.0}]} 10:36:17 INFO - Return code: 0 10:36:17 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 10:36:17 ERROR - # TBPL SUCCESS # 10:36:17 INFO - Running post-action listener: _resource_record_post_action 10:36:17 INFO - Running post-run listener: _resource_record_post_run 10:36:18 INFO - Total resource usage - Wall time: 1191s; CPU: 13.0%; Read bytes: 499712; Write bytes: 293396480; Read time: 68; Write time: 248816 10:36:18 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 4775936; Read time: 0; Write time: 372 10:36:18 INFO - run-tests - Wall time: 1174s; CPU: 13.0%; Read bytes: 499712; Write bytes: 288620544; Read time: 68; Write time: 248444 10:36:18 INFO - Running post-run listener: _upload_blobber_files 10:36:18 INFO - Blob upload gear active. 10:36:18 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 10:36:18 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 10:36:18 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', 'Firefox', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 10:36:18 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 Firefox -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 10:36:19 INFO - (blobuploader) - INFO - Open directory for files ... 10:36:19 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 10:36:19 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 10:36:19 INFO - (blobuploader) - INFO - Uploading, attempt #1. 10:36:20 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 10:36:20 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 10:36:20 INFO - (blobuploader) - INFO - Done attempting. 10:36:20 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 10:36:20 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 10:36:20 INFO - (blobuploader) - INFO - Uploading, attempt #1. 10:36:20 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 10:36:20 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 10:36:20 INFO - (blobuploader) - INFO - Done attempting. 10:36:20 INFO - (blobuploader) - INFO - Iteration through files over. 10:36:20 INFO - Return code: 0 10:36:20 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 10:36:20 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 10:36:20 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/d75074b2a0b691bbcb69ec7e890468bbabda27939ebbe947c2899cea369b4da0cd1cdce742c3c8c502dfec99bf9b9f786ff914e03ba80c07e77aa6ab95caea5d", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/c6462d46beff13d6f0a2c72cfac9cce0df43ccb74dcd7bb3fb7e0fbb754618efb3200128a5f8ad8aba81ac2a3db4e91950646a2a546957c3459fb2edc1d16ebf"} 10:36:20 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 10:36:20 INFO - Writing to file /builds/slave/test/properties/blobber_files 10:36:20 INFO - Contents: 10:36:20 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/d75074b2a0b691bbcb69ec7e890468bbabda27939ebbe947c2899cea369b4da0cd1cdce742c3c8c502dfec99bf9b9f786ff914e03ba80c07e77aa6ab95caea5d", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/c6462d46beff13d6f0a2c72cfac9cce0df43ccb74dcd7bb3fb7e0fbb754618efb3200128a5f8ad8aba81ac2a3db4e91950646a2a546957c3459fb2edc1d16ebf"} 10:36:20 INFO - Running post-run listener: copy_logs_to_upload_dir 10:36:20 INFO - Copying logs to upload dir... 10:36:20 INFO - mkdir: /builds/slave/test/build/upload/logs 10:36:20 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1246.899831 ========= master_lag: 0.03 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 46 secs) (at 2016-04-23 10:36:20.736419) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-23 10:36:20.742449) ========= 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=4ac8d263c7293b36a1be1aed000001be-1461426355.958197-518667313 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/d75074b2a0b691bbcb69ec7e890468bbabda27939ebbe947c2899cea369b4da0cd1cdce742c3c8c502dfec99bf9b9f786ff914e03ba80c07e77aa6ab95caea5d", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/c6462d46beff13d6f0a2c72cfac9cce0df43ccb74dcd7bb3fb7e0fbb754618efb3200128a5f8ad8aba81ac2a3db4e91950646a2a546957c3459fb2edc1d16ebf"} build_url:https://queue.taskcluster.net/v1/task/b0Xfub06QRuOOWFfunc99g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011235 build_url: 'https://queue.taskcluster.net/v1/task/b0Xfub06QRuOOWFfunc99g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/d75074b2a0b691bbcb69ec7e890468bbabda27939ebbe947c2899cea369b4da0cd1cdce742c3c8c502dfec99bf9b9f786ff914e03ba80c07e77aa6ab95caea5d", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/c6462d46beff13d6f0a2c72cfac9cce0df43ccb74dcd7bb3fb7e0fbb754618efb3200128a5f8ad8aba81ac2a3db4e91950646a2a546957c3459fb2edc1d16ebf"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-23 10:36:20.771197) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-23 10:36:20.771823) ========= 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=4ac8d263c7293b36a1be1aed000001be-1461426355.958197-518667313 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004375 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-23 10:36:20.857620) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-23 10:36:20.858321) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-23 10:36:20.858798) ========= ========= Total master_lag: 0.20 =========