builder: autoland_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-023 starttime: 1470850899.7 results: success (0) buildid: 20160810090020 builduid: 2ab29804b1664262a13740db157c75de revision: fe582cf4fffdc8faee63f925afb25ce21a2881c1 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-08-10 10:41:39.696239) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-08-10 10:41:39.696695) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-08-10 10:41:39.696971) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-08-10 10:41:39.712059) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-10 10:41:39.712378) ========= 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=6d15e502d8e29d5d2676d664000001c3-1470850899.276051-603618958 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-08-10 10:41:40-- 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% 225M=0s 2016-08-10 10:41:40 (225 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.080252 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-10 10:41:39.806578) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-08-10 10:41:39.806928) ========= 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=6d15e502d8e29d5d2676d664000001c3-1470850899.276051-603618958 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.020641 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-08-10 10:41:39.857063) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-08-10 10:41:39.857439) ========= bash -c 'python archiver_client.py mozharness --repo integration/autoland --rev fe582cf4fffdc8faee63f925afb25ce21a2881c1 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/autoland --rev fe582cf4fffdc8faee63f925afb25ce21a2881c1 --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=6d15e502d8e29d5d2676d664000001c3-1470850899.276051-603618958 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-08-10 10:41:40,192 truncating revision to first 12 chars 2016-08-10 10:41:40,192 Setting DEBUG logging. 2016-08-10 10:41:40,192 attempt 1/10 2016-08-10 10:41:40,192 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/autoland/fe582cf4fffd?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-08-10 10:41:41,016 unpacking tar archive at: autoland-fe582cf4fffd/testing/mozharness/ program finished with exit code 0 elapsedTime=1.152090 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-08-10 10:41:41.023641) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-08-10 10:41:41.023972) ========= script_repo_revision: fe582cf4fffdc8faee63f925afb25ce21a2881c1 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-08-10 10:41:41.024395) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-08-10 10:41:41.024653) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-08-10 10:41:41.035859) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 37 secs) (at 2016-08-10 10:41:41.036560) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Autoland-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Autoland-Non-PGO in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Autoland-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Autoland-Non-PGO'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=6d15e502d8e29d5d2676d664000001c3-1470850899.276051-603618958 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 10:41:41 INFO - MultiFileLogger online at 20160810 10:41:41 in /builds/slave/test 10:41:41 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Autoland-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Autoland-Non-PGO 10:41:41 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 10:41:41 INFO - {'append_to_log': False, 10:41:41 INFO - 'base_work_dir': '/builds/slave/test', 10:41:41 INFO - 'blob_upload_branch': 'Autoland-Non-PGO', 10:41:41 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 10:41:41 INFO - 'branch': 'Autoland-Non-PGO', 10:41:41 INFO - 'buildbot_json_path': 'buildprops.json', 10:41:41 INFO - 'config_files': ('talos/linux_config.py',), 10:41:41 INFO - 'default_actions': ('clobber', 10:41:41 INFO - 'read-buildbot-config', 10:41:41 INFO - 'download-and-extract', 10:41:41 INFO - 'populate-webroot', 10:41:41 INFO - 'create-virtualenv', 10:41:41 INFO - 'install', 10:41:41 INFO - 'run-tests'), 10:41:41 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 10:41:41 INFO - 'download_minidump_stackwalk': True, 10:41:41 INFO - 'download_symbols': 'ondemand', 10:41:41 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 10:41:41 INFO - 'tooltool.py': '/tools/tooltool.py', 10:41:41 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 10:41:41 INFO - '/tools/misc-python/virtualenv.py')}, 10:41:41 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 10:41:41 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 10:41:41 INFO - 'installer_path': 'installer.exe', 10:41:41 INFO - 'log_level': 'info', 10:41:41 INFO - 'log_name': 'talos', 10:41:41 INFO - 'log_to_console': True, 10:41:41 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 10:41:41 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 10:41:41 INFO - 'opt_config_files': (), 10:41:41 INFO - 'pip_index': False, 10:41:41 INFO - 'sps_profile': False, 10:41:41 INFO - 'sps_profile_interval': 0, 10:41:41 INFO - 'suite': 'dromaeojs-e10s', 10:41:41 INFO - 'system_bits': '32', 10:41:41 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 10:41:41 INFO - 'title': 'talos-linux64-ix-023', 10:41:41 INFO - 'tooltool_cache': '/builds/tooltool_cache', 10:41:41 INFO - 'use_talos_json': True, 10:41:41 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 10:41:41 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 10:41:41 INFO - 'work_dir': 'build'} 10:41:41 INFO - [mozharness: 2016-08-10 17:41:41.465459Z] Running clobber step. 10:41:41 INFO - Running pre-action listener: _resource_record_pre_action 10:41:41 INFO - Running main action method: clobber 10:41:41 INFO - rmtree: /builds/slave/test/build 10:41:41 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 10:41:41 INFO - Running post-action listener: _resource_record_post_action 10:41:41 INFO - [mozharness: 2016-08-10 17:41:41.921221Z] Finished clobber step (success) 10:41:41 INFO - [mozharness: 2016-08-10 17:41:41.921323Z] Running read-buildbot-config step. 10:41:41 INFO - Running pre-action listener: _resource_record_pre_action 10:41:41 INFO - Running main action method: read_buildbot_config 10:41:41 INFO - Using buildbot properties: 10:41:41 INFO - { 10:41:41 INFO - "project": "", 10:41:41 INFO - "product": "firefox", 10:41:41 INFO - "script_repo_revision": "production", 10:41:41 INFO - "builddir": "autoland_ubuntu64_hw_test-dromaeojs-e10s", 10:41:41 INFO - "repository": "", 10:41:41 INFO - "buildername": "Ubuntu HW 12.04 x64 autoland talos dromaeojs-e10s", 10:41:41 INFO - "buildid": "20160810090020", 10:41:41 INFO - "pgo_build": "False", 10:41:41 INFO - "basedir": "/builds/slave/test", 10:41:41 INFO - "buildnumber": 272, 10:41:41 INFO - "slavename": "talos-linux64-ix-023", 10:41:41 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 10:41:41 INFO - "platform": "ubuntu64_hw", 10:41:41 INFO - "scheduler": "tests-autoland-linux64-talos", 10:41:41 INFO - "branch": "autoland", 10:41:41 INFO - "repo_path": "integration/autoland", 10:41:41 INFO - "revision": "fe582cf4fffdc8faee63f925afb25ce21a2881c1", 10:41:41 INFO - "stage_platform": "linux64", 10:41:41 INFO - "builduid": "2ab29804b1664262a13740db157c75de", 10:41:41 INFO - "slavebuilddir": "test" 10:41:41 INFO - } 10:41:41 INFO - Found installer url https://queue.taskcluster.net/v1/task/bFA_a0i3SP6SjBuZbj49jg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2. 10:41:41 INFO - Running post-action listener: _resource_record_post_action 10:41:41 INFO - [mozharness: 2016-08-10 17:41:41.923761Z] Finished read-buildbot-config step (success) 10:41:41 INFO - [mozharness: 2016-08-10 17:41:41.923851Z] Running download-and-extract step. 10:41:41 INFO - Running pre-action listener: _resource_record_pre_action 10:41:41 INFO - Running main action method: download_and_extract 10:41:41 INFO - mkdir: /builds/slave/test/build/tests 10:41:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:41:41 INFO - trying https://queue.taskcluster.net/v1/task/bFA_a0i3SP6SjBuZbj49jg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 10:41:41 INFO - Downloading https://queue.taskcluster.net/v1/task/bFA_a0i3SP6SjBuZbj49jg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 10:41:41 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/bFA_a0i3SP6SjBuZbj49jg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 10:41:42 INFO - Downloaded 1361 bytes. 10:41:42 INFO - Reading from file /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 10:41:42 INFO - Using the following test package requirements: 10:41:42 INFO - {u'common': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'], 10:41:42 INFO - u'cppunittest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 10:41:42 INFO - u'firefox-51.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 10:41:42 INFO - u'gtest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 10:41:42 INFO - u'firefox-51.0a1.en-US.linux-x86_64.gtest.tests.zip'], 10:41:42 INFO - u'jittest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 10:41:42 INFO - u'jsshell-linux-x86_64.zip'], 10:41:42 INFO - u'mochitest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 10:41:42 INFO - u'firefox-51.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 10:41:42 INFO - u'mozbase': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'], 10:41:42 INFO - u'reftest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 10:41:42 INFO - u'firefox-51.0a1.en-US.linux-x86_64.reftest.tests.zip'], 10:41:42 INFO - u'talos': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 10:41:42 INFO - u'firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip'], 10:41:42 INFO - u'web-platform': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 10:41:42 INFO - u'firefox-51.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 10:41:42 INFO - u'xpcshell': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 10:41:42 INFO - u'firefox-51.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 10:41:42 INFO - Downloading packages: [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 10:41:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:41:42 INFO - trying https://queue.taskcluster.net/v1/task/bFA_a0i3SP6SjBuZbj49jg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 10:41:42 INFO - Downloading https://queue.taskcluster.net/v1/task/bFA_a0i3SP6SjBuZbj49jg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 10:41:42 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/bFA_a0i3SP6SjBuZbj49jg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 10:41:43 INFO - Downloaded 20259511 bytes. 10:41:43 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 10:41:43 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 10:41:44 INFO - Return code: 0 10:41:44 INFO - Downloading packages: [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 10:41:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:41:44 INFO - trying https://queue.taskcluster.net/v1/task/bFA_a0i3SP6SjBuZbj49jg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 10:41:44 INFO - Downloading https://queue.taskcluster.net/v1/task/bFA_a0i3SP6SjBuZbj49jg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 10:41:44 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/bFA_a0i3SP6SjBuZbj49jg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 10:41:45 INFO - Downloaded 20259511 bytes. 10:41:45 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 10:41:45 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 10:41:46 INFO - Return code: 0 10:41: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:41:46 INFO - trying https://queue.taskcluster.net/v1/task/bFA_a0i3SP6SjBuZbj49jg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip 10:41:46 INFO - Downloading https://queue.taskcluster.net/v1/task/bFA_a0i3SP6SjBuZbj49jg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip 10:41:46 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/bFA_a0i3SP6SjBuZbj49jg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 10:41:47 INFO - Downloaded 14413719 bytes. 10:41:47 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 10:41:47 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 10:41:47 INFO - Return code: 0 10:41:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:41:47 INFO - trying https://queue.taskcluster.net/v1/task/bFA_a0i3SP6SjBuZbj49jg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 10:41:47 INFO - Downloading https://queue.taskcluster.net/v1/task/bFA_a0i3SP6SjBuZbj49jg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 10:41:47 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/bFA_a0i3SP6SjBuZbj49jg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 10:41:48 INFO - Downloaded 55609154 bytes. 10:41:48 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/bFA_a0i3SP6SjBuZbj49jg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 10:41:48 INFO - mkdir: /builds/slave/test/properties 10:41:48 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 10:41:48 INFO - Writing to file /builds/slave/test/properties/build_url 10:41:48 INFO - Contents: 10:41:48 INFO - build_url:https://queue.taskcluster.net/v1/task/bFA_a0i3SP6SjBuZbj49jg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 10:41:49 INFO - Running post-action listener: _resource_record_post_action 10:41:49 INFO - Running post-action listener: set_extra_try_arguments 10:41:49 INFO - [mozharness: 2016-08-10 17:41:49.538639Z] Finished download-and-extract step (success) 10:41:49 INFO - [mozharness: 2016-08-10 17:41:49.538876Z] Running populate-webroot step. 10:41:49 INFO - Running pre-action listener: _resource_record_pre_action 10:41:49 INFO - Running main action method: populate_webroot 10:41:49 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 10:41:49 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 10:41:49 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 10:41:49 INFO - '--tppagecycles', 10:41:49 INFO - '7'], 10:41:49 INFO - 'tests': ['tsvgm']}}, 10:41:49 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 10:41:49 INFO - 'tests': ['tresize', 'tcanvasmark']}, 10:41:49 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 10:41:49 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 10:41:49 INFO - 'tests': ['dromaeo_css', 'kraken']}, 10:41:49 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 10:41:49 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:41:49 INFO - 'talos_options': ['--disable-e10s'], 10:41:49 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 10:41:49 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:41:49 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 10:41:49 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:41:49 INFO - 'talos_options': ['--disable-e10s'], 10:41:49 INFO - 'tests': ['damp', 'tps']}, 10:41:49 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:41:49 INFO - 'tests': ['damp', 'tps']}, 10:41:49 INFO - 'g3': {'talos_options': ['--disable-e10s'], 10:41:49 INFO - 'tests': ['dromaeo_dom']}, 10:41:49 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 10:41:49 INFO - 'g4': {'talos_options': ['--disable-e10s'], 10:41:49 INFO - 'tests': ['basic_compositor_video']}, 10:41:49 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 10:41:49 INFO - 'other': {'talos_options': ['--disable-e10s'], 10:41:49 INFO - 'tests': ['a11yr', 10:41:49 INFO - 'ts_paint', 10:41:49 INFO - 'tpaint', 10:41:49 INFO - 'sessionrestore', 10:41:49 INFO - 'sessionrestore_no_auto_restore', 10:41:49 INFO - 'tabpaint']}, 10:41:49 INFO - 'other-e10s': {'tests': ['a11yr', 10:41:49 INFO - 'ts_paint', 10:41:49 INFO - 'tpaint', 10:41:49 INFO - 'sessionrestore', 10:41:49 INFO - 'sessionrestore_no_auto_restore', 10:41:49 INFO - 'tabpaint']}, 10:41:49 INFO - 'other-e10s_l64': {'tests': ['a11yr', 10:41:49 INFO - 'ts_paint', 10:41:49 INFO - 'tpaint', 10:41:49 INFO - 'sessionrestore', 10:41:49 INFO - 'sessionrestore_no_auto_restore', 10:41:49 INFO - 'tabpaint']}, 10:41:49 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 10:41:49 INFO - 'ts_paint', 10:41:49 INFO - 'tpaint', 10:41:49 INFO - 'sessionrestore', 10:41:49 INFO - 'sessionrestore_no_auto_restore', 10:41:49 INFO - 'tabpaint']}, 10:41:49 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 10:41:49 INFO - 'tests': ['a11yr', 10:41:49 INFO - 'ts_paint', 10:41:49 INFO - 'tpaint', 10:41:49 INFO - 'sessionrestore', 10:41:49 INFO - 'sessionrestore_no_auto_restore', 10:41:49 INFO - 'tabpaint']}, 10:41:49 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 10:41:49 INFO - 'tests': ['a11yr', 10:41:49 INFO - 'ts_paint', 10:41:49 INFO - 'tpaint', 10:41:49 INFO - 'sessionrestore', 10:41:49 INFO - 'sessionrestore_no_auto_restore', 10:41:49 INFO - 'tabpaint']}, 10:41:49 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 10:41:49 INFO - 'tests': ['tsvgx', 10:41:49 INFO - 'tsvgr_opacity', 10:41:49 INFO - 'tart', 10:41:49 INFO - 'tscrollx', 10:41:49 INFO - 'cart']}, 10:41:49 INFO - 'svgr-e10s': {'tests': ['tsvgx', 10:41:49 INFO - 'tsvgr_opacity', 10:41:49 INFO - 'tart', 10:41:49 INFO - 'tscrollx', 10:41:49 INFO - 'cart']}, 10:41:49 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:41:49 INFO - 'talos_options': ['--disable-e10s'], 10:41:49 INFO - 'tests': ['tp5o']}, 10:41:49 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:41:49 INFO - 'tests': ['tp5o']}, 10:41:49 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:41:49 INFO - 'talos_options': ['--disable-e10s', 10:41:49 INFO - '--xperf_path', 10:41:49 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 10:41:49 INFO - 'tests': ['tp5n']}, 10:41:49 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:41:49 INFO - 'talos_options': ['--xperf_path', 10:41:49 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 10:41:49 INFO - 'tests': ['tp5n']}}, 10:41:49 INFO - 'talos.zip': {'path': '', 10:41:49 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 10:41:49 INFO - Running post-action listener: _resource_record_post_action 10:41:49 INFO - [mozharness: 2016-08-10 17:41:49.561641Z] Finished populate-webroot step (success) 10:41:49 INFO - [mozharness: 2016-08-10 17:41:49.561730Z] Running create-virtualenv step. 10:41:49 INFO - Running pre-action listener: _resource_record_pre_action 10:41:49 INFO - Running main action method: create_virtualenv 10:41:49 INFO - Creating virtualenv /builds/slave/test/build/venv 10:41:49 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:41:49 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 10:41:49 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 10:41:49 INFO - Using real prefix '/usr' 10:41:49 INFO - New python executable in /builds/slave/test/build/venv/bin/python 10:41:50 INFO - Installing distribute.............................................................................................................................................................................................done. 10:41:52 INFO - Installing pip.................done. 10:41:52 INFO - Return code: 0 10:41:52 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 10:41:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:41:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:41:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:41:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:41:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:41:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:41:52 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1ba0030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d038a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1dcf400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e5e570>, '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 0x1e5f470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e5f900>, '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': '6d15e502d8e29d5d2676d664000001c3-1470850899.276051-603618958', '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:41:52 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 10:41:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 10:41:52 INFO - Using env: {'DISPLAY': ':0', 10:41:52 INFO - 'HOME': '/home/cltbld', 10:41:52 INFO - 'LANG': 'en_US.UTF-8', 10:41:52 INFO - 'LANGUAGE': 'en_US:en', 10:41:52 INFO - 'LOGNAME': 'cltbld', 10:41:52 INFO - 'MAIL': '/var/mail/cltbld', 10:41:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:41:52 INFO - 'MOZ_NO_REMOTE': '1', 10:41:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:41:52 INFO - 'NO_EM_RESTART': '1', 10:41:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:41:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:41:52 INFO - 'PWD': '/builds/slave/test', 10:41:52 INFO - 'SHELL': '/bin/bash', 10:41:52 INFO - 'SHLVL': '1', 10:41:52 INFO - 'TERM': 'linux', 10:41:52 INFO - 'TMOUT': '86400', 10:41:52 INFO - 'USER': 'cltbld', 10:41:52 INFO - 'XDG_SESSION_COOKIE': '6d15e502d8e29d5d2676d664000001c3-1470850899.276051-603618958', 10:41:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:41:52 INFO - '_': '/tools/buildbot/bin/python'} 10:41:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:41:52 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:41:52 INFO - Cleaning up... 10:41:52 INFO - Return code: 0 10:41:52 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 10:41:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:41:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:41:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:41:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:41:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:41:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:41:52 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1ba0030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d038a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1dcf400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e5e570>, '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 0x1e5f470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e5f900>, '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': '6d15e502d8e29d5d2676d664000001c3-1470850899.276051-603618958', '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:41:52 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 10:41:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 10:41:52 INFO - Using env: {'DISPLAY': ':0', 10:41:52 INFO - 'HOME': '/home/cltbld', 10:41:52 INFO - 'LANG': 'en_US.UTF-8', 10:41:52 INFO - 'LANGUAGE': 'en_US:en', 10:41:52 INFO - 'LOGNAME': 'cltbld', 10:41:52 INFO - 'MAIL': '/var/mail/cltbld', 10:41:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:41:52 INFO - 'MOZ_NO_REMOTE': '1', 10:41:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:41:52 INFO - 'NO_EM_RESTART': '1', 10:41:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:41:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:41:52 INFO - 'PWD': '/builds/slave/test', 10:41:52 INFO - 'SHELL': '/bin/bash', 10:41:52 INFO - 'SHLVL': '1', 10:41:52 INFO - 'TERM': 'linux', 10:41:52 INFO - 'TMOUT': '86400', 10:41:52 INFO - 'USER': 'cltbld', 10:41:52 INFO - 'XDG_SESSION_COOKIE': '6d15e502d8e29d5d2676d664000001c3-1470850899.276051-603618958', 10:41:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:41:52 INFO - '_': '/tools/buildbot/bin/python'} 10:41:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:41:52 INFO - Downloading/unpacking psutil>=3.1.1 10:41:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:41:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:41:52 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:41:52 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:41:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:41:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:41:54 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 10:41:54 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 10:41:54 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 10:41:54 INFO - Installing collected packages: psutil 10:41:54 INFO - Running setup.py install for psutil 10:41:54 INFO - building 'psutil._psutil_linux' extension 10:41:54 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:41:54 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:41:54 INFO - building 'psutil._psutil_posix' extension 10:41:54 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:41:54 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:41:55 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 10:41:55 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 10:41:55 INFO - Successfully installed psutil 10:41:55 INFO - Cleaning up... 10:41:55 INFO - Return code: 0 10:41:55 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 10:41:55 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:41:55 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:41:55 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:41:55 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:41:55 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:41:55 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:41:55 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.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1ba0030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d038a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1dcf400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e5e570>, '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 0x1e5f470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e5f900>, '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': '6d15e502d8e29d5d2676d664000001c3-1470850899.276051-603618958', '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:41:55 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.3'] in /builds/slave/test/build 10:41:55 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.3 10:41:55 INFO - Using env: {'DISPLAY': ':0', 10:41:55 INFO - 'HOME': '/home/cltbld', 10:41:55 INFO - 'LANG': 'en_US.UTF-8', 10:41:55 INFO - 'LANGUAGE': 'en_US:en', 10:41:55 INFO - 'LOGNAME': 'cltbld', 10:41:55 INFO - 'MAIL': '/var/mail/cltbld', 10:41:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:41:55 INFO - 'MOZ_NO_REMOTE': '1', 10:41:55 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:41:55 INFO - 'NO_EM_RESTART': '1', 10:41:55 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:41:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:41:55 INFO - 'PWD': '/builds/slave/test', 10:41:55 INFO - 'SHELL': '/bin/bash', 10:41:55 INFO - 'SHLVL': '1', 10:41:55 INFO - 'TERM': 'linux', 10:41:55 INFO - 'TMOUT': '86400', 10:41:55 INFO - 'USER': 'cltbld', 10:41:55 INFO - 'XDG_SESSION_COOKIE': '6d15e502d8e29d5d2676d664000001c3-1470850899.276051-603618958', 10:41:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:41:55 INFO - '_': '/tools/buildbot/bin/python'} 10:41:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:41:55 INFO - Downloading/unpacking mozsystemmonitor==0.3 10:41:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:41:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:41:55 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:41:55 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:41:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:41:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:41:57 INFO - Downloading mozsystemmonitor-0.3.tar.gz 10:41:57 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 10:41:57 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 10:41:57 INFO - Installing collected packages: mozsystemmonitor 10:41:57 INFO - Running setup.py install for mozsystemmonitor 10:41:57 INFO - Successfully installed mozsystemmonitor 10:41:57 INFO - Cleaning up... 10:41:57 INFO - Return code: 0 10:41:57 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 10:41: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:41:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:41:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:41: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:41:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:41:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:41:57 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==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1ba0030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d038a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1dcf400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e5e570>, '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 0x1e5f470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e5f900>, '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': '6d15e502d8e29d5d2676d664000001c3-1470850899.276051-603618958', '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:41:57 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==2.5.1'] in /builds/slave/test/build 10:41:57 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==2.5.1 10:41:57 INFO - Using env: {'DISPLAY': ':0', 10:41:57 INFO - 'HOME': '/home/cltbld', 10:41:57 INFO - 'LANG': 'en_US.UTF-8', 10:41:57 INFO - 'LANGUAGE': 'en_US:en', 10:41:57 INFO - 'LOGNAME': 'cltbld', 10:41:57 INFO - 'MAIL': '/var/mail/cltbld', 10:41:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:41:57 INFO - 'MOZ_NO_REMOTE': '1', 10:41:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:41:57 INFO - 'NO_EM_RESTART': '1', 10:41:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:41:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:41:57 INFO - 'PWD': '/builds/slave/test', 10:41:57 INFO - 'SHELL': '/bin/bash', 10:41:57 INFO - 'SHLVL': '1', 10:41:57 INFO - 'TERM': 'linux', 10:41:57 INFO - 'TMOUT': '86400', 10:41:57 INFO - 'USER': 'cltbld', 10:41:57 INFO - 'XDG_SESSION_COOKIE': '6d15e502d8e29d5d2676d664000001c3-1470850899.276051-603618958', 10:41:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:41:57 INFO - '_': '/tools/buildbot/bin/python'} 10:41:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:41:57 INFO - Downloading/unpacking jsonschema==2.5.1 10:41:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:41:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:41:57 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:41:57 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:41:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:41:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:41:59 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 10:41:59 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 10:41:59 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:41:59 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:41:59 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:41:59 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:41:59 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:41:59 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:41:59 INFO - Downloading functools32-3.2.3-2.tar.gz 10:41:59 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 10:41:59 INFO - warning: no files found matching '*.txt' 10:41:59 INFO - no previously-included directories found matching 'build' 10:41:59 INFO - no previously-included directories found matching 'dist' 10:41:59 INFO - no previously-included directories found matching '.git*' 10:41:59 INFO - Installing collected packages: jsonschema, functools32 10:41:59 INFO - Running setup.py install for functools32 10:41:59 INFO - warning: no files found matching '*.txt' 10:41:59 INFO - no previously-included directories found matching 'build' 10:41:59 INFO - no previously-included directories found matching 'dist' 10:41:59 INFO - no previously-included directories found matching '.git*' 10:41:59 INFO - Successfully installed jsonschema functools32 10:41:59 INFO - Cleaning up... 10:42:00 INFO - Return code: 0 10:42:00 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 10:42:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:42:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:42:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:42:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:42:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:42:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:42:00 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1ba0030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d038a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1dcf400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e5e570>, '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 0x1e5f470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e5f900>, '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': '6d15e502d8e29d5d2676d664000001c3-1470850899.276051-603618958', '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:42:00 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 10:42:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 10:42:00 INFO - Using env: {'DISPLAY': ':0', 10:42:00 INFO - 'HOME': '/home/cltbld', 10:42:00 INFO - 'LANG': 'en_US.UTF-8', 10:42:00 INFO - 'LANGUAGE': 'en_US:en', 10:42:00 INFO - 'LOGNAME': 'cltbld', 10:42:00 INFO - 'MAIL': '/var/mail/cltbld', 10:42:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:42:00 INFO - 'MOZ_NO_REMOTE': '1', 10:42:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:42:00 INFO - 'NO_EM_RESTART': '1', 10:42:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:42:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:42:00 INFO - 'PWD': '/builds/slave/test', 10:42:00 INFO - 'SHELL': '/bin/bash', 10:42:00 INFO - 'SHLVL': '1', 10:42:00 INFO - 'TERM': 'linux', 10:42:00 INFO - 'TMOUT': '86400', 10:42:00 INFO - 'USER': 'cltbld', 10:42:00 INFO - 'XDG_SESSION_COOKIE': '6d15e502d8e29d5d2676d664000001c3-1470850899.276051-603618958', 10:42:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:42:00 INFO - '_': '/tools/buildbot/bin/python'} 10:42:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:42:00 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 10:42:00 INFO - Cleaning up... 10:42:00 INFO - Return code: 0 10:42:00 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 10:42:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:42:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:42:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:42:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:42:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:42:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:42:00 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x1ba0030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d038a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1dcf400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e5e570>, '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 0x1e5f470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e5f900>, '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': '6d15e502d8e29d5d2676d664000001c3-1470850899.276051-603618958', '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:42:00 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 10:42:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 10:42:00 INFO - Using env: {'DISPLAY': ':0', 10:42:00 INFO - 'HOME': '/home/cltbld', 10:42:00 INFO - 'LANG': 'en_US.UTF-8', 10:42:00 INFO - 'LANGUAGE': 'en_US:en', 10:42:00 INFO - 'LOGNAME': 'cltbld', 10:42:00 INFO - 'MAIL': '/var/mail/cltbld', 10:42:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:42:00 INFO - 'MOZ_NO_REMOTE': '1', 10:42:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:42:00 INFO - 'NO_EM_RESTART': '1', 10:42:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:42:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:42:00 INFO - 'PWD': '/builds/slave/test', 10:42:00 INFO - 'SHELL': '/bin/bash', 10:42:00 INFO - 'SHLVL': '1', 10:42:00 INFO - 'TERM': 'linux', 10:42:00 INFO - 'TMOUT': '86400', 10:42:00 INFO - 'USER': 'cltbld', 10:42:00 INFO - 'XDG_SESSION_COOKIE': '6d15e502d8e29d5d2676d664000001c3-1470850899.276051-603618958', 10:42:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:42:00 INFO - '_': '/tools/buildbot/bin/python'} 10:42:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:42:00 INFO - Downloading/unpacking blobuploader==1.2.4 10:42:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:42:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:42:00 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:42:00 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:42:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:42:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:42:02 INFO - Downloading blobuploader-1.2.4.tar.gz 10:42:02 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 10:42:02 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 10:42:02 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:42:02 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:42:02 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:42:02 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:42:02 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:42:02 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:42:02 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 10:42:02 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 10:42:02 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:42:02 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:42:02 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:42:02 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:42:02 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:42:02 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:42:03 INFO - Downloading docopt-0.6.1.tar.gz 10:42:03 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 10:42:03 INFO - Installing collected packages: blobuploader, requests, docopt 10:42:03 INFO - Running setup.py install for blobuploader 10:42:03 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 10:42:03 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 10:42:03 INFO - Running setup.py install for requests 10:42:03 INFO - Running setup.py install for docopt 10:42:03 INFO - Successfully installed blobuploader requests docopt 10:42:03 INFO - Cleaning up... 10:42:03 INFO - Return code: 0 10:42:03 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:42:03 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:42:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:42:03 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:42:03 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:42:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:42:03 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:42:03 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 0x1ba0030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d038a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1dcf400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e5e570>, '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 0x1e5f470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e5f900>, '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': '6d15e502d8e29d5d2676d664000001c3-1470850899.276051-603618958', '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:42:03 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:42:03 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:42:03 INFO - Using env: {'DISPLAY': ':0', 10:42:03 INFO - 'HOME': '/home/cltbld', 10:42:03 INFO - 'LANG': 'en_US.UTF-8', 10:42:03 INFO - 'LANGUAGE': 'en_US:en', 10:42:03 INFO - 'LOGNAME': 'cltbld', 10:42:03 INFO - 'MAIL': '/var/mail/cltbld', 10:42:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:42:03 INFO - 'MOZ_NO_REMOTE': '1', 10:42:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:42:03 INFO - 'NO_EM_RESTART': '1', 10:42:03 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:42:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:42:03 INFO - 'PWD': '/builds/slave/test', 10:42:03 INFO - 'SHELL': '/bin/bash', 10:42:03 INFO - 'SHLVL': '1', 10:42:03 INFO - 'TERM': 'linux', 10:42:03 INFO - 'TMOUT': '86400', 10:42:03 INFO - 'USER': 'cltbld', 10:42:03 INFO - 'XDG_SESSION_COOKIE': '6d15e502d8e29d5d2676d664000001c3-1470850899.276051-603618958', 10:42:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:42:03 INFO - '_': '/tools/buildbot/bin/python'} 10:42:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:42:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 10:42:03 INFO - Running setup.py (path:/tmp/pip-KdR_UV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 10:42:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 10:42:04 INFO - Running setup.py (path:/tmp/pip-xvtGth-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 10:42:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 10:42:04 INFO - Running setup.py (path:/tmp/pip-ldb86s-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 10:42:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 10:42:04 INFO - Running setup.py (path:/tmp/pip-RuhhOG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 10:42:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 10:42:04 INFO - Running setup.py (path:/tmp/pip-sYTSco-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 10:42:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 10:42:04 INFO - Running setup.py (path:/tmp/pip-cCU8rp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 10:42:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 10:42:04 INFO - Running setup.py (path:/tmp/pip-Cx2TqF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 10:42:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 10:42:04 INFO - Running setup.py (path:/tmp/pip-8jdn1H-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 10:42:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 10:42:04 INFO - Running setup.py (path:/tmp/pip-FfMo2O-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 10:42:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 10:42:04 INFO - Running setup.py (path:/tmp/pip-kEIuiE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 10:42:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 10:42:04 INFO - Running setup.py (path:/tmp/pip-k4JpHl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 10:42:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 10:42:04 INFO - Running setup.py (path:/tmp/pip-REGwxY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 10:42:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 10:42:04 INFO - Running setup.py (path:/tmp/pip-Q7PBDO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 10:42:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 10:42:04 INFO - Running setup.py (path:/tmp/pip-UsXAF3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 10:42:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 10:42:04 INFO - Running setup.py (path:/tmp/pip-4aoQKz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 10:42:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 10:42:05 INFO - Running setup.py (path:/tmp/pip-QOSkHA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 10:42:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 10:42:05 INFO - Running setup.py (path:/tmp/pip-XdkvEf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 10:42:05 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 10:42:05 INFO - Running setup.py install for manifestparser 10:42:05 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 10:42:05 INFO - Running setup.py install for mozcrash 10:42:05 INFO - Running setup.py install for mozdebug 10:42:05 INFO - Running setup.py install for mozdevice 10:42:05 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 10:42:05 INFO - Installing dm script to /builds/slave/test/build/venv/bin 10:42:05 INFO - Running setup.py install for mozfile 10:42:05 INFO - Running setup.py install for mozhttpd 10:42:05 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 10:42:05 INFO - Running setup.py install for mozinfo 10:42:05 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 10:42:05 INFO - Running setup.py install for mozInstall 10:42:06 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 10:42:06 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 10:42:06 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 10:42:06 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 10:42:06 INFO - Running setup.py install for mozleak 10:42:06 INFO - Running setup.py install for mozlog 10:42:06 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 10:42:06 INFO - Running setup.py install for moznetwork 10:42:06 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 10:42:06 INFO - Running setup.py install for mozprocess 10:42:06 INFO - Running setup.py install for mozprofile 10:42:06 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 10:42:06 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 10:42:06 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 10:42:06 INFO - Running setup.py install for mozrunner 10:42:06 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 10:42:06 INFO - Running setup.py install for mozscreenshot 10:42:06 INFO - Running setup.py install for moztest 10:42:06 INFO - Running setup.py install for mozversion 10:42:06 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 10:42:07 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 10:42:07 INFO - Cleaning up... 10:42:07 INFO - Return code: 0 10:42:07 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:42: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:42:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:42:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:42: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:42:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:42:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:42:07 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 0x1ba0030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d038a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1dcf400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e5e570>, '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 0x1e5f470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e5f900>, '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': '6d15e502d8e29d5d2676d664000001c3-1470850899.276051-603618958', '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:42:07 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:42:07 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:42:07 INFO - Using env: {'DISPLAY': ':0', 10:42:07 INFO - 'HOME': '/home/cltbld', 10:42:07 INFO - 'LANG': 'en_US.UTF-8', 10:42:07 INFO - 'LANGUAGE': 'en_US:en', 10:42:07 INFO - 'LOGNAME': 'cltbld', 10:42:07 INFO - 'MAIL': '/var/mail/cltbld', 10:42:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:42:07 INFO - 'MOZ_NO_REMOTE': '1', 10:42:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:42:07 INFO - 'NO_EM_RESTART': '1', 10:42:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:42:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:42:07 INFO - 'PWD': '/builds/slave/test', 10:42:07 INFO - 'SHELL': '/bin/bash', 10:42:07 INFO - 'SHLVL': '1', 10:42:07 INFO - 'TERM': 'linux', 10:42:07 INFO - 'TMOUT': '86400', 10:42:07 INFO - 'USER': 'cltbld', 10:42:07 INFO - 'XDG_SESSION_COOKIE': '6d15e502d8e29d5d2676d664000001c3-1470850899.276051-603618958', 10:42:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:42:07 INFO - '_': '/tools/buildbot/bin/python'} 10:42:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:42:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 10:42:07 INFO - Running setup.py (path:/tmp/pip-ZDvToS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 10:42:07 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:42:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 10:42:07 INFO - Running setup.py (path:/tmp/pip-zsoDrr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 10:42:07 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:42:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 10:42:07 INFO - Running setup.py (path:/tmp/pip-q_Ev89-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 10:42:07 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:42:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 10:42:07 INFO - Running setup.py (path:/tmp/pip-2AnX6W-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 10:42:07 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:42:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 10:42:07 INFO - Running setup.py (path:/tmp/pip-peK9Es-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 10:42:07 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:42:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 10:42:07 INFO - Running setup.py (path:/tmp/pip-3s8gDC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 10:42:07 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:42:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 10:42:07 INFO - Running setup.py (path:/tmp/pip-zLwTLL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 10:42:07 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:42:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 10:42:07 INFO - Running setup.py (path:/tmp/pip-JIk0lA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 10:42:07 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:42:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 10:42:07 INFO - Running setup.py (path:/tmp/pip-FPiL3Y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 10:42:07 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:42:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 10:42:07 INFO - Running setup.py (path:/tmp/pip-S5VX3T-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 10:42:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.3 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:42:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 10:42:07 INFO - Running setup.py (path:/tmp/pip-CKhCUK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 10:42:08 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:42:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 10:42:08 INFO - Running setup.py (path:/tmp/pip-xljCUk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 10:42:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.23 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:42:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 10:42:08 INFO - Running setup.py (path:/tmp/pip-9vdbls-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 10:42:08 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:42:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 10:42:08 INFO - Running setup.py (path:/tmp/pip-b_QzNz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 10:42:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.12 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:42:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 10:42:08 INFO - Running setup.py (path:/tmp/pip-PFWDPL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 10:42:08 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:42:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 10:42:08 INFO - Running setup.py (path:/tmp/pip-BNG3At-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 10:42:08 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:42:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 10:42:08 INFO - Running setup.py (path:/tmp/pip-UdWTO6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 10:42:08 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:42:08 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:42:08 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:42:08 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:42:08 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:42:08 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:42:08 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.3->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 10:42:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:42:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:42:08 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:42:08 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:42:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:42:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:42:10 INFO - Downloading blessings-1.6.tar.gz 10:42:10 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 10:42:10 INFO - Installing collected packages: blessings 10:42:10 INFO - Running setup.py install for blessings 10:42:10 INFO - Successfully installed blessings 10:42:10 INFO - Cleaning up... 10:42:10 INFO - Return code: 0 10:42:10 INFO - Done creating virtualenv /builds/slave/test/build/venv. 10:42:10 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 10:42:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 10:42:10 INFO - Reading from file tmpfile_stdout 10:42:10 INFO - Current package versions: 10:42:10 INFO - argparse == 1.2.1 10:42:10 INFO - blessings == 1.6 10:42:10 INFO - blobuploader == 1.2.4 10:42:10 INFO - docopt == 0.6.1 10:42:10 INFO - functools32 == 3.2.3-2 10:42:10 INFO - jsonschema == 2.5.1 10:42:10 INFO - manifestparser == 1.1 10:42:10 INFO - mozInstall == 1.12 10:42:10 INFO - mozcrash == 0.17 10:42:10 INFO - mozdebug == 0.1 10:42:10 INFO - mozdevice == 0.48 10:42:10 INFO - mozfile == 1.2 10:42:10 INFO - mozhttpd == 0.7 10:42:10 INFO - mozinfo == 0.9 10:42:10 INFO - mozleak == 0.1 10:42:10 INFO - mozlog == 3.3 10:42:10 INFO - moznetwork == 0.27 10:42:10 INFO - mozprocess == 0.23 10:42:10 INFO - mozprofile == 0.28 10:42:10 INFO - mozrunner == 6.12 10:42:10 INFO - mozscreenshot == 0.1 10:42:10 INFO - mozsystemmonitor == 0.3 10:42:10 INFO - moztest == 0.7 10:42:10 INFO - mozversion == 1.4 10:42:10 INFO - psutil == 3.1.1 10:42:10 INFO - requests == 1.2.3 10:42:10 INFO - wsgiref == 0.1.2 10:42:10 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:42: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:42:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:42:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:42: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:42:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:42:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:42:10 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 0x1ba0030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d038a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1dcf400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e5e570>, '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 0x1e5f470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e5f900>, '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': '6d15e502d8e29d5d2676d664000001c3-1470850899.276051-603618958', '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:42:10 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:42:10 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:42:10 INFO - Using env: {'DISPLAY': ':0', 10:42:10 INFO - 'HOME': '/home/cltbld', 10:42:10 INFO - 'LANG': 'en_US.UTF-8', 10:42:10 INFO - 'LANGUAGE': 'en_US:en', 10:42:10 INFO - 'LOGNAME': 'cltbld', 10:42:10 INFO - 'MAIL': '/var/mail/cltbld', 10:42:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:42:10 INFO - 'MOZ_NO_REMOTE': '1', 10:42:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:42:10 INFO - 'NO_EM_RESTART': '1', 10:42:10 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:42:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:42:10 INFO - 'PWD': '/builds/slave/test', 10:42:10 INFO - 'SHELL': '/bin/bash', 10:42:10 INFO - 'SHLVL': '1', 10:42:10 INFO - 'TERM': 'linux', 10:42:10 INFO - 'TMOUT': '86400', 10:42:10 INFO - 'USER': 'cltbld', 10:42:10 INFO - 'XDG_SESSION_COOKIE': '6d15e502d8e29d5d2676d664000001c3-1470850899.276051-603618958', 10:42:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:42:10 INFO - '_': '/tools/buildbot/bin/python'} 10:42:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:42:11 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:42:11 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:42:11 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:42:11 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:42:11 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:42:11 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:42:11 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:42:11 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:42:11 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:42:11 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:42:11 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:42:11 INFO - Cleaning up... 10:42:11 INFO - Return code: 0 10:42:11 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 10:42:11 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:42:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:42:11 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:42:11 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:42:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:42:11 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:42:11 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 0x1ba0030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d038a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1dcf400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e5e570>, '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 0x1e5f470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e5f900>, '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': '6d15e502d8e29d5d2676d664000001c3-1470850899.276051-603618958', '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:42:11 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:42:11 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:42:11 INFO - Using env: {'DISPLAY': ':0', 10:42:11 INFO - 'HOME': '/home/cltbld', 10:42:11 INFO - 'LANG': 'en_US.UTF-8', 10:42:11 INFO - 'LANGUAGE': 'en_US:en', 10:42:11 INFO - 'LOGNAME': 'cltbld', 10:42:11 INFO - 'MAIL': '/var/mail/cltbld', 10:42:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:42:11 INFO - 'MOZ_NO_REMOTE': '1', 10:42:11 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:42:11 INFO - 'NO_EM_RESTART': '1', 10:42:11 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:42:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:42:11 INFO - 'PWD': '/builds/slave/test', 10:42:11 INFO - 'SHELL': '/bin/bash', 10:42:11 INFO - 'SHLVL': '1', 10:42:11 INFO - 'TERM': 'linux', 10:42:11 INFO - 'TMOUT': '86400', 10:42:11 INFO - 'USER': 'cltbld', 10:42:11 INFO - 'XDG_SESSION_COOKIE': '6d15e502d8e29d5d2676d664000001c3-1470850899.276051-603618958', 10:42:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:42:11 INFO - '_': '/tools/buildbot/bin/python'} 10:42:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:42:11 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 10:42:11 INFO - Cleaning up... 10:42:11 INFO - Return code: 0 10:42:11 INFO - Running post-action listener: _resource_record_post_action 10:42:11 INFO - Running post-action listener: _start_resource_monitoring 10:42:11 INFO - Starting resource monitoring. 10:42:11 INFO - [mozharness: 2016-08-10 17:42:11.336114Z] Finished create-virtualenv step (success) 10:42:11 INFO - [mozharness: 2016-08-10 17:42:11.336546Z] Running install step. 10:42:11 INFO - Running pre-action listener: _resource_record_pre_action 10:42:11 INFO - Running main action method: install 10:42:11 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 10:42:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 10:42:11 INFO - Reading from file tmpfile_stdout 10:42:11 INFO - Detecting whether we're running mozinstall >=1.0... 10:42:11 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 10:42:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 10:42:11 INFO - Reading from file tmpfile_stdout 10:42:11 INFO - Output received: 10:42:11 INFO - Usage: mozinstall [options] installer 10:42:11 INFO - Options: 10:42:11 INFO - -h, --help show this help message and exit 10:42:11 INFO - -d DEST, --destination=DEST 10:42:11 INFO - Directory to install application into. [default: 10:42:11 INFO - "/builds/slave/test"] 10:42:11 INFO - --app=APP Application being installed. [default: firefox] 10:42:11 INFO - mkdir: /builds/slave/test/build/application 10:42:11 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 10:42:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 10:42:27 INFO - Reading from file tmpfile_stdout 10:42:27 INFO - Output received: 10:42:27 INFO - /builds/slave/test/build/application/firefox/firefox 10:42:27 INFO - Running post-action listener: _resource_record_post_action 10:42:27 INFO - [mozharness: 2016-08-10 17:42:27.665721Z] Finished install step (success) 10:42:27 INFO - [mozharness: 2016-08-10 17:42:27.665971Z] Running run-tests step. 10:42:27 INFO - Running pre-action listener: _resource_record_pre_action 10:42:27 INFO - Running main action method: run_tests 10:42:27 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 10:42:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 10:42:27 INFO - Python 2.7.3 10:42:27 INFO - Return code: 0 10:42:27 INFO - grabbing minidump binary from tooltool 10:42:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:42:27 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: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e5e570>, '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 0x1e5f470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e5f900>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 10:42:27 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:42:27 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:42:27 INFO - Calling ['/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'] with output_timeout 600 10:42:27 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 10:42:27 INFO - Return code: 0 10:42:27 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 10:42:27 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 10:42:27 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 10:42:27 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 10:42:27 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 10:42:27 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Autoland-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/bFA_a0i3SP6SjBuZbj49jg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-023', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 10:42:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Autoland-Non-PGO --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/bFA_a0i3SP6SjBuZbj49jg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-023 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 10:42:27 INFO - Using env: {'DISPLAY': ':0', 10:42:27 INFO - 'HOME': '/home/cltbld', 10:42:27 INFO - 'LANG': 'en_US.UTF-8', 10:42:27 INFO - 'LANGUAGE': 'en_US:en', 10:42:27 INFO - 'LOGNAME': 'cltbld', 10:42:27 INFO - 'MAIL': '/var/mail/cltbld', 10:42:27 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 10:42:27 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 10:42:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:42:27 INFO - 'MOZ_NO_REMOTE': '1', 10:42:27 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 10:42:27 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:42:27 INFO - 'NO_EM_RESTART': '1', 10:42:27 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:42:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:42:27 INFO - 'PWD': '/builds/slave/test', 10:42:27 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 10:42:27 INFO - 'SHELL': '/bin/bash', 10:42:27 INFO - 'SHLVL': '1', 10:42:27 INFO - 'TERM': 'linux', 10:42:27 INFO - 'TMOUT': '86400', 10:42:27 INFO - 'USER': 'cltbld', 10:42:27 INFO - 'XDG_SESSION_COOKIE': '6d15e502d8e29d5d2676d664000001c3-1470850899.276051-603618958', 10:42:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:42:27 INFO - '_': '/tools/buildbot/bin/python'} 10:42:27 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Autoland-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/bFA_a0i3SP6SjBuZbj49jg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-023', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 10:42:27 INFO - mozversion application_buildid: 20160810090020 10:42:27 INFO - mozversion application_changeset: fe582cf4fffdc8faee63f925afb25ce21a2881c1 10:42:27 INFO - mozversion application_display_name: Nightly 10:42:27 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 10:42:27 INFO - mozversion application_name: Firefox 10:42:27 INFO - mozversion application_remotingname: firefox 10:42:27 INFO - mozversion application_repository: https://hg.mozilla.org/integration/autoland 10:42:27 INFO - mozversion application_vendor: Mozilla 10:42:27 INFO - mozversion application_version: 51.0a1 10:42:27 INFO - mozversion platform_buildid: 20160810090020 10:42:27 INFO - mozversion platform_changeset: fe582cf4fffdc8faee63f925afb25ce21a2881c1 10:42:27 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/autoland 10:42:27 INFO - mozversion platform_version: 51.0a1 10:42:27 INFO - using testdate: 1470850947 10:42:27 INFO - actual date: 1470850947 10:42:27 INFO - starting webserver on 'localhost:42126' 10:42:27 INFO - SUITE-START | Running 2 tests 10:42:27 INFO - TEST-START | dromaeo_css 10:42:27 INFO - operating with platform_type : linux_ 10:42:27 INFO - Initialising browser for dromaeo_css test... 10:42:27 INFO - TEST-INFO | started process 17818 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpwGr0Af/profile http://localhost:42126/getInfo.html) 10:42:32 INFO - PROCESS | 17818 | __metrics Screen width/height:1600/1200 10:42:32 INFO - PROCESS | 17818 | colorDepth:24 10:42:32 INFO - PROCESS | 17818 | Browser inner width/height: 1024/697 10:42:32 INFO - PROCESS | 17818 | __metrics 10:42:32 ERROR - PROCESS | 17818 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2967: TypeError: this.tabs is undefined 10:42:33 INFO - TEST-INFO | 17818: exit 0 10:42:33 INFO - Browser initialized. 10:42:33 INFO - Running cycle 1/1 for dromaeo_css test... 10:42:33 INFO - TEST-INFO | started process 17938 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpwGr0Af/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 10:42:45 INFO - PROCESS | 17938 | RSS: Main: 164630528 10:42:45 INFO - PROCESS | 17938 | 10:43:35 INFO - PROCESS | 17938 | 1470851015428 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:45:48 INFO - PROCESS | 17938 | Cycle 1(1): loaded http://localhost:42126/tests/dromaeo/cssquery-dojo.html (next: http://localhost:42126/tests/dromaeo/cssquery-ext.html) 10:45:49 INFO - PROCESS | 17938 | RSS: Main: 166825984 10:45:49 INFO - PROCESS | 17938 | 10:48:52 INFO - PROCESS | 17938 | Cycle 1(1): loaded http://localhost:42126/tests/dromaeo/cssquery-ext.html (next: http://localhost:42126/tests/dromaeo/cssquery-jquery.html) 10:48:52 INFO - PROCESS | 17938 | RSS: Main: 166039552 10:48:52 INFO - PROCESS | 17938 | 10:51:54 INFO - PROCESS | 17938 | Cycle 1(1): loaded http://localhost:42126/tests/dromaeo/cssquery-jquery.html (next: http://localhost:42126/tests/dromaeo/cssquery-mootools.html) 10:51:55 INFO - PROCESS | 17938 | RSS: Main: 168833024 10:51:55 INFO - PROCESS | 17938 | 10:54:57 INFO - PROCESS | 17938 | Cycle 1(1): loaded http://localhost:42126/tests/dromaeo/cssquery-mootools.html (next: http://localhost:42126/tests/dromaeo/cssquery-prototype.html) 10:54:57 INFO - PROCESS | 17938 | RSS: Main: 163049472 10:54:57 INFO - PROCESS | 17938 | 10:58:00 INFO - PROCESS | 17938 | Cycle 1(1): loaded http://localhost:42126/tests/dromaeo/cssquery-prototype.html (next: http://localhost:42126/tests/dromaeo/cssquery-yui.html) 10:58:01 INFO - PROCESS | 17938 | RSS: Main: 164945920 10:58:01 INFO - PROCESS | 17938 | 11:01:04 INFO - PROCESS | 17938 | Cycle 1(1): loaded http://localhost:42126/tests/dromaeo/cssquery-yui.html (next: http://localhost:42126/tests/dromaeo/cssquery-dojo.html) 11:01:04 INFO - PROCESS | 17938 | RSS: Main: 169234432 11:01:04 INFO - PROCESS | 17938 | 11:01:04 INFO - PROCESS | 17938 | __start_tp_report 11:01:04 INFO - PROCESS | 17938 | _x_x_mozilla_page_load 11:01:04 INFO - PROCESS | 17938 | _x_x_mozilla_page_load_details 11:01:04 INFO - PROCESS | 17938 | |i|pagename|runs| 11:01:04 INFO - PROCESS | 17938 | |0;dojo.html;2685.046808383023;2691.5020721166584;2694.299482134644;2707.648005759251;2714.334987927958;4550.431196100488;4821.8312359067395;4839.370881785363;4845.709257444556;4860.4410492793295;4806.158922188621;4806.303086052529;4857.48996355382;4864.513548645134;4882.121218180726;4360.934585981213;4403.383526306304;4451.666125040619;4556.817727290904;4582.9770851145695;4476.283794592866;4546.227141385956;4549.681522293441;4568.428946381702;4573.039661671053;4253.234417804794;4319.632831209351;4357.9128417431475;4376.956230437687;4454.220511410506;4339.631131353839;4347;4359.912801743979;4380.408644832939;4446.866594002185;4394.231009573312;4410.911781764346;4419.359192917042;4443.4445694288215;4469.882529367658;4783;4787.976060119712;4836.46798852126;4837.806487740521;4851.223804191312;5230.398504172031;5231.738413079331;5232.424433312332;5255.632105752599;5293.206019097128;5217.452167522393;5239.1093514102695;5265.52610265078;5275.604329675251;5309.601779866525;4599.356090147382;4809.374781278411;4827.468978412372;4871.34236878017;4898.044881248194;5352.4915133062295;5377.569794416438;5379.6234263601955;5383.7308134593895;5432.456754324615;5147.613928955343;5154.943236636481;5156.020356132323;5157.174852023733;5220.843374698765;4940.357753492095;5158.148905430637;5188.351456067991;5196.376434827845;5231.947680523146;5170.922436163461;5173.689578625294;5180.7150606717;5184.896302074013;5226.294450249244;5151.6908985461;5153.948460515347;5165.9225111623355;5179.378474583074;5222.529972302511;4225.345071513921;4363.6072753452345;4394.033312671208;4397.846075387346;4403.911921761547;3831.8275677594575;3852.3065848147603;3854.9614503854605;3907.8632247871756;3911.706622003361;4504.977475112603;4547.590716835501;4555;4571.588557029883;4597.057603191338;4946.727929963887;5171.974140129275;5215.869603259949;5227.242049902743;5280.551153151949;4489.214387482178;4518.932216016762;4521.8191272349395;4548.158590660738;4570.65720070996;4713.175194340976;4726.929096063562;4736.171170045228;4771.093492236464;4776.283557466339;4752.049590082067;4767.570918617341;4881.463039065771;4925.827596034122;4972.154733695353;5244.921326180034;5252.054630166606;5256.132738098171;5274.446183150714;5277.234800953917;4943.382077240345;4972.701637901738;4980;4988.800447982186;5018.874528136826;4938.629602779734;5057.190849464068;5105.030044291572;5120.97439512815;5167.741612919263;5184.9740751296;5219.634625576326;5221.2690223368;5227.843164705065;5267.051930652519;5054.671446355975;5056.974715126401;5060.089183946778;5067.670601410897;5116.769745361393;4848.80604775805;4958.6281028923695;5012.273220382951;5015.799368025238;5020.523050310215;4927.852164435073;4947.703137811743;4973.850784476472;4982.701037937735;5020.673656212334;5030.421501527371;5073.543381095719;5083.161278389024;5083.212102124176;5109.923351149661;4732.952670473389;4801.151556650784;4927.9507204927495;4942.950570494249;5002.974985125051 11:01:04 INFO - PROCESS | 17938 | |1;ext.html;543.3425555078355;549.2941570082444;558.5336244236063;565.4373897971517;594.4323171371341;35224.82387588065;38857.41713874287;39118.21763564727;39123.41314880272;39172.80413597931;38749.225015499745;39175;39225.803870980606;39335.60664393362;39358.21283574327;7647.388208943271;7783.455158138932;7785.766427007171;7786.065672119325;7787.299143077122;7673.884891726629;7715.575643339614;7748.070231572219;7791;7791.883121753178;7787.7663670089705;7833.490823096509;7843;7843.882341764878;7851.371890248766;7767.572783496906;7794.259545343211;7815.726449574237;7823.413244006722;7826.5695386753705;7683.231676832328;7751.0311211098615;7781.8832717509285;7781.9610901945125;7783.688652453895;37618.811905940565;37942;37954.430683539766;38121;38448;2350.882455877216;2933.8973135940355;3108.9533656995163;3115.12776422602;3371.393149233137;26366.340841478926;26522.86738566314;27342.863285683645;27915.441691166063;28354.29114272139;3255.7232635226032;3274.1159886830424;3306.2230375861654;3329.6836800503916;3423.246885685145;231999;232211;232255;233546;234609;32113.197170070467;32132;32219.35561288761;32273.677263227535;32285.838570806995;32115.1096401325;33042.3391532168;33255.334893301995;33256;35225.47161792575;14597.416103355747;14814.333354999051;14829.406823727146;14835.480758173411;14884.553463396116;11292.887071129184;11449.141314401453;11525;11556.422178891022;11564.826527602092;17993.640127197643;18017.819821801877;18065.638687226183;18172;18236.36172733948;6738.713926475804;6785.626790526569;6843.7604683835825;7075.150981882207;7184.461165412615;819.8770184472377;895.4224525181352;911.4576826788051;913.8674892140602;969.1277849935115;27193.864030680117;28272.29319267035;28419.147425577266;29100.563491547644;29111.272218194714;971;973.5959576775559;987.8913319534845;1071.5499490214129;1082.7509672775307;15029.699406011818;15349.923250383677;15352.539423817303;15357.692846143238;15574.688506229812;393976;395645;396325;396340;400731;32479.18802029968;32618.184545386554;32723;32753.67246327554;32775.836120819244;1169.636091627965;1217.6468824040928;1228.7419641875128;1237.0660151585496;1244.7448273103992;26245;27488.58767118535;28241;28252.717472825832;28765.28086797847;43018;43261.35107973446;43375.13249735051;43414.782926085165;43431.782841085595;355078;355208;355925;356981;357640;24753;25568;25681.614775778005;25994.61008084918;26071.348216294744;42236.36645450259;42466;43040;43240;43717.562824372624;35992.78589862407;36021;36688.63311366959;37679;37811.243775124894;35637.465438017935;36065.27869442649;36448.08879778027;36567.26865462623;36761.26477470382;35969;36222.45666314955;36323;36457.81771091127;37148.62851371452;30896.69103309028;33042.33915321728;33068.1732956678;33114;33460.330793384484;25591.488170236862;25769.649945506964;26152.34619134537;26180.60729089027;26366.340841479116 11:01:04 INFO - PROCESS | 17938 | |2;jquery.html;357.79248036139023;360.1967612224737;379.22070145850273;380.58136050344615;393.37846202999265;15535.300911458984;16800.159992000397;17491.650166996667;17612.20745066472;17655.382061627846;16306.510804675878;16933.83066169338;17028.744568831447;17101.40145094922;17116.82883171168;5139.15203991341;5334.946650533503;5342.385625653061;5345.4387289334645;5347.732613369335;3767.7739335639812;5224.477552244764;5850.0932355484965;6084.604500707462;6158.84602884927;6176.660283684396;6198.132261483396;6222.844428889269;6245.843853903643;6247.750089996394;5012.172991456406;5250.894982100355;5286.497782710656;5356.54469370104;5361.2226227197225;5158.226266060084;5172.27588137661;5187.948120518822;5193.8961220775755;5197.350331208599;12736.108472406935;12896.09727319088;13012.739745205137;20434.489137771525;20919.477013074644;1893.640208360421;1898.7057006164066;2047.30391666834;2442.9755702442926;2493.164789795421;9164.541772911327;9295.349325547215;9311.20854727349;9387.121799844857;9562.378445401027;1662.983370166295;1684.2168391697796;1808.439383791029;1932.7584051993501;1940.3984764722982;45005;73184.63407682927;73302.26697733007;74547;74693.25306746917;9921.40471571708;10159.339642923334;10166.966606678694;10202.438865862448;10335;13850.307484625728;13943.651408714863;13968.93015534936;14001.43994240219;14001.929990349983;7421;7708.922910770821;7737.922620773833;7819.413543984224;7854.410919181084;7290.927090729025;7386.519876208029;7397.667104980289;7593.6582853771715;7665.846683066307;4276.657867370603;4316.078551249097;4359.711151645348;4410.316400957857;4481.3195051855555;1538.2155100898622;1614.701280263155;1637.2550489527237;1822.9088545572667;1914.009430192612;828.2722201856662;904.5703290936752;924.3714274293545;930.7673081729567;943.3538026451903;16659.750103748454;17164.498076598135;17836.9108154461;17852.19665115073;17994.370197043303;855.4867079752099;891.4473026723473;913.9497327647043;958.4009993753904;994.4282037828277;9579.329446938647;9852.50737463124;10024.749381265527;10043.598256069676;10125.898741012643;381098;386493;417173;422147;424275;78699.60650196712;78828;79627;79772;79927.60036199898;850.5449584472277;876.6887754847065;903.8960519540205;908.4458480326995;909.0409617853228;15189.468368607046;15265.923670381577;15797.526074217792;15991.92004040019;16002.67994640124;34957.126071848405;36713.44929826001;38158.61841381551;40811.59188408078;41359.37960930528;52634.73682631715;54709.179362310395;54830;55175.44824551864;55500.72249638887;7700.151963528825;7789.64946577394;7938.24586664266;7951;8023.83952320962;8585.313174946114;8672.913270867211;8963.844402691839;12325.815112773495;12843.807342889677;7814.374850012099;8041.356691464785;8095.595220239083;8260.091389947222;8457.746267611981;7602.695892164473;7750.883736743841;7802.180771019188;8163.102058773649;8197.590120493833;8044.798880027812;8109.1890810920795;8209.466384684976;8353.707620233263;8536.573171341532;11424.200305978502;11734.237274577124;12008.75982480363;12014.579489717818;12081.879181208076;11161.776764464503;11295.435228238719;11453.828192577284;11788.823167652663;11806.350650714294 11:01:04 INFO - PROCESS | 17938 | |3;mootools.html;1376.6764810269585;1408.0988167572755;1486.4202960845273;1645.2020769926592;1667.2497376180713;6562.409383155515;7228.457865660071;7554.942308076874;7848.097468791091;7860.096088949773;7628.923710762891;7899.328557072641;7920.881186782203;7924.603769811501;7924.801879953004;2152.278986539511;2195.034184958621;2196.3959911024435;2196.615592271354;2203.0747086223823;2132.5201829588373;2171.0447403142643;2210.1932794530044;2211.6019116559014;2219.8224142068675;2172.5329054253334;2208.138825857917;2210.1490925993526;2214.878181700006;2254.2786308381324;2115.3548167808813;2122.278425335378;2123.2462475821094;2123.6071326804436;2125;2143.0677655219874;2145.463634091477;2168.3278183762927;2171.1098449635733;2171.348595421383;7714.498557593738;7928.643211055516;7951.522908625501;7997.600119993977;8024.879626805603;4465.68740188187;4620.976895115503;4625.722456652612;4632.536746325374;4672.3692301539195;2952.852357382122;3036.1954082168245;3046.7562594992346;3050.9542356864663;3098.5971823663003;916.6104405627582;917.2249449215402;988.0761488008735;998.4458625462865;1008.5058321422523;10836.891631083667;10842.783144337149;10850.186236032328;10865.185111116698;10881.075108615698;3903.6096390361304;4126.257273690764;4240.830366785356;4243.215005224043;4265.850695225652;9195.90804091964;9238;9286.95356523213;9300.90699093014;9308.069193080637;4572.954270457253;4576.496585375606;4608.308753686907;4612.976935115303;4616.492185859553;3455.6371580984137;4171.436856024458;4176.686748493875;4218.557051509609;4332.133573285356;3617.819109044537;3714.23858109087;3788.905277368033;3801.6198380161763;3845.9230815383535;1143.7655280667443;1148.7415331550335;1148.977020459603;1160.988390116105;1186.7507823357018;763.1986414265;772.2894936658288;780.9960950195326;787.2717736094205;802.6147449224288;5180.300659410931;5256.316678831804;5285.63000589955;5367.973160134175;5390.460953904578;394.1624048896096;406.5385787131627;407.45808075259833;407.567977943381;411.40141094707127;3580.7135429165605;3604.33319835826;3610.151614370621;3628.965909260843;3664.9633503665154;9591.520423978773;9895.505224738734;9919.702408927744;9927.354721943195;9988.500574971222;9836.754081148028;9845.803083938425;9870.457124858201;9875.20998320147;9891.10980011788;7518.586477743776;7542.962285188539;7609.695612175451;7613.972113764571;7623.885641715378;5018.096742586369;5067.366579177603;5072.467390924047;5136.229565565195;5261.947380526146;8979.281657467256;9035.27717782589;9036.819263614823;9075.636974521209;9109.544522773967;9021.954890225506;9105.04397038328;9298.442093474414;9380.20268277204;9400;6782.593044417351;6815;6839.555428897106;6844.178698556205;6869.519133660796;7542.132654744774;7556.319931206218;7587.127480339832;7604.961975190088;7622.352100071556;6869.210040845367;6957.443404527525;7004.894926576208;7078.1860086090755;7140.46446516503;6737.865242695217;6809.625470598967;6820.283870193757;6826.965865170642;6879.759208427681;6310.337414571588;6348.206474190726;6349.238091429058;6427.228732552124;6438.420542151229;4599.563041511051;4748.928766068442;4757.976210118927;4766.761661916821;4890.853274401774;4552.931706024346;4598.26427771555;4613.0210099963215;4631.791569379318;4727.149113159527 11:01:04 INFO - PROCESS | 17938 | |4;prototype.html;281.6676321940111;282.1465068168789;288.1341568586398;288.6492911112997;291.67769614575906;5056.129232184093;5075.670081444703;5085.287739949838;5092;5123.205903085019;4972.925406118911;4980.178270585349;4982.975085124578;5028.396592408907;5044.772985215665;3682.6869716074166;3756.492873462075;3879.35990561557;3905.902352441183;3913.7456065355805;3882.5729169791302;3889.747166434173;3891.8443262269475;3902.9609703902884;3905.2384784966944;3876.7092468064866;3877.7509044753974;3883.9805800970958;3888;3893.8442462301473;3772.5284339457567;3862.942055869164;3881.301365754149;3881.3207688654375;3883.339832228514;3423.8972830815114;3443.94959537341;3445.776024558396;3449.5170676105367;3450.258194488197;4895.510448955076;4915.975420122876;4928.383952005999;4939;4948.094983431369;4387.341898715218;4479.3504941783585;4486.439195100613;4490.640748740093;4514.977425112854;5201.921971170435;5203.4763139877505;5227.869303267449;5254;5264.552513036397;3728.6017743346247;3742.4573436851506;3744.157564547982;3753.530808648919;3771.0383852117807;5385.040239861104;5454.645448045864;5469.972650136764;5481.725913704299;5484.890302193934;3684.907877303035;3749.8500059997295;3794.6205379461835;3806.2006978534264;3834.9616503835164;3865.903352416212;3868.497095377639;3877.3796192609047;3880.902977425587;3893.474380958591;4446;4458.375827384169;4462.196804575207;4465.285554311295;4476.395686582335;5077.669951453217;5233.215017747369;5298.70857102863;5310.203469479532;5337.332833395825;1325.9403326850315;1347.0772520823268;1350.8787706203827;1351.4594162335145;1352.2495015266425;807.588130053665;825.108882407011;846.3483117999107;860.2429861721645;860.4192170285032;4390.648748100144;4485.327200919888;4607.401037865056;4613.30800379939;4613.308003799457;5347.893042139213;5359.08895487768;5375.650582712111;5400.864978375572;5408.296386638275;4597.793059331473;4607.654425918069;4610.631149508032;4616.446026476844;4629.675922685447;2697.5414179589516;2839.5030869597736;2868.3076984579197;2871.425714857037;2879.5392737161956;5082.390113186441;5132.538071573502;5135;5146.433892271847;5169.922451163236;5264.526192642604;5463.617546771688;5531.751071201806;5534.446555344433;5537.169424586345;5077.314562534085;5103.004914041726;5103.137354865373;5103.617228707862;5107.923381149211;5359.946400535945;5366.490183432567;5367.704776237344;5384.649997750291;5390.622656414013;5022.296878436949;5187.610929180402;5232.529072383351;5249.238860365302;5273.182656688219;5091.567216786615;5103.515166059218;5110.642255042111;5128.923066153936;5139.563137133236;3723.404255319136;3770.377887648507;3793.0465810107266;3793.6016718244186;3811.0662887592716;5146.536811686966;5277.393099793573;5290.100682883842;5330.200469929387;5345.893082138413;5137.17805151189;5145.176771716657;5172.189733593213;5177.974110129425;5188.273641690242;5163.199704045879;5170.1986192140275;5174.63777535584;5176.249443830548;5188.22176673502;4924.8768780780765;5069.847904562869;5097.7510509925305;5099.36257967754;5103.464136265638;4970.552650261494;5130.897382052263;5149.897002060013;5193.662411943212;5285.894282114259;5136.409312929061;5146.50751282124;5170.586353091819;5171.482851714798;5191.195364718475 11:01:04 INFO - PROCESS | 17938 | |5;yui.html;578.1585649705688;643.9066335381369;649.9187601549806;656.9080328753976;670.5272782688205;13005.869941300583;13724.931375343134;14161.433542658295;14180.22008789516;14975.400983960655;13625.795613065788;13809.24049177295;13858.93070534646;13861;13956.162630242192;639.0382474376081;768.7386288661868;790.9604519773989;793.9404544659174;794.1899262751989;763.5914785589711;782.9530228186327;787.0398114300544;789.4789438970281;792.2275781113426;829.2950991657103;832.305025303872;832.8084540555676;832.8459235041506;834.9332053435711;822.7531740477892;825.2036784502924;826.3926014379426;826.710651272056;827.437342607027;598.0759726222996;599.3018133874032;599.484443378694;601.3235110500686;603.1254680712984;12587.181833180814;12595.622131336075;12597.37013149348;12609.180403273758;12631.115821892472;13598;13954.162750234917;14129.293535323295;14256.693818498929;14431.278436078259;10829.458527073615;10895.782084358349;11060.391678457681;11161.72095697606;11188.66434006981;3245;3252.073159149631;3263.347330533879;3271.558339624144;3374.898753037413;67328.3267167327;68298;69357.3064269356;69627;70115.64942175256;10210.846837297446;10491.10825579819;10591.523381447852;10596.205284603686;10713.517891694892;16863.494095177164;17594.296228150986;20954.685679714818;20958.371248862557;21216.04527796253;7215.989761433403;7281.672324745399;7311.341979221896;7381.66782494789;7530.887036694454;3893.2213557288655;3901.0637447012514;3901.453796468497;3942.664873485786;3969.2458432897656;2893.4357800228754;2997.385535965122;3152.590163278759;3317.3531161423775;3337.933241335208;558.1209594888068;560.529155509366;567.2342337843878;567.6820980251073;574.0814696485589;597.0894386061204;608.4341562347059;610.8137018209488;615.9507239420835;621.627023785725;8729.781755456164;8988.46069235848;9018.368714190075;9021.594028268744;9134.086591340945;497.9626528010414;603.5503549855385;627.1971875998729;628.1456822415048;633.7655067624916;4116.814743336557;4203.55862634419;4249.7237679551345;4395.670324725658;4478.798454069574;100879;103701.96298036924;104005.47997259966;104879.47560262303;106081;54481.727591362585;56725.43274567284;92136;93652;93879;74125;77951.22048779554;79544.6022769894;79872.805087797;80029;8138.104808470945;8360.414770965974;8374.958125209336;8529.445586036887;8531.616077276414;46100.30849537192;46718;46896.53103469058;47492;47847;66025;69505.30494694988;69773;70225.64887175531;71519.64240178766;9745.463999480096;9973.351732137387;10027.598896044077;10119.241056920613;10246.129079028366;11513.36676482768;11651;11724.531018759155;12088.032957363213;12088.75822483563;11179.217454778087;11283.629969464608;11344.716382090513;11371.204015719151;11886.702832429259;11067.50196241155;11119.221654484109;11143.65696777955;11371.829422558834;11615.128865334964;10996.890031099587;11069.833952490559;11206.495707693337;11240.381779002233;11560.364179970182;8891.64433422656;8967.778091879729;8999.730008099768;9202.401843880127;9307.581158847732;9445.433274003582;9807.117359437685;9812.950935245279;9849.950750246202;9854.211663066793 11:01:04 INFO - PROCESS | 17938 | __end_tp_report 11:01:04 INFO - PROCESS | 17938 | __start_cc_report 11:01:04 INFO - PROCESS | 17938 | _x_x_mozilla_cycle_collect,359 11:01:04 INFO - PROCESS | 17938 | __end_cc_report 11:01:04 INFO - PROCESS | 17938 | __startTimestamp1470852064319__endTimestamp 11:01:04 INFO - PROCESS | 17938 | 11:01:04 INFO - PROCESS | 17938 | ------- Summary: start ------- 11:01:04 INFO - PROCESS | 17938 | Number of tests: 6 11:01:04 INFO - PROCESS | 17938 | 11:01:04 INFO - PROCESS | 17938 | [#0] dojo.html Cycles:165 Average:4796.46 Median:4927.85 stddev:511.22 (10.4%) stddev-sans-first:485.21 11:01:04 INFO - PROCESS | 17938 | Values: 2685.0 2691.5 2694.3 2707.6 2714.3 4550.4 4821.8 4839.4 4845.7 4860.4 4806.2 4806.3 4857.5 4864.5 4882.1 4360.9 4403.4 4451.7 4556.8 4583.0 4476.3 4546.2 4549.7 4568.4 4573.0 4253.2 4319.6 4357.9 4377.0 4454.2 4339.6 4347.0 4359.9 4380.4 4446.9 4394.2 4410.9 4419.4 4443.4 4469.9 4783.0 4788.0 4836.5 4837.8 4851.2 5230.4 5231.7 5232.4 5255.6 5293.2 5217.5 5239.1 5265.5 5275.6 5309.6 4599.4 4809.4 4827.5 4871.3 4898.0 5352.5 5377.6 5379.6 5383.7 5432.5 5147.6 5154.9 5156.0 5157.2 5220.8 4940.4 5158.1 5188.4 5196.4 5231.9 5170.9 5173.7 5180.7 5184.9 5226.3 5151.7 5153.9 5165.9 5179.4 5222.5 4225.3 4363.6 4394.0 4397.8 4403.9 3831.8 3852.3 3855.0 3907.9 3911.7 4505.0 4547.6 4555.0 4571.6 4597.1 4946.7 5172.0 5215.9 5227.2 5280.6 4489.2 4518.9 4521.8 4548.2 4570.7 4713.2 4726.9 4736.2 4771.1 4776.3 4752.0 4767.6 4881.5 4925.8 4972.2 5244.9 5252.1 5256.1 5274.4 5277.2 4943.4 4972.7 4980.0 4988.8 5018.9 4938.6 5057.2 5105.0 5121.0 5167.7 5185.0 5219.6 5221.3 5227.8 5267.1 5054.7 5057.0 5060.1 5067.7 5116.8 4848.8 4958.6 5012.3 5015.8 5020.5 4927.9 4947.7 4973.9 4982.7 5020.7 5030.4 5073.5 5083.2 5083.2 5109.9 4733.0 4801.2 4928.0 4943.0 5003.0 11:01:04 INFO - PROCESS | 17938 | 11:01:04 INFO - PROCESS | 17938 | [#1] ext.html Cycles:180 Average:46627.99 Median:195781.23 stddev:88681.86 (45.3%) stddev-sans-first:88863.14 11:01:04 INFO - PROCESS | 17938 | Values: 543.3 549.3 558.5 565.4 594.4 35224.8 38857.4 39118.2 39123.4 39172.8 38749.2 39175.0 39225.8 39335.6 39358.2 7647.4 7783.5 7785.8 7786.1 7787.3 7673.9 7715.6 7748.1 7791.0 7791.9 7787.8 7833.5 7843.0 7843.9 7851.4 7767.6 7794.3 7815.7 7823.4 7826.6 7683.2 7751.0 7781.9 7782.0 7783.7 37618.8 37942.0 37954.4 38121.0 38448.0 2350.9 2933.9 3109.0 3115.1 3371.4 26366.3 26522.9 27342.9 27915.4 28354.3 3255.7 3274.1 3306.2 3329.7 3423.2 231999.0 232211.0 232255.0 233546.0 234609.0 32113.2 32132.0 32219.4 32273.7 32285.8 32115.1 33042.3 33255.3 33256.0 35225.5 14597.4 14814.3 14829.4 14835.5 14884.6 11292.9 11449.1 11525.0 11556.4 11564.8 17993.6 18017.8 18065.6 18172.0 18236.4 6738.7 6785.6 6843.8 7075.2 7184.5 819.9 895.4 911.5 913.9 969.1 27193.9 28272.3 28419.1 29100.6 29111.3 971.0 973.6 987.9 1071.5 1082.8 15029.7 15349.9 15352.5 15357.7 15574.7 393976.0 395645.0 396325.0 396340.0 400731.0 32479.2 32618.2 32723.0 32753.7 32775.8 1169.6 1217.6 1228.7 1237.1 1244.7 26245.0 27488.6 28241.0 28252.7 28765.3 43018.0 43261.4 43375.1 43414.8 43431.8 355078.0 355208.0 355925.0 356981.0 357640.0 24753.0 25568.0 25681.6 25994.6 26071.3 42236.4 42466.0 43040.0 43240.0 43717.6 35992.8 36021.0 36688.6 37679.0 37811.2 35637.5 36065.3 36448.1 36567.3 36761.3 35969.0 36222.5 36323.0 36457.8 37148.6 30896.7 33042.3 33068.2 33114.0 33460.3 25591.5 25769.6 26152.3 26180.6 26366.3 11:01:04 INFO - PROCESS | 17938 | 11:01:04 INFO - PROCESS | 17938 | [#2] jquery.html Cycles:180 Average:24851.34 Median:5190.92 stddev:67165.08 (1293.9%) stddev-sans-first:67328.32 11:01:04 INFO - PROCESS | 17938 | Values: 357.8 360.2 379.2 380.6 393.4 15535.3 16800.2 17491.7 17612.2 17655.4 16306.5 16933.8 17028.7 17101.4 17116.8 5139.2 5334.9 5342.4 5345.4 5347.7 3767.8 5224.5 5850.1 6084.6 6158.8 6176.7 6198.1 6222.8 6245.8 6247.8 5012.2 5250.9 5286.5 5356.5 5361.2 5158.2 5172.3 5187.9 5193.9 5197.4 12736.1 12896.1 13012.7 20434.5 20919.5 1893.6 1898.7 2047.3 2443.0 2493.2 9164.5 9295.3 9311.2 9387.1 9562.4 1663.0 1684.2 1808.4 1932.8 1940.4 45005.0 73184.6 73302.3 74547.0 74693.3 9921.4 10159.3 10167.0 10202.4 10335.0 13850.3 13943.7 13968.9 14001.4 14001.9 7421.0 7708.9 7737.9 7819.4 7854.4 7290.9 7386.5 7397.7 7593.7 7665.8 4276.7 4316.1 4359.7 4410.3 4481.3 1538.2 1614.7 1637.3 1822.9 1914.0 828.3 904.6 924.4 930.8 943.4 16659.8 17164.5 17836.9 17852.2 17994.4 855.5 891.4 913.9 958.4 994.4 9579.3 9852.5 10024.7 10043.6 10125.9 381098.0 386493.0 417173.0 422147.0 424275.0 78699.6 78828.0 79627.0 79772.0 79927.6 850.5 876.7 903.9 908.4 909.0 15189.5 15265.9 15797.5 15991.9 16002.7 34957.1 36713.4 38158.6 40811.6 41359.4 52634.7 54709.2 54830.0 55175.4 55500.7 7700.2 7789.6 7938.2 7951.0 8023.8 8585.3 8672.9 8963.8 12325.8 12843.8 7814.4 8041.4 8095.6 8260.1 8457.7 7602.7 7750.9 7802.2 8163.1 8197.6 8044.8 8109.2 8209.5 8353.7 8536.6 11424.2 11734.2 12008.8 12014.6 12081.9 11161.8 11295.4 11453.8 11788.8 11806.4 11:01:04 INFO - PROCESS | 17938 | 11:01:04 INFO - PROCESS | 17938 | [#3] mootools.html Cycles:180 Average:5190.16 Median:4954.48 stddev:2958.42 (59.7%) stddev-sans-first:2952.84 11:01:04 INFO - PROCESS | 17938 | Values: 1376.7 1408.1 1486.4 1645.2 1667.2 6562.4 7228.5 7554.9 7848.1 7860.1 7628.9 7899.3 7920.9 7924.6 7924.8 2152.3 2195.0 2196.4 2196.6 2203.1 2132.5 2171.0 2210.2 2211.6 2219.8 2172.5 2208.1 2210.1 2214.9 2254.3 2115.4 2122.3 2123.2 2123.6 2125.0 2143.1 2145.5 2168.3 2171.1 2171.3 7714.5 7928.6 7951.5 7997.6 8024.9 4465.7 4621.0 4625.7 4632.5 4672.4 2952.9 3036.2 3046.8 3051.0 3098.6 916.6 917.2 988.1 998.4 1008.5 10836.9 10842.8 10850.2 10865.2 10881.1 3903.6 4126.3 4240.8 4243.2 4265.9 9195.9 9238.0 9287.0 9300.9 9308.1 4573.0 4576.5 4608.3 4613.0 4616.5 3455.6 4171.4 4176.7 4218.6 4332.1 3617.8 3714.2 3788.9 3801.6 3845.9 1143.8 1148.7 1149.0 1161.0 1186.8 763.2 772.3 781.0 787.3 802.6 5180.3 5256.3 5285.6 5368.0 5390.5 394.2 406.5 407.5 407.6 411.4 3580.7 3604.3 3610.2 3629.0 3665.0 9591.5 9895.5 9919.7 9927.4 9988.5 9836.8 9845.8 9870.5 9875.2 9891.1 7518.6 7543.0 7609.7 7614.0 7623.9 5018.1 5067.4 5072.5 5136.2 5261.9 8979.3 9035.3 9036.8 9075.6 9109.5 9022.0 9105.0 9298.4 9380.2 9400.0 6782.6 6815.0 6839.6 6844.2 6869.5 7542.1 7556.3 7587.1 7605.0 7622.4 6869.2 6957.4 7004.9 7078.2 7140.5 6737.9 6809.6 6820.3 6827.0 6879.8 6310.3 6348.2 6349.2 6427.2 6438.4 4599.6 4748.9 4758.0 4766.8 4890.9 4552.9 4598.3 4613.0 4631.8 4727.1 11:01:04 INFO - PROCESS | 17938 | 11:01:04 INFO - PROCESS | 17938 | [#4] prototype.html Cycles:180 Average:4338.01 Median:5025.35 stddev:1265.34 (25.2%) stddev-sans-first:1231.72 11:01:04 INFO - PROCESS | 17938 | Values: 281.7 282.1 288.1 288.6 291.7 5056.1 5075.7 5085.3 5092.0 5123.2 4972.9 4980.2 4983.0 5028.4 5044.8 3682.7 3756.5 3879.4 3905.9 3913.7 3882.6 3889.7 3891.8 3903.0 3905.2 3876.7 3877.8 3884.0 3888.0 3893.8 3772.5 3862.9 3881.3 3881.3 3883.3 3423.9 3443.9 3445.8 3449.5 3450.3 4895.5 4916.0 4928.4 4939.0 4948.1 4387.3 4479.4 4486.4 4490.6 4515.0 5201.9 5203.5 5227.9 5254.0 5264.6 3728.6 3742.5 3744.2 3753.5 3771.0 5385.0 5454.6 5470.0 5481.7 5484.9 3684.9 3749.9 3794.6 3806.2 3835.0 3865.9 3868.5 3877.4 3880.9 3893.5 4446.0 4458.4 4462.2 4465.3 4476.4 5077.7 5233.2 5298.7 5310.2 5337.3 1325.9 1347.1 1350.9 1351.5 1352.2 807.6 825.1 846.3 860.2 860.4 4390.6 4485.3 4607.4 4613.3 4613.3 5347.9 5359.1 5375.7 5400.9 5408.3 4597.8 4607.7 4610.6 4616.4 4629.7 2697.5 2839.5 2868.3 2871.4 2879.5 5082.4 5132.5 5135.0 5146.4 5169.9 5264.5 5463.6 5531.8 5534.4 5537.2 5077.3 5103.0 5103.1 5103.6 5107.9 5359.9 5366.5 5367.7 5384.6 5390.6 5022.3 5187.6 5232.5 5249.2 5273.2 5091.6 5103.5 5110.6 5128.9 5139.6 3723.4 3770.4 3793.0 3793.6 3811.1 5146.5 5277.4 5290.1 5330.2 5345.9 5137.2 5145.2 5172.2 5178.0 5188.3 5163.2 5170.2 5174.6 5176.2 5188.2 4924.9 5069.8 5097.8 5099.4 5103.5 4970.6 5130.9 5149.9 5193.7 5285.9 5136.4 5146.5 5170.6 5171.5 5191.2 11:01:04 INFO - PROCESS | 17938 | 11:01:04 INFO - PROCESS | 17938 | [#5] yui.html Cycles:180 Average:18373.29 Median:559.33 stddev:26661.31 (4766.7%) stddev-sans-first:26702.62 11:01:04 INFO - PROCESS | 17938 | Values: 578.2 643.9 649.9 656.9 670.5 13005.9 13724.9 14161.4 14180.2 14975.4 13625.8 13809.2 13858.9 13861.0 13956.2 639.0 768.7 791.0 793.9 794.2 763.6 783.0 787.0 789.5 792.2 829.3 832.3 832.8 832.8 834.9 822.8 825.2 826.4 826.7 827.4 598.1 599.3 599.5 601.3 603.1 12587.2 12595.6 12597.4 12609.2 12631.1 13598.0 13954.2 14129.3 14256.7 14431.3 10829.5 10895.8 11060.4 11161.7 11188.7 3245.0 3252.1 3263.3 3271.6 3374.9 67328.3 68298.0 69357.3 69627.0 70115.6 10210.8 10491.1 10591.5 10596.2 10713.5 16863.5 17594.3 20954.7 20958.4 21216.0 7216.0 7281.7 7311.3 7381.7 7530.9 3893.2 3901.1 3901.5 3942.7 3969.2 2893.4 2997.4 3152.6 3317.4 3337.9 558.1 560.5 567.2 567.7 574.1 597.1 608.4 610.8 616.0 621.6 8729.8 8988.5 9018.4 9021.6 9134.1 498.0 603.6 627.2 628.1 633.8 4116.8 4203.6 4249.7 4395.7 4478.8 100879.0 103702.0 104005.5 104879.5 106081.0 54481.7 56725.4 92136.0 93652.0 93879.0 74125.0 77951.2 79544.6 79872.8 80029.0 8138.1 8360.4 8375.0 8529.4 8531.6 46100.3 46718.0 46896.5 47492.0 47847.0 66025.0 69505.3 69773.0 70225.6 71519.6 9745.5 9973.4 10027.6 10119.2 10246.1 11513.4 11651.0 11724.5 12088.0 12088.8 11179.2 11283.6 11344.7 11371.2 11886.7 11067.5 11119.2 11143.7 11371.8 11615.1 10996.9 11069.8 11206.5 11240.4 11560.4 8891.6 8967.8 8999.7 9202.4 9307.6 9445.4 9807.1 9813.0 9850.0 9854.2 11:01:04 INFO - PROCESS | 17938 | -------- Summary: end -------- 11:01:04 INFO - PROCESS | 17938 | 11:01:05 INFO - TEST-INFO | 17938: exit 0 11:01:05 INFO - TEST-OK | dromaeo_css | took 1117121ms 11:01:05 INFO - TEST-START | kraken 11:01:05 INFO - operating with platform_type : linux_ 11:01:05 INFO - Initialising browser for kraken test... 11:01:05 INFO - TEST-INFO | started process 18182 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpJg3VcR/profile http://localhost:42126/getInfo.html) 11:01:09 INFO - PROCESS | 18182 | __metrics Screen width/height:1600/1200 11:01:09 INFO - PROCESS | 18182 | colorDepth:24 11:01:09 INFO - PROCESS | 18182 | Browser inner width/height: 1024/697 11:01:09 INFO - PROCESS | 18182 | __metrics 11:01:10 ERROR - PROCESS | 18182 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2967: TypeError: this.tabs is undefined 11:01:11 INFO - TEST-INFO | 18182: exit 0 11:01:11 INFO - Browser initialized. 11:01:11 INFO - Running cycle 1/1 for kraken test... 11:01:11 INFO - TEST-INFO | started process 18301 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpJg3VcR/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 11:01:23 INFO - PROCESS | 18301 | RSS: Main: 164749312 11:01:23 INFO - PROCESS | 18301 | 11:01:25 INFO - PROCESS | 18301 | Cycle 1(1): loaded http://localhost:42126/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:42126/tests/kraken/driver.html?testName=audio-beat-detection) 11:01:26 INFO - PROCESS | 18301 | RSS: Main: 169046016 11:01:26 INFO - PROCESS | 18301 | 11:01:29 INFO - PROCESS | 18301 | Cycle 1(1): loaded http://localhost:42126/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:42126/tests/kraken/driver.html?testName=audio-dft) 11:01:30 INFO - PROCESS | 18301 | RSS: Main: 167923712 11:01:30 INFO - PROCESS | 18301 | 11:01:33 INFO - PROCESS | 18301 | Cycle 1(1): loaded http://localhost:42126/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:42126/tests/kraken/driver.html?testName=audio-fft) 11:01:33 INFO - PROCESS | 18301 | RSS: Main: 164782080 11:01:33 INFO - PROCESS | 18301 | 11:01:36 INFO - PROCESS | 18301 | Cycle 1(1): loaded http://localhost:42126/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:42126/tests/kraken/driver.html?testName=audio-oscillator) 11:01:36 INFO - PROCESS | 18301 | RSS: Main: 165527552 11:01:36 INFO - PROCESS | 18301 | 11:01:38 INFO - PROCESS | 18301 | Cycle 1(1): loaded http://localhost:42126/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:42126/tests/kraken/driver.html?testName=imaging-gaussian-blur) 11:01:39 INFO - PROCESS | 18301 | RSS: Main: 165695488 11:01:39 INFO - PROCESS | 18301 | 11:01:42 INFO - PROCESS | 18301 | Cycle 1(1): loaded http://localhost:42126/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:42126/tests/kraken/driver.html?testName=imaging-darkroom) 11:01:43 INFO - PROCESS | 18301 | RSS: Main: 165367808 11:01:43 INFO - PROCESS | 18301 | 11:01:46 INFO - PROCESS | 18301 | Cycle 1(1): loaded http://localhost:42126/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:42126/tests/kraken/driver.html?testName=imaging-desaturate) 11:01:47 INFO - PROCESS | 18301 | RSS: Main: 162324480 11:01:47 INFO - PROCESS | 18301 | 11:01:50 INFO - PROCESS | 18301 | Cycle 1(1): loaded http://localhost:42126/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:42126/tests/kraken/driver.html?testName=json-parse-financial) 11:01:51 INFO - PROCESS | 18301 | RSS: Main: 164720640 11:01:51 INFO - PROCESS | 18301 | 11:01:52 INFO - PROCESS | 18301 | Cycle 1(1): loaded http://localhost:42126/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:42126/tests/kraken/driver.html?testName=json-stringify-tinderbox) 11:01:53 INFO - PROCESS | 18301 | RSS: Main: 164986880 11:01:53 INFO - PROCESS | 18301 | 11:01:55 INFO - PROCESS | 18301 | Cycle 1(1): loaded http://localhost:42126/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:42126/tests/kraken/driver.html?testName=stanford-crypto-aes) 11:01:56 INFO - PROCESS | 18301 | RSS: Main: 164651008 11:01:56 INFO - PROCESS | 18301 | 11:01:58 INFO - PROCESS | 18301 | Cycle 1(1): loaded http://localhost:42126/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:42126/tests/kraken/driver.html?testName=stanford-crypto-ccm) 11:01:59 INFO - PROCESS | 18301 | RSS: Main: 165666816 11:01:59 INFO - PROCESS | 18301 | 11:02:01 INFO - PROCESS | 18301 | Cycle 1(1): loaded http://localhost:42126/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:42126/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 11:02:02 INFO - PROCESS | 18301 | RSS: Main: 165208064 11:02:02 INFO - PROCESS | 18301 | 11:02:05 INFO - PROCESS | 18301 | Cycle 1(1): loaded http://localhost:42126/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:42126/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 11:02:06 INFO - PROCESS | 18301 | RSS: Main: 166076416 11:02:06 INFO - PROCESS | 18301 | 11:02:07 INFO - PROCESS | 18301 | Cycle 1(1): loaded http://localhost:42126/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:42126/tests/kraken/driver.html?testName=ai-astar) 11:02:08 INFO - PROCESS | 18301 | RSS: Main: 166895616 11:02:08 INFO - PROCESS | 18301 | 11:02:08 INFO - PROCESS | 18301 | __start_tp_report 11:02:08 INFO - PROCESS | 18301 | _x_x_mozilla_page_load 11:02:08 INFO - PROCESS | 18301 | _x_x_mozilla_page_load_details 11:02:08 INFO - PROCESS | 18301 | |i|pagename|runs| 11:02:08 INFO - PROCESS | 18301 | |0;ai-astar;110;119;108;114;115;114;117;115;116;114 11:02:08 INFO - PROCESS | 18301 | |1;audio-beat-detection;152;124;153;190;123;145;154;126;187;134 11:02:08 INFO - PROCESS | 18301 | |2;audio-dft;166;168;174;162;163;163;163;163;163;162 11:02:08 INFO - PROCESS | 18301 | |3;audio-fft;75;76;78;168;77;77;75;75;157;77 11:02:08 INFO - PROCESS | 18301 | |4;audio-oscillator;87;86;150;86;87;88;133;86;85;137 11:02:08 INFO - PROCESS | 18301 | |5;imaging-gaussian-blur;119;119;118;133;122;118;118;119;118;117 11:02:08 INFO - PROCESS | 18301 | |6;imaging-darkroom;148;148;148;150;147;151;148;150;148;148 11:02:08 INFO - PROCESS | 18301 | |7;imaging-desaturate;95;96;96;96;95;96;95;95;96;96 11:02:08 INFO - PROCESS | 18301 | |8;json-parse-financial;63;65;67;65;66;64;64;63;63;66 11:02:08 INFO - PROCESS | 18301 | |9;json-stringify-tinderbox;66;66;65;65;68;65;67;71;65;67 11:02:08 INFO - PROCESS | 18301 | |10;stanford-crypto-aes;85;84;87;83;81;80;83;81;84;86 11:02:08 INFO - PROCESS | 18301 | |11;stanford-crypto-ccm;143;141;139;138;150;153;133;151;147;143 11:02:08 INFO - PROCESS | 18301 | |12;stanford-crypto-pbkdf2;171;171;177;174;170;170;170;174;172;170 11:02:08 INFO - PROCESS | 18301 | |13;stanford-crypto-sha256-iterative;69;72;76;70;69;71;70;69;73;69 11:02:08 INFO - PROCESS | 18301 | __end_tp_report 11:02:08 INFO - PROCESS | 18301 | __start_cc_report 11:02:08 INFO - PROCESS | 18301 | _x_x_mozilla_cycle_collect,935 11:02:08 INFO - PROCESS | 18301 | __end_cc_report 11:02:08 INFO - PROCESS | 18301 | __startTimestamp1470852128217__endTimestamp 11:02:08 INFO - PROCESS | 18301 | 11:02:08 INFO - PROCESS | 18301 | ------- Summary: start ------- 11:02:08 INFO - PROCESS | 18301 | Number of tests: 14 11:02:08 INFO - PROCESS | 18301 | 11:02:08 INFO - PROCESS | 18301 | [#0] ai-astar Cycles:10 Average:114.20 Median:115.00 stddev:3.19 (2.8%) stddev-sans-first:3.00 11:02:08 INFO - PROCESS | 18301 | Values: 110.0 119.0 108.0 114.0 115.0 114.0 117.0 115.0 116.0 114.0 11:02:08 INFO - PROCESS | 18301 | 11:02:08 INFO - PROCESS | 18301 | [#1] audio-beat-detection Cycles:10 Average:148.80 Median:152.50 stddev:24.14 (15.8%) stddev-sans-first:25.58 11:02:08 INFO - PROCESS | 18301 | Values: 152.0 124.0 153.0 190.0 123.0 145.0 154.0 126.0 187.0 134.0 11:02:08 INFO - PROCESS | 18301 | 11:02:08 INFO - PROCESS | 18301 | [#2] audio-dft Cycles:10 Average:164.70 Median:163.00 stddev:3.77 (2.3%) stddev-sans-first:3.97 11:02:08 INFO - PROCESS | 18301 | Values: 166.0 168.0 174.0 162.0 163.0 163.0 163.0 163.0 163.0 162.0 11:02:08 INFO - PROCESS | 18301 | 11:02:08 INFO - PROCESS | 18301 | [#3] audio-fft Cycles:10 Average:93.50 Median:76.50 stddev:36.47 (47.7%) stddev-sans-first:38.07 11:02:08 INFO - PROCESS | 18301 | Values: 75.0 76.0 78.0 168.0 77.0 77.0 75.0 75.0 157.0 77.0 11:02:08 INFO - PROCESS | 18301 | 11:02:08 INFO - PROCESS | 18301 | [#4] audio-oscillator Cycles:10 Average:102.50 Median:86.00 stddev:26.23 (30.5%) stddev-sans-first:27.21 11:02:08 INFO - PROCESS | 18301 | Values: 87.0 86.0 150.0 86.0 87.0 88.0 133.0 86.0 85.0 137.0 11:02:08 INFO - PROCESS | 18301 | 11:02:08 INFO - PROCESS | 18301 | [#5] imaging-gaussian-blur Cycles:10 Average:120.10 Median:119.00 stddev:4.72 (4.0%) stddev-sans-first:4.99 11:02:08 INFO - PROCESS | 18301 | Values: 119.0 119.0 118.0 133.0 122.0 118.0 118.0 119.0 118.0 117.0 11:02:08 INFO - PROCESS | 18301 | 11:02:08 INFO - PROCESS | 18301 | [#6] imaging-darkroom Cycles:10 Average:148.60 Median:148.00 stddev:1.26 (0.9%) stddev-sans-first:1.32 11:02:08 INFO - PROCESS | 18301 | Values: 148.0 148.0 148.0 150.0 147.0 151.0 148.0 150.0 148.0 148.0 11:02:08 INFO - PROCESS | 18301 | 11:02:08 INFO - PROCESS | 18301 | [#7] imaging-desaturate Cycles:10 Average:95.60 Median:96.00 stddev:0.52 (0.5%) stddev-sans-first:0.50 11:02:08 INFO - PROCESS | 18301 | Values: 95.0 96.0 96.0 96.0 95.0 96.0 95.0 95.0 96.0 96.0 11:02:08 INFO - PROCESS | 18301 | 11:02:08 INFO - PROCESS | 18301 | [#8] json-parse-financial Cycles:10 Average:64.60 Median:65.00 stddev:1.43 (2.2%) stddev-sans-first:1.39 11:02:08 INFO - PROCESS | 18301 | Values: 63.0 65.0 67.0 65.0 66.0 64.0 64.0 63.0 63.0 66.0 11:02:08 INFO - PROCESS | 18301 | 11:02:08 INFO - PROCESS | 18301 | [#9] json-stringify-tinderbox Cycles:10 Average:66.50 Median:66.50 stddev:1.90 (2.9%) stddev-sans-first:2.01 11:02:08 INFO - PROCESS | 18301 | Values: 66.0 66.0 65.0 65.0 68.0 65.0 67.0 71.0 65.0 67.0 11:02:08 INFO - PROCESS | 18301 | 11:02:08 INFO - PROCESS | 18301 | [#10] stanford-crypto-aes Cycles:10 Average:83.40 Median:84.00 stddev:2.27 (2.7%) stddev-sans-first:2.33 11:02:08 INFO - PROCESS | 18301 | Values: 85.0 84.0 87.0 83.0 81.0 80.0 83.0 81.0 84.0 86.0 11:02:08 INFO - PROCESS | 18301 | 11:02:08 INFO - PROCESS | 18301 | [#11] stanford-crypto-ccm Cycles:10 Average:143.80 Median:145.00 stddev:6.39 (4.4%) stddev-sans-first:6.77 11:02:08 INFO - PROCESS | 18301 | Values: 143.0 141.0 139.0 138.0 150.0 153.0 133.0 151.0 147.0 143.0 11:02:08 INFO - PROCESS | 18301 | 11:02:08 INFO - PROCESS | 18301 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:171.90 Median:171.50 stddev:2.38 (1.4%) stddev-sans-first:2.50 11:02:08 INFO - PROCESS | 18301 | Values: 171.0 171.0 177.0 174.0 170.0 170.0 170.0 174.0 172.0 170.0 11:02:08 INFO - PROCESS | 18301 | 11:02:08 INFO - PROCESS | 18301 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:70.80 Median:70.50 stddev:2.30 (3.3%) stddev-sans-first:2.35 11:02:08 INFO - PROCESS | 18301 | Values: 69.0 72.0 76.0 70.0 69.0 71.0 70.0 69.0 73.0 69.0 11:02:08 INFO - PROCESS | 18301 | -------- Summary: end -------- 11:02:08 INFO - PROCESS | 18301 | 11:02:09 INFO - TEST-INFO | 18301: exit 0 11:02:09 INFO - TEST-OK | kraken | took 64221ms 11:02:09 INFO - SUITE-END | took 1181s 11:02:09 INFO - Completed test suite (00:19:41) 11:02:09 INFO - javascript benchmark 11:02:09 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 6441.628812199036, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2685.046808383023, 2691.5020721166584, 2694.299482134644, 2707.648005759251, 2714.334987927958, 4550.431196100488, 4821.8312359067395, 4839.370881785363, 4845.709257444556, 4860.4410492793295, 4806.158922188621, 4806.303086052529, 4857.48996355382, 4864.513548645134, 4882.121218180726, 4360.934585981213, 4403.383526306304, 4451.666125040619, 4556.817727290904, 4582.9770851145695, 4476.283794592866, 4546.227141385956, 4549.681522293441, 4568.428946381702, 4573.039661671053, 4253.234417804794, 4319.632831209351, 4357.9128417431475, 4376.956230437687, 4454.220511410506, 4339.631131353839, 4347.0, 4359.912801743979, 4380.408644832939, 4446.866594002185, 4394.231009573312, 4410.911781764346, 4419.359192917042, 4443.4445694288215, 4469.882529367658, 4783.0, 4787.976060119712, 4836.46798852126, 4837.806487740521, 4851.223804191312, 5230.398504172031, 5231.738413079331, 5232.424433312332, 5255.632105752599, 5293.206019097128, 5217.452167522393, 5239.1093514102695, 5265.52610265078, 5275.604329675251, 5309.601779866525, 4599.356090147382, 4809.374781278411, 4827.468978412372, 4871.34236878017, 4898.044881248194, 5352.4915133062295, 5377.569794416438, 5379.6234263601955, 5383.7308134593895, 5432.456754324615, 5147.613928955343, 5154.943236636481, 5156.020356132323, 5157.174852023733, 5220.843374698765, 4940.357753492095, 5158.148905430637, 5188.351456067991, 5196.376434827845, 5231.947680523146, 5170.922436163461, 5173.689578625294, 5180.7150606717, 5184.896302074013, 5226.294450249244, 5151.6908985461, 5153.948460515347, 5165.9225111623355, 5179.378474583074, 5222.529972302511, 4225.345071513921, 4363.6072753452345, 4394.033312671208, 4397.846075387346, 4403.911921761547, 3831.8275677594575, 3852.3065848147603, 3854.9614503854605, 3907.8632247871756, 3911.706622003361, 4504.977475112603, 4547.590716835501, 4555.0, 4571.588557029883, 4597.057603191338, 4946.727929963887, 5171.974140129275, 5215.869603259949, 5227.242049902743, 5280.551153151949, 4489.214387482178, 4518.932216016762, 4521.8191272349395, 4548.158590660738, 4570.65720070996, 4713.175194340976, 4726.929096063562, 4736.171170045228, 4771.093492236464, 4776.283557466339, 4752.049590082067, 4767.570918617341, 4881.463039065771, 4925.827596034122, 4972.154733695353, 5244.921326180034, 5252.054630166606, 5256.132738098171, 5274.446183150714, 5277.234800953917, 4943.382077240345, 4972.701637901738, 4980.0, 4988.800447982186, 5018.874528136826, 4938.629602779734, 5057.190849464068, 5105.030044291572, 5120.97439512815, 5167.741612919263, 5184.9740751296, 5219.634625576326, 5221.2690223368, 5227.843164705065, 5267.051930652519, 5054.671446355975, 5056.974715126401, 5060.089183946778, 5067.670601410897, 5116.769745361393, 4848.80604775805, 4958.6281028923695, 5012.273220382951, 5015.799368025238, 5020.523050310215, 4927.852164435073, 4947.703137811743, 4973.850784476472, 4982.701037937735, 5020.673656212334, 5030.421501527371, 5073.543381095719, 5083.161278389024, 5083.212102124176, 5109.923351149661, 4732.952670473389, 4801.151556650784, 4927.9507204927495, 4942.950570494249, 5002.974985125051], "value": 4763.521460263108, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [543.3425555078355, 549.2941570082444, 558.5336244236063, 565.4373897971517, 594.4323171371341, 35224.82387588065, 38857.41713874287, 39118.21763564727, 39123.41314880272, 39172.80413597931, 38749.225015499745, 39175.0, 39225.803870980606, 39335.60664393362, 39358.21283574327, 7647.388208943271, 7783.455158138932, 7785.766427007171, 7786.065672119325, 7787.299143077122, 7673.884891726629, 7715.575643339614, 7748.070231572219, 7791.0, 7791.883121753178, 7787.7663670089705, 7833.490823096509, 7843.0, 7843.882341764878, 7851.371890248766, 7767.572783496906, 7794.259545343211, 7815.726449574237, 7823.413244006722, 7826.5695386753705, 7683.231676832328, 7751.0311211098615, 7781.8832717509285, 7781.9610901945125, 7783.688652453895, 37618.811905940565, 37942.0, 37954.430683539766, 38121.0, 38448.0, 2350.882455877216, 2933.8973135940355, 3108.9533656995163, 3115.12776422602, 3371.393149233137, 26366.340841478926, 26522.86738566314, 27342.863285683645, 27915.441691166063, 28354.29114272139, 3255.7232635226032, 3274.1159886830424, 3306.2230375861654, 3329.6836800503916, 3423.246885685145, 231999.0, 232211.0, 232255.0, 233546.0, 234609.0, 32113.197170070467, 32132.0, 32219.35561288761, 32273.677263227535, 32285.838570806995, 32115.1096401325, 33042.3391532168, 33255.334893301995, 33256.0, 35225.47161792575, 14597.416103355747, 14814.333354999051, 14829.406823727146, 14835.480758173411, 14884.553463396116, 11292.887071129184, 11449.141314401453, 11525.0, 11556.422178891022, 11564.826527602092, 17993.640127197643, 18017.819821801877, 18065.638687226183, 18172.0, 18236.36172733948, 6738.713926475804, 6785.626790526569, 6843.7604683835825, 7075.150981882207, 7184.461165412615, 819.8770184472377, 895.4224525181352, 911.4576826788051, 913.8674892140602, 969.1277849935115, 27193.864030680117, 28272.29319267035, 28419.147425577266, 29100.563491547644, 29111.272218194714, 971.0, 973.5959576775559, 987.8913319534845, 1071.5499490214129, 1082.7509672775307, 15029.699406011818, 15349.923250383677, 15352.539423817303, 15357.692846143238, 15574.688506229812, 393976.0, 395645.0, 396325.0, 396340.0, 400731.0, 32479.18802029968, 32618.184545386554, 32723.0, 32753.67246327554, 32775.836120819244, 1169.636091627965, 1217.6468824040928, 1228.7419641875128, 1237.0660151585496, 1244.7448273103992, 26245.0, 27488.58767118535, 28241.0, 28252.717472825832, 28765.28086797847, 43018.0, 43261.35107973446, 43375.13249735051, 43414.782926085165, 43431.782841085595, 355078.0, 355208.0, 355925.0, 356981.0, 357640.0, 24753.0, 25568.0, 25681.614775778005, 25994.61008084918, 26071.348216294744, 42236.36645450259, 42466.0, 43040.0, 43240.0, 43717.562824372624, 35992.78589862407, 36021.0, 36688.63311366959, 37679.0, 37811.243775124894, 35637.465438017935, 36065.27869442649, 36448.08879778027, 36567.26865462623, 36761.26477470382, 35969.0, 36222.45666314955, 36323.0, 36457.81771091127, 37148.62851371452, 30896.69103309028, 33042.33915321728, 33068.1732956678, 33114.0, 33460.330793384484, 25591.488170236862, 25769.649945506964, 26152.34619134537, 26180.60729089027, 26366.340841479116], "value": 16908.2335615799, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [357.79248036139023, 360.1967612224737, 379.22070145850273, 380.58136050344615, 393.37846202999265, 15535.300911458984, 16800.159992000397, 17491.650166996667, 17612.20745066472, 17655.382061627846, 16306.510804675878, 16933.83066169338, 17028.744568831447, 17101.40145094922, 17116.82883171168, 5139.15203991341, 5334.946650533503, 5342.385625653061, 5345.4387289334645, 5347.732613369335, 3767.7739335639812, 5224.477552244764, 5850.0932355484965, 6084.604500707462, 6158.84602884927, 6176.660283684396, 6198.132261483396, 6222.844428889269, 6245.843853903643, 6247.750089996394, 5012.172991456406, 5250.894982100355, 5286.497782710656, 5356.54469370104, 5361.2226227197225, 5158.226266060084, 5172.27588137661, 5187.948120518822, 5193.8961220775755, 5197.350331208599, 12736.108472406935, 12896.09727319088, 13012.739745205137, 20434.489137771525, 20919.477013074644, 1893.640208360421, 1898.7057006164066, 2047.30391666834, 2442.9755702442926, 2493.164789795421, 9164.541772911327, 9295.349325547215, 9311.20854727349, 9387.121799844857, 9562.378445401027, 1662.983370166295, 1684.2168391697796, 1808.439383791029, 1932.7584051993501, 1940.3984764722982, 45005.0, 73184.63407682927, 73302.26697733007, 74547.0, 74693.25306746917, 9921.40471571708, 10159.339642923334, 10166.966606678694, 10202.438865862448, 10335.0, 13850.307484625728, 13943.651408714863, 13968.93015534936, 14001.43994240219, 14001.929990349983, 7421.0, 7708.922910770821, 7737.922620773833, 7819.413543984224, 7854.410919181084, 7290.927090729025, 7386.519876208029, 7397.667104980289, 7593.6582853771715, 7665.846683066307, 4276.657867370603, 4316.078551249097, 4359.711151645348, 4410.316400957857, 4481.3195051855555, 1538.2155100898622, 1614.701280263155, 1637.2550489527237, 1822.9088545572667, 1914.009430192612, 828.2722201856662, 904.5703290936752, 924.3714274293545, 930.7673081729567, 943.3538026451903, 16659.750103748454, 17164.498076598135, 17836.9108154461, 17852.19665115073, 17994.370197043303, 855.4867079752099, 891.4473026723473, 913.9497327647043, 958.4009993753904, 994.4282037828277, 9579.329446938647, 9852.50737463124, 10024.749381265527, 10043.598256069676, 10125.898741012643, 381098.0, 386493.0, 417173.0, 422147.0, 424275.0, 78699.60650196712, 78828.0, 79627.0, 79772.0, 79927.60036199898, 850.5449584472277, 876.6887754847065, 903.8960519540205, 908.4458480326995, 909.0409617853228, 15189.468368607046, 15265.923670381577, 15797.526074217792, 15991.92004040019, 16002.67994640124, 34957.126071848405, 36713.44929826001, 38158.61841381551, 40811.59188408078, 41359.37960930528, 52634.73682631715, 54709.179362310395, 54830.0, 55175.44824551864, 55500.72249638887, 7700.151963528825, 7789.64946577394, 7938.24586664266, 7951.0, 8023.83952320962, 8585.313174946114, 8672.913270867211, 8963.844402691839, 12325.815112773495, 12843.807342889677, 7814.374850012099, 8041.356691464785, 8095.595220239083, 8260.091389947222, 8457.746267611981, 7602.695892164473, 7750.883736743841, 7802.180771019188, 8163.102058773649, 8197.590120493833, 8044.798880027812, 8109.1890810920795, 8209.466384684976, 8353.707620233263, 8536.573171341532, 11424.200305978502, 11734.237274577124, 12008.75982480363, 12014.579489717818, 12081.879181208076, 11161.776764464503, 11295.435228238719, 11453.828192577284, 11788.823167652663, 11806.350650714294], "value": 8257.542791298269, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1376.6764810269585, 1408.0988167572755, 1486.4202960845273, 1645.2020769926592, 1667.2497376180713, 6562.409383155515, 7228.457865660071, 7554.942308076874, 7848.097468791091, 7860.096088949773, 7628.923710762891, 7899.328557072641, 7920.881186782203, 7924.603769811501, 7924.801879953004, 2152.278986539511, 2195.034184958621, 2196.3959911024435, 2196.615592271354, 2203.0747086223823, 2132.5201829588373, 2171.0447403142643, 2210.1932794530044, 2211.6019116559014, 2219.8224142068675, 2172.5329054253334, 2208.138825857917, 2210.1490925993526, 2214.878181700006, 2254.2786308381324, 2115.3548167808813, 2122.278425335378, 2123.2462475821094, 2123.6071326804436, 2125.0, 2143.0677655219874, 2145.463634091477, 2168.3278183762927, 2171.1098449635733, 2171.348595421383, 7714.498557593738, 7928.643211055516, 7951.522908625501, 7997.600119993977, 8024.879626805603, 4465.68740188187, 4620.976895115503, 4625.722456652612, 4632.536746325374, 4672.3692301539195, 2952.852357382122, 3036.1954082168245, 3046.7562594992346, 3050.9542356864663, 3098.5971823663003, 916.6104405627582, 917.2249449215402, 988.0761488008735, 998.4458625462865, 1008.5058321422523, 10836.891631083667, 10842.783144337149, 10850.186236032328, 10865.185111116698, 10881.075108615698, 3903.6096390361304, 4126.257273690764, 4240.830366785356, 4243.215005224043, 4265.850695225652, 9195.90804091964, 9238.0, 9286.95356523213, 9300.90699093014, 9308.069193080637, 4572.954270457253, 4576.496585375606, 4608.308753686907, 4612.976935115303, 4616.492185859553, 3455.6371580984137, 4171.436856024458, 4176.686748493875, 4218.557051509609, 4332.133573285356, 3617.819109044537, 3714.23858109087, 3788.905277368033, 3801.6198380161763, 3845.9230815383535, 1143.7655280667443, 1148.7415331550335, 1148.977020459603, 1160.988390116105, 1186.7507823357018, 763.1986414265, 772.2894936658288, 780.9960950195326, 787.2717736094205, 802.6147449224288, 5180.300659410931, 5256.316678831804, 5285.63000589955, 5367.973160134175, 5390.460953904578, 394.1624048896096, 406.5385787131627, 407.45808075259833, 407.567977943381, 411.40141094707127, 3580.7135429165605, 3604.33319835826, 3610.151614370621, 3628.965909260843, 3664.9633503665154, 9591.520423978773, 9895.505224738734, 9919.702408927744, 9927.354721943195, 9988.500574971222, 9836.754081148028, 9845.803083938425, 9870.457124858201, 9875.20998320147, 9891.10980011788, 7518.586477743776, 7542.962285188539, 7609.695612175451, 7613.972113764571, 7623.885641715378, 5018.096742586369, 5067.366579177603, 5072.467390924047, 5136.229565565195, 5261.947380526146, 8979.281657467256, 9035.27717782589, 9036.819263614823, 9075.636974521209, 9109.544522773967, 9021.954890225506, 9105.04397038328, 9298.442093474414, 9380.20268277204, 9400.0, 6782.593044417351, 6815.0, 6839.555428897106, 6844.178698556205, 6869.519133660796, 7542.132654744774, 7556.319931206218, 7587.127480339832, 7604.961975190088, 7622.352100071556, 6869.210040845367, 6957.443404527525, 7004.894926576208, 7078.1860086090755, 7140.46446516503, 6737.865242695217, 6809.625470598967, 6820.283870193757, 6826.965865170642, 6879.759208427681, 6310.337414571588, 6348.206474190726, 6349.238091429058, 6427.228732552124, 6438.420542151229, 4599.563041511051, 4748.928766068442, 4757.976210118927, 4766.761661916821, 4890.853274401774, 4552.931706024346, 4598.26427771555, 4613.0210099963215, 4631.791569379318, 4727.149113159527], "value": 4088.668534058922, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [281.6676321940111, 282.1465068168789, 288.1341568586398, 288.6492911112997, 291.67769614575906, 5056.129232184093, 5075.670081444703, 5085.287739949838, 5092.0, 5123.205903085019, 4972.925406118911, 4980.178270585349, 4982.975085124578, 5028.396592408907, 5044.772985215665, 3682.6869716074166, 3756.492873462075, 3879.35990561557, 3905.902352441183, 3913.7456065355805, 3882.5729169791302, 3889.747166434173, 3891.8443262269475, 3902.9609703902884, 3905.2384784966944, 3876.7092468064866, 3877.7509044753974, 3883.9805800970958, 3888.0, 3893.8442462301473, 3772.5284339457567, 3862.942055869164, 3881.301365754149, 3881.3207688654375, 3883.339832228514, 3423.8972830815114, 3443.94959537341, 3445.776024558396, 3449.5170676105367, 3450.258194488197, 4895.510448955076, 4915.975420122876, 4928.383952005999, 4939.0, 4948.094983431369, 4387.341898715218, 4479.3504941783585, 4486.439195100613, 4490.640748740093, 4514.977425112854, 5201.921971170435, 5203.4763139877505, 5227.869303267449, 5254.0, 5264.552513036397, 3728.6017743346247, 3742.4573436851506, 3744.157564547982, 3753.530808648919, 3771.0383852117807, 5385.040239861104, 5454.645448045864, 5469.972650136764, 5481.725913704299, 5484.890302193934, 3684.907877303035, 3749.8500059997295, 3794.6205379461835, 3806.2006978534264, 3834.9616503835164, 3865.903352416212, 3868.497095377639, 3877.3796192609047, 3880.902977425587, 3893.474380958591, 4446.0, 4458.375827384169, 4462.196804575207, 4465.285554311295, 4476.395686582335, 5077.669951453217, 5233.215017747369, 5298.70857102863, 5310.203469479532, 5337.332833395825, 1325.9403326850315, 1347.0772520823268, 1350.8787706203827, 1351.4594162335145, 1352.2495015266425, 807.588130053665, 825.108882407011, 846.3483117999107, 860.2429861721645, 860.4192170285032, 4390.648748100144, 4485.327200919888, 4607.401037865056, 4613.30800379939, 4613.308003799457, 5347.893042139213, 5359.08895487768, 5375.650582712111, 5400.864978375572, 5408.296386638275, 4597.793059331473, 4607.654425918069, 4610.631149508032, 4616.446026476844, 4629.675922685447, 2697.5414179589516, 2839.5030869597736, 2868.3076984579197, 2871.425714857037, 2879.5392737161956, 5082.390113186441, 5132.538071573502, 5135.0, 5146.433892271847, 5169.922451163236, 5264.526192642604, 5463.617546771688, 5531.751071201806, 5534.446555344433, 5537.169424586345, 5077.314562534085, 5103.004914041726, 5103.137354865373, 5103.617228707862, 5107.923381149211, 5359.946400535945, 5366.490183432567, 5367.704776237344, 5384.649997750291, 5390.622656414013, 5022.296878436949, 5187.610929180402, 5232.529072383351, 5249.238860365302, 5273.182656688219, 5091.567216786615, 5103.515166059218, 5110.642255042111, 5128.923066153936, 5139.563137133236, 3723.404255319136, 3770.377887648507, 3793.0465810107266, 3793.6016718244186, 3811.0662887592716, 5146.536811686966, 5277.393099793573, 5290.100682883842, 5330.200469929387, 5345.893082138413, 5137.17805151189, 5145.176771716657, 5172.189733593213, 5177.974110129425, 5188.273641690242, 5163.199704045879, 5170.1986192140275, 5174.63777535584, 5176.249443830548, 5188.22176673502, 4924.8768780780765, 5069.847904562869, 5097.7510509925305, 5099.36257967754, 5103.464136265638, 4970.552650261494, 5130.897382052263, 5149.897002060013, 5193.662411943212, 5285.894282114259, 5136.409312929061, 5146.50751282124, 5170.586353091819, 5171.482851714798, 5191.195364718475], "value": 3925.2444008590614, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [578.1585649705688, 643.9066335381369, 649.9187601549806, 656.9080328753976, 670.5272782688205, 13005.869941300583, 13724.931375343134, 14161.433542658295, 14180.22008789516, 14975.400983960655, 13625.795613065788, 13809.24049177295, 13858.93070534646, 13861.0, 13956.162630242192, 639.0382474376081, 768.7386288661868, 790.9604519773989, 793.9404544659174, 794.1899262751989, 763.5914785589711, 782.9530228186327, 787.0398114300544, 789.4789438970281, 792.2275781113426, 829.2950991657103, 832.305025303872, 832.8084540555676, 832.8459235041506, 834.9332053435711, 822.7531740477892, 825.2036784502924, 826.3926014379426, 826.710651272056, 827.437342607027, 598.0759726222996, 599.3018133874032, 599.484443378694, 601.3235110500686, 603.1254680712984, 12587.181833180814, 12595.622131336075, 12597.37013149348, 12609.180403273758, 12631.115821892472, 13598.0, 13954.162750234917, 14129.293535323295, 14256.693818498929, 14431.278436078259, 10829.458527073615, 10895.782084358349, 11060.391678457681, 11161.72095697606, 11188.66434006981, 3245.0, 3252.073159149631, 3263.347330533879, 3271.558339624144, 3374.898753037413, 67328.3267167327, 68298.0, 69357.3064269356, 69627.0, 70115.64942175256, 10210.846837297446, 10491.10825579819, 10591.523381447852, 10596.205284603686, 10713.517891694892, 16863.494095177164, 17594.296228150986, 20954.685679714818, 20958.371248862557, 21216.04527796253, 7215.989761433403, 7281.672324745399, 7311.341979221896, 7381.66782494789, 7530.887036694454, 3893.2213557288655, 3901.0637447012514, 3901.453796468497, 3942.664873485786, 3969.2458432897656, 2893.4357800228754, 2997.385535965122, 3152.590163278759, 3317.3531161423775, 3337.933241335208, 558.1209594888068, 560.529155509366, 567.2342337843878, 567.6820980251073, 574.0814696485589, 597.0894386061204, 608.4341562347059, 610.8137018209488, 615.9507239420835, 621.627023785725, 8729.781755456164, 8988.46069235848, 9018.368714190075, 9021.594028268744, 9134.086591340945, 497.9626528010414, 603.5503549855385, 627.1971875998729, 628.1456822415048, 633.7655067624916, 4116.814743336557, 4203.55862634419, 4249.7237679551345, 4395.670324725658, 4478.798454069574, 100879.0, 103701.96298036924, 104005.47997259966, 104879.47560262303, 106081.0, 54481.727591362585, 56725.43274567284, 92136.0, 93652.0, 93879.0, 74125.0, 77951.22048779554, 79544.6022769894, 79872.805087797, 80029.0, 8138.104808470945, 8360.414770965974, 8374.958125209336, 8529.445586036887, 8531.616077276414, 46100.30849537192, 46718.0, 46896.53103469058, 47492.0, 47847.0, 66025.0, 69505.30494694988, 69773.0, 70225.64887175531, 71519.64240178766, 9745.463999480096, 9973.351732137387, 10027.598896044077, 10119.241056920613, 10246.129079028366, 11513.36676482768, 11651.0, 11724.531018759155, 12088.032957363213, 12088.75822483563, 11179.217454778087, 11283.629969464608, 11344.716382090513, 11371.204015719151, 11886.702832429259, 11067.50196241155, 11119.221654484109, 11143.65696777955, 11371.829422558834, 11615.128865334964, 10996.890031099587, 11069.833952490559, 11206.495707693337, 11240.381779002233, 11560.364179970182, 8891.64433422656, 8967.778091879729, 8999.730008099768, 9202.401843880127, 9307.581158847732, 9445.433274003582, 9807.117359437685, 9812.950935245279, 9849.950750246202, 9854.211663066793], "value": 6692.705314949088, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1589.0000000000002, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [110.0, 119.0, 108.0, 114.0, 115.0, 114.0, 117.0, 115.0, 116.0, 114.0], "value": 114.2, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [152.0, 124.0, 153.0, 190.0, 123.0, 145.0, 154.0, 126.0, 187.0, 134.0], "value": 148.8, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [166.0, 168.0, 174.0, 162.0, 163.0, 163.0, 163.0, 163.0, 163.0, 162.0], "value": 164.7, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 76.0, 78.0, 168.0, 77.0, 77.0, 75.0, 75.0, 157.0, 77.0], "value": 93.5, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [87.0, 86.0, 150.0, 86.0, 87.0, 88.0, 133.0, 86.0, 85.0, 137.0], "value": 102.5, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [119.0, 119.0, 118.0, 133.0, 122.0, 118.0, 118.0, 119.0, 118.0, 117.0], "value": 120.1, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [148.0, 148.0, 148.0, 150.0, 147.0, 151.0, 148.0, 150.0, 148.0, 148.0], "value": 148.6, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 96.0, 96.0, 96.0, 95.0, 96.0, 95.0, 95.0, 96.0, 96.0], "value": 95.6, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [63.0, 65.0, 67.0, 65.0, 66.0, 64.0, 64.0, 63.0, 63.0, 66.0], "value": 64.6, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [66.0, 66.0, 65.0, 65.0, 68.0, 65.0, 67.0, 71.0, 65.0, 67.0], "value": 66.5, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 84.0, 87.0, 83.0, 81.0, 80.0, 83.0, 81.0, 84.0, 86.0], "value": 83.4, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [143.0, 141.0, 139.0, 138.0, 150.0, 153.0, 133.0, 151.0, 147.0, 143.0], "value": 143.8, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [171.0, 171.0, 177.0, 174.0, 170.0, 170.0, 170.0, 174.0, 172.0, 170.0], "value": 171.9, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [69.0, 72.0, 76.0, 70.0, 69.0, 71.0, 70.0, 69.0, 73.0, 69.0], "value": 70.8, "unit": "score"}]}]} 11:02:09 INFO - Return code: 0 11:02:09 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 11:02:09 ERROR - # TBPL SUCCESS # 11:02:09 INFO - Running post-action listener: _resource_record_post_action 11:02:09 INFO - [mozharness: 2016-08-10 18:02:09.505803Z] Finished run-tests step (success) 11:02:09 INFO - Running post-run listener: _resource_record_post_run 11:02:09 INFO - Total resource usage - Wall time: 1198s; CPU: 13.0%; Read bytes: 0; Write bytes: 550424576; Read time: 0; Write time: 441112 11:02:09 INFO - TinderboxPrint: CPU usage
13.3% 11:02:09 INFO - TinderboxPrint: I/O read bytes / time
0 / 0 11:02:09 INFO - TinderboxPrint: I/O write bytes / time
550,424,576 / 441,112 11:02:09 INFO - TinderboxPrint: CPU idle
8,282.7 (86.6%) 11:02:09 INFO - TinderboxPrint: CPU user
1,219.8 (12.8%) 11:02:09 INFO - TinderboxPrint: Swap in / out
0 / 0 11:02:09 INFO - install - Wall time: 16s; CPU: 14.0%; Read bytes: 0; Write bytes: 252973056; Read time: 0; Write time: 253256 11:02:09 INFO - run-tests - Wall time: 1182s; CPU: 13.0%; Read bytes: 0; Write bytes: 297451520; Read time: 0; Write time: 187856 11:02:10 INFO - Running post-run listener: _upload_blobber_files 11:02:10 INFO - Blob upload gear active. 11:02:10 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 11:02:10 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 11:02:10 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', 'Autoland-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 11:02:10 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 Autoland-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 11:02:10 INFO - (blobuploader) - INFO - Open directory for files ... 11:02:10 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 11:02:10 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:02:10 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:02:11 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 11:02:11 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:02:11 INFO - (blobuploader) - INFO - Done attempting. 11:02:11 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 11:02:11 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:02:11 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:02:12 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 11:02:12 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:02:12 INFO - (blobuploader) - INFO - Done attempting. 11:02:12 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 11:02:12 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:02:12 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:02:19 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 11:02:19 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:02:19 INFO - (blobuploader) - INFO - Done attempting. 11:02:19 INFO - (blobuploader) - INFO - Iteration through files over. 11:02:19 INFO - Return code: 0 11:02:19 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 11:02:19 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 11:02:19 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/6843e276eb3e270bc840caf0084a5ecec7e98dd8574f0dd497e25e89f1ac85460208a754702f4317e8813057e4c33a1cf197f0fcce8239cd4efa2bf26bbfaa2e", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/cbecb4bdf54b2e5c7166f401a13ba2ae79ec4c7019a19711970b0d4e9869beb89e9e23a9ef2959ded3f595aafc319303c5a82e692572997aabf54683ae38000a", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/1a790b651194da6652057f1421d8e965ebfb29d6914cf1b11a722a4447293d0f88e93048516f4147cef8dd7bedd69bf43a79f54141f796382b435b134860e9ed"} 11:02:19 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 11:02:19 INFO - Writing to file /builds/slave/test/properties/blobber_files 11:02:19 INFO - Contents: 11:02:19 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/6843e276eb3e270bc840caf0084a5ecec7e98dd8574f0dd497e25e89f1ac85460208a754702f4317e8813057e4c33a1cf197f0fcce8239cd4efa2bf26bbfaa2e", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/cbecb4bdf54b2e5c7166f401a13ba2ae79ec4c7019a19711970b0d4e9869beb89e9e23a9ef2959ded3f595aafc319303c5a82e692572997aabf54683ae38000a", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/1a790b651194da6652057f1421d8e965ebfb29d6914cf1b11a722a4447293d0f88e93048516f4147cef8dd7bedd69bf43a79f54141f796382b435b134860e9ed"} 11:02:19 INFO - Running post-run listener: copy_logs_to_upload_dir 11:02:19 INFO - Copying logs to upload dir... 11:02:19 INFO - mkdir: /builds/slave/test/build/upload/logs 11:02:19 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1237.863264 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 37 secs) (at 2016-08-10 11:02:18.906494) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-08-10 11:02:18.909692) ========= 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=6d15e502d8e29d5d2676d664000001c3-1470850899.276051-603618958 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/6843e276eb3e270bc840caf0084a5ecec7e98dd8574f0dd497e25e89f1ac85460208a754702f4317e8813057e4c33a1cf197f0fcce8239cd4efa2bf26bbfaa2e", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/cbecb4bdf54b2e5c7166f401a13ba2ae79ec4c7019a19711970b0d4e9869beb89e9e23a9ef2959ded3f595aafc319303c5a82e692572997aabf54683ae38000a", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/1a790b651194da6652057f1421d8e965ebfb29d6914cf1b11a722a4447293d0f88e93048516f4147cef8dd7bedd69bf43a79f54141f796382b435b134860e9ed"} build_url:https://queue.taskcluster.net/v1/task/bFA_a0i3SP6SjBuZbj49jg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011277 build_url: 'https://queue.taskcluster.net/v1/task/bFA_a0i3SP6SjBuZbj49jg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/6843e276eb3e270bc840caf0084a5ecec7e98dd8574f0dd497e25e89f1ac85460208a754702f4317e8813057e4c33a1cf197f0fcce8239cd4efa2bf26bbfaa2e", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/cbecb4bdf54b2e5c7166f401a13ba2ae79ec4c7019a19711970b0d4e9869beb89e9e23a9ef2959ded3f595aafc319303c5a82e692572997aabf54683ae38000a", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/1a790b651194da6652057f1421d8e965ebfb29d6914cf1b11a722a4447293d0f88e93048516f4147cef8dd7bedd69bf43a79f54141f796382b435b134860e9ed"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-08-10 11:02:18.935294) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-08-10 11:02:18.935650) ========= 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=6d15e502d8e29d5d2676d664000001c3-1470850899.276051-603618958 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004537 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-08-10 11:02:19.020753) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-08-10 11:02:19.021281) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-08-10 11:02:19.021772) ========= ========= Total master_lag: 0.16 =========