builder: fx-team_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-066 starttime: 1470849728.04 results: success (0) buildid: 20160810083014 builduid: 7a24fc98c0f14960957fdefdcd3a16d9 revision: 531100c1d950c8857dda172573fbd23360f7619b ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-08-10 10:22:08.044153) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-08-10 10:22:08.044644) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-08-10 10:22:08.044930) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-08-10 10:22:08.060028) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-10 10:22:08.060437) ========= 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=82c74bd3bc9a11c5833d2010000001e6-1470849727.689592-844574423 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-08-10 10:22:08-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 35.6M=0s 2016-08-10 10:22:08 (35.6 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.128951 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-10 10:22:08.203327) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-08-10 10:22:08.203637) ========= 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=82c74bd3bc9a11c5833d2010000001e6-1470849727.689592-844574423 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.015127 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-08-10 10:22:08.253122) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-08-10 10:22:08.253481) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 531100c1d950c8857dda172573fbd23360f7619b --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/fx-team --rev 531100c1d950c8857dda172573fbd23360f7619b --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=82c74bd3bc9a11c5833d2010000001e6-1470849727.689592-844574423 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-08-10 10:22:08,619 truncating revision to first 12 chars 2016-08-10 10:22:08,619 Setting DEBUG logging. 2016-08-10 10:22:08,619 attempt 1/10 2016-08-10 10:22:08,619 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/531100c1d950?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-08-10 10:22:09,632 unpacking tar archive at: fx-team-531100c1d950/testing/mozharness/ program finished with exit code 0 elapsedTime=1.325075 ========= master_lag: 0.04 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-08-10 10:22:09.617587) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-08-10 10:22:09.617926) ========= script_repo_revision: 531100c1d950c8857dda172573fbd23360f7619b ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-08-10 10:22:09.618361) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-08-10 10:22:09.618642) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-08-10 10:22:09.631714) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 31 secs) (at 2016-08-10 10:22:09.632091) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team'] 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=82c74bd3bc9a11c5833d2010000001e6-1470849727.689592-844574423 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 10:22:10 INFO - MultiFileLogger online at 20160810 10:22:10 in /builds/slave/test 10:22:10 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 10:22:10 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 10:22:10 INFO - {'append_to_log': False, 10:22:10 INFO - 'base_work_dir': '/builds/slave/test', 10:22:10 INFO - 'blob_upload_branch': 'Fx-Team', 10:22:10 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 10:22:10 INFO - 'branch': 'Fx-Team', 10:22:10 INFO - 'buildbot_json_path': 'buildprops.json', 10:22:10 INFO - 'config_files': ('talos/linux_config.py',), 10:22:10 INFO - 'default_actions': ('clobber', 10:22:10 INFO - 'read-buildbot-config', 10:22:10 INFO - 'download-and-extract', 10:22:10 INFO - 'populate-webroot', 10:22:10 INFO - 'create-virtualenv', 10:22:10 INFO - 'install', 10:22:10 INFO - 'run-tests'), 10:22:10 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 10:22:10 INFO - 'download_minidump_stackwalk': True, 10:22:10 INFO - 'download_symbols': 'ondemand', 10:22:10 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 10:22:10 INFO - 'tooltool.py': '/tools/tooltool.py', 10:22:10 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 10:22:10 INFO - '/tools/misc-python/virtualenv.py')}, 10:22:10 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 10:22:10 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 10:22:10 INFO - 'installer_path': 'installer.exe', 10:22:10 INFO - 'log_level': 'info', 10:22:10 INFO - 'log_name': 'talos', 10:22:10 INFO - 'log_to_console': True, 10:22:10 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 10:22:10 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 10:22:10 INFO - 'opt_config_files': (), 10:22:10 INFO - 'pip_index': False, 10:22:10 INFO - 'sps_profile': False, 10:22:10 INFO - 'sps_profile_interval': 0, 10:22:10 INFO - 'suite': 'dromaeojs', 10:22:10 INFO - 'system_bits': '32', 10:22:10 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 10:22:10 INFO - 'title': 'talos-linux64-ix-066', 10:22:10 INFO - 'tooltool_cache': '/builds/tooltool_cache', 10:22:10 INFO - 'use_talos_json': True, 10:22:10 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 10:22:10 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 10:22:10 INFO - 'work_dir': 'build'} 10:22:10 INFO - [mozharness: 2016-08-10 17:22:10.087316Z] Running clobber step. 10:22:10 INFO - Running pre-action listener: _resource_record_pre_action 10:22:10 INFO - Running main action method: clobber 10:22:10 INFO - rmtree: /builds/slave/test/build 10:22:10 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 10:22:11 INFO - Running post-action listener: _resource_record_post_action 10:22:11 INFO - [mozharness: 2016-08-10 17:22:11.070931Z] Finished clobber step (success) 10:22:11 INFO - [mozharness: 2016-08-10 17:22:11.071034Z] Running read-buildbot-config step. 10:22:11 INFO - Running pre-action listener: _resource_record_pre_action 10:22:11 INFO - Running main action method: read_buildbot_config 10:22:11 INFO - Using buildbot properties: 10:22:11 INFO - { 10:22:11 INFO - "project": "", 10:22:11 INFO - "product": "firefox", 10:22:11 INFO - "script_repo_revision": "production", 10:22:11 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs", 10:22:11 INFO - "repository": "", 10:22:11 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs", 10:22:11 INFO - "buildid": "20160810083014", 10:22:11 INFO - "pgo_build": "True", 10:22:11 INFO - "basedir": "/builds/slave/test", 10:22:11 INFO - "buildnumber": 355, 10:22:11 INFO - "slavename": "talos-linux64-ix-066", 10:22:11 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 10:22:11 INFO - "platform": "ubuntu64_hw", 10:22:11 INFO - "scheduler": "tests-fx-team-linux64-pgo-talos", 10:22:11 INFO - "branch": "fx-team", 10:22:11 INFO - "repo_path": "integration/fx-team", 10:22:11 INFO - "revision": "531100c1d950c8857dda172573fbd23360f7619b", 10:22:11 INFO - "stage_platform": "linux64-pgo", 10:22:11 INFO - "builduid": "7a24fc98c0f14960957fdefdcd3a16d9", 10:22:11 INFO - "slavebuilddir": "test" 10:22:11 INFO - } 10:22:11 INFO - Found installer url https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2. 10:22:11 INFO - Running post-action listener: _resource_record_post_action 10:22:11 INFO - [mozharness: 2016-08-10 17:22:11.073461Z] Finished read-buildbot-config step (success) 10:22:11 INFO - [mozharness: 2016-08-10 17:22:11.073551Z] Running download-and-extract step. 10:22:11 INFO - Running pre-action listener: _resource_record_pre_action 10:22:11 INFO - Running main action method: download_and_extract 10:22:11 INFO - mkdir: /builds/slave/test/build/tests 10:22: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:22:11 INFO - trying https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 10:22:11 INFO - Downloading https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/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:22:11 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/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:22:11 INFO - Downloaded 1361 bytes. 10:22:11 INFO - Reading from file /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 10:22:11 INFO - Using the following test package requirements: 10:22:11 INFO - {u'common': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'], 10:22:11 INFO - u'cppunittest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 10:22:11 INFO - u'firefox-51.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 10:22:11 INFO - u'gtest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 10:22:11 INFO - u'firefox-51.0a1.en-US.linux-x86_64.gtest.tests.zip'], 10:22:11 INFO - u'jittest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 10:22:11 INFO - u'jsshell-linux-x86_64.zip'], 10:22:11 INFO - u'mochitest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 10:22:11 INFO - u'firefox-51.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 10:22:11 INFO - u'mozbase': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'], 10:22:11 INFO - u'reftest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 10:22:11 INFO - u'firefox-51.0a1.en-US.linux-x86_64.reftest.tests.zip'], 10:22:11 INFO - u'talos': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 10:22:11 INFO - u'firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip'], 10:22:11 INFO - u'web-platform': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 10:22:11 INFO - u'firefox-51.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 10:22:11 INFO - u'xpcshell': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 10:22:11 INFO - u'firefox-51.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 10:22:11 INFO - Downloading packages: [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 10:22: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:22:11 INFO - trying https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 10:22:11 INFO - Downloading https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/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:22:11 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/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:22:12 INFO - Downloaded 21831360 bytes. 10:22:12 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:22:12 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:22:13 INFO - Return code: 0 10:22:13 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:22:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:22:13 INFO - trying https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 10:22:13 INFO - Downloading https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/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:22:13 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/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:22:14 INFO - Downloaded 21831360 bytes. 10:22:14 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:22:14 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:22:15 INFO - Return code: 0 10:22:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:22:15 INFO - trying https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip 10:22:15 INFO - Downloading https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/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:22:15 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/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:22:16 INFO - Downloaded 14413719 bytes. 10:22:16 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:22:16 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:22:16 INFO - Return code: 0 10:22:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:22:16 INFO - trying https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 10:22:16 INFO - Downloading https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/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:22:16 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/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:22:18 INFO - Downloaded 59371661 bytes. 10:22:18 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 10:22:18 INFO - mkdir: /builds/slave/test/properties 10:22:18 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 10:22:18 INFO - Writing to file /builds/slave/test/properties/build_url 10:22:18 INFO - Contents: 10:22:18 INFO - build_url:https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 10:22:18 INFO - Running post-action listener: _resource_record_post_action 10:22:18 INFO - Running post-action listener: set_extra_try_arguments 10:22:18 INFO - [mozharness: 2016-08-10 17:22:18.897726Z] Finished download-and-extract step (success) 10:22:18 INFO - [mozharness: 2016-08-10 17:22:18.898167Z] Running populate-webroot step. 10:22:18 INFO - Running pre-action listener: _resource_record_pre_action 10:22:18 INFO - Running main action method: populate_webroot 10:22:18 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 10:22:18 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 10:22:18 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 10:22:18 INFO - '--tppagecycles', 10:22:18 INFO - '7'], 10:22:18 INFO - 'tests': ['tsvgm']}}, 10:22:18 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 10:22:18 INFO - 'tests': ['tresize', 'tcanvasmark']}, 10:22:18 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 10:22:18 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 10:22:18 INFO - 'tests': ['dromaeo_css', 'kraken']}, 10:22:18 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 10:22:18 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:22:18 INFO - 'talos_options': ['--disable-e10s'], 10:22:18 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 10:22:18 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:22:18 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 10:22:18 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:22:18 INFO - 'talos_options': ['--disable-e10s'], 10:22:18 INFO - 'tests': ['damp', 'tps']}, 10:22:18 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:22:18 INFO - 'tests': ['damp', 'tps']}, 10:22:18 INFO - 'g3': {'talos_options': ['--disable-e10s'], 10:22:18 INFO - 'tests': ['dromaeo_dom']}, 10:22:18 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 10:22:18 INFO - 'g4': {'talos_options': ['--disable-e10s'], 10:22:18 INFO - 'tests': ['basic_compositor_video']}, 10:22:18 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 10:22:18 INFO - 'other': {'talos_options': ['--disable-e10s'], 10:22:18 INFO - 'tests': ['a11yr', 10:22:18 INFO - 'ts_paint', 10:22:18 INFO - 'tpaint', 10:22:18 INFO - 'sessionrestore', 10:22:18 INFO - 'sessionrestore_no_auto_restore', 10:22:18 INFO - 'tabpaint']}, 10:22:18 INFO - 'other-e10s': {'tests': ['a11yr', 10:22:18 INFO - 'ts_paint', 10:22:18 INFO - 'tpaint', 10:22:18 INFO - 'sessionrestore', 10:22:18 INFO - 'sessionrestore_no_auto_restore', 10:22:18 INFO - 'tabpaint']}, 10:22:18 INFO - 'other-e10s_l64': {'tests': ['a11yr', 10:22:18 INFO - 'ts_paint', 10:22:18 INFO - 'tpaint', 10:22:18 INFO - 'sessionrestore', 10:22:18 INFO - 'sessionrestore_no_auto_restore', 10:22:18 INFO - 'tabpaint']}, 10:22:18 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 10:22:18 INFO - 'ts_paint', 10:22:18 INFO - 'tpaint', 10:22:18 INFO - 'sessionrestore', 10:22:18 INFO - 'sessionrestore_no_auto_restore', 10:22:18 INFO - 'tabpaint']}, 10:22:18 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 10:22:18 INFO - 'tests': ['a11yr', 10:22:18 INFO - 'ts_paint', 10:22:18 INFO - 'tpaint', 10:22:18 INFO - 'sessionrestore', 10:22:18 INFO - 'sessionrestore_no_auto_restore', 10:22:18 INFO - 'tabpaint']}, 10:22:18 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 10:22:18 INFO - 'tests': ['a11yr', 10:22:18 INFO - 'ts_paint', 10:22:18 INFO - 'tpaint', 10:22:18 INFO - 'sessionrestore', 10:22:18 INFO - 'sessionrestore_no_auto_restore', 10:22:18 INFO - 'tabpaint']}, 10:22:18 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 10:22:18 INFO - 'tests': ['tsvgx', 10:22:18 INFO - 'tsvgr_opacity', 10:22:18 INFO - 'tart', 10:22:18 INFO - 'tscrollx', 10:22:18 INFO - 'cart']}, 10:22:18 INFO - 'svgr-e10s': {'tests': ['tsvgx', 10:22:18 INFO - 'tsvgr_opacity', 10:22:18 INFO - 'tart', 10:22:18 INFO - 'tscrollx', 10:22:18 INFO - 'cart']}, 10:22:18 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:22:18 INFO - 'talos_options': ['--disable-e10s'], 10:22:18 INFO - 'tests': ['tp5o']}, 10:22:18 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:22:18 INFO - 'tests': ['tp5o']}, 10:22:18 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:22:18 INFO - 'talos_options': ['--disable-e10s', 10:22:18 INFO - '--xperf_path', 10:22:18 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 10:22:18 INFO - 'tests': ['tp5n']}, 10:22:18 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:22:18 INFO - 'talos_options': ['--xperf_path', 10:22:18 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 10:22:18 INFO - 'tests': ['tp5n']}}, 10:22:18 INFO - 'talos.zip': {'path': '', 10:22:18 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 10:22:18 INFO - Running post-action listener: _resource_record_post_action 10:22:18 INFO - [mozharness: 2016-08-10 17:22:18.917047Z] Finished populate-webroot step (success) 10:22:18 INFO - [mozharness: 2016-08-10 17:22:18.917136Z] Running create-virtualenv step. 10:22:18 INFO - Running pre-action listener: _resource_record_pre_action 10:22:18 INFO - Running main action method: create_virtualenv 10:22:18 INFO - Creating virtualenv /builds/slave/test/build/venv 10:22:18 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:22:18 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 10:22:19 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 10:22:19 INFO - Using real prefix '/usr' 10:22:19 INFO - New python executable in /builds/slave/test/build/venv/bin/python 10:22:19 INFO - Installing distribute.............................................................................................................................................................................................done. 10:22:21 INFO - Installing pip.................done. 10:22:21 INFO - Return code: 0 10:22:21 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 10:22:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:22:21 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:22:21 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:22:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:22:21 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:22:21 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:22:21 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 0xdac030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf0f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x106d180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106b3b0>, '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 0x106c2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x106c740>, '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': '82c74bd3bc9a11c5833d2010000001e6-1470849727.689592-844574423', '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:22:21 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:22:21 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:22:21 INFO - Using env: {'DISPLAY': ':0', 10:22:21 INFO - 'HOME': '/home/cltbld', 10:22:21 INFO - 'LANG': 'en_US.UTF-8', 10:22:21 INFO - 'LANGUAGE': 'en_US:en', 10:22:21 INFO - 'LOGNAME': 'cltbld', 10:22:21 INFO - 'MAIL': '/var/mail/cltbld', 10:22:21 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:22:21 INFO - 'MOZ_NO_REMOTE': '1', 10:22:21 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:22:21 INFO - 'NO_EM_RESTART': '1', 10:22:21 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:22:21 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:22:21 INFO - 'PWD': '/builds/slave/test', 10:22:21 INFO - 'SHELL': '/bin/bash', 10:22:21 INFO - 'SHLVL': '1', 10:22:21 INFO - 'TERM': 'linux', 10:22:21 INFO - 'TMOUT': '86400', 10:22:21 INFO - 'USER': 'cltbld', 10:22:21 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1470849727.689592-844574423', 10:22:21 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:22:21 INFO - '_': '/tools/buildbot/bin/python'} 10:22:21 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:22:21 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:22:21 INFO - Cleaning up... 10:22:21 INFO - Return code: 0 10:22:21 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 10:22:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:22:21 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:22:21 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:22:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:22:21 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:22:21 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:22:21 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 0xdac030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf0f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x106d180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106b3b0>, '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 0x106c2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x106c740>, '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': '82c74bd3bc9a11c5833d2010000001e6-1470849727.689592-844574423', '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:22:21 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:22:21 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:22:21 INFO - Using env: {'DISPLAY': ':0', 10:22:21 INFO - 'HOME': '/home/cltbld', 10:22:21 INFO - 'LANG': 'en_US.UTF-8', 10:22:21 INFO - 'LANGUAGE': 'en_US:en', 10:22:21 INFO - 'LOGNAME': 'cltbld', 10:22:21 INFO - 'MAIL': '/var/mail/cltbld', 10:22:21 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:22:21 INFO - 'MOZ_NO_REMOTE': '1', 10:22:21 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:22:21 INFO - 'NO_EM_RESTART': '1', 10:22:21 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:22:21 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:22:21 INFO - 'PWD': '/builds/slave/test', 10:22:21 INFO - 'SHELL': '/bin/bash', 10:22:21 INFO - 'SHLVL': '1', 10:22:21 INFO - 'TERM': 'linux', 10:22:21 INFO - 'TMOUT': '86400', 10:22:21 INFO - 'USER': 'cltbld', 10:22:21 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1470849727.689592-844574423', 10:22:21 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:22:21 INFO - '_': '/tools/buildbot/bin/python'} 10:22:21 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:22:21 INFO - Downloading/unpacking psutil>=3.1.1 10:22:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:22:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:22:22 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:22:22 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:22:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:22:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:22:23 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 10:22:23 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 10:22:23 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 10:22:23 INFO - Installing collected packages: psutil 10:22:23 INFO - Running setup.py install for psutil 10:22:24 INFO - building 'psutil._psutil_linux' extension 10:22:24 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:22:24 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:22:24 INFO - building 'psutil._psutil_posix' extension 10:22:24 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:22:24 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:22:24 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 10:22:24 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 10:22:24 INFO - Successfully installed psutil 10:22:24 INFO - Cleaning up... 10:22:24 INFO - Return code: 0 10:22:24 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 10:22:24 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:22:24 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:22:24 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:22:24 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:22:24 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:22:24 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:22:24 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 0xdac030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf0f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x106d180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106b3b0>, '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 0x106c2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x106c740>, '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': '82c74bd3bc9a11c5833d2010000001e6-1470849727.689592-844574423', '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:22:24 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:22:24 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:22:24 INFO - Using env: {'DISPLAY': ':0', 10:22:24 INFO - 'HOME': '/home/cltbld', 10:22:24 INFO - 'LANG': 'en_US.UTF-8', 10:22:24 INFO - 'LANGUAGE': 'en_US:en', 10:22:24 INFO - 'LOGNAME': 'cltbld', 10:22:24 INFO - 'MAIL': '/var/mail/cltbld', 10:22:24 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:22:24 INFO - 'MOZ_NO_REMOTE': '1', 10:22:24 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:22:24 INFO - 'NO_EM_RESTART': '1', 10:22:24 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:22:24 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:22:24 INFO - 'PWD': '/builds/slave/test', 10:22:24 INFO - 'SHELL': '/bin/bash', 10:22:24 INFO - 'SHLVL': '1', 10:22:24 INFO - 'TERM': 'linux', 10:22:24 INFO - 'TMOUT': '86400', 10:22:24 INFO - 'USER': 'cltbld', 10:22:24 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1470849727.689592-844574423', 10:22:24 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:22:24 INFO - '_': '/tools/buildbot/bin/python'} 10:22:24 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:22:24 INFO - Downloading/unpacking mozsystemmonitor==0.3 10:22:24 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:22:24 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:22:24 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:22:24 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:22:24 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:22:24 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:22:26 INFO - Downloading mozsystemmonitor-0.3.tar.gz 10:22:26 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 10:22:26 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 10:22:26 INFO - Installing collected packages: mozsystemmonitor 10:22:26 INFO - Running setup.py install for mozsystemmonitor 10:22:26 INFO - Successfully installed mozsystemmonitor 10:22:26 INFO - Cleaning up... 10:22:26 INFO - Return code: 0 10:22:26 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 10:22:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:22:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:22:26 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:22:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:22:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:22:26 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:22:26 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 0xdac030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf0f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x106d180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106b3b0>, '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 0x106c2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x106c740>, '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': '82c74bd3bc9a11c5833d2010000001e6-1470849727.689592-844574423', '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:22:26 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:22:26 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:22:26 INFO - Using env: {'DISPLAY': ':0', 10:22:26 INFO - 'HOME': '/home/cltbld', 10:22:26 INFO - 'LANG': 'en_US.UTF-8', 10:22:26 INFO - 'LANGUAGE': 'en_US:en', 10:22:26 INFO - 'LOGNAME': 'cltbld', 10:22:26 INFO - 'MAIL': '/var/mail/cltbld', 10:22:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:22:26 INFO - 'MOZ_NO_REMOTE': '1', 10:22:26 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:22:26 INFO - 'NO_EM_RESTART': '1', 10:22:26 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:22:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:22:26 INFO - 'PWD': '/builds/slave/test', 10:22:26 INFO - 'SHELL': '/bin/bash', 10:22:26 INFO - 'SHLVL': '1', 10:22:26 INFO - 'TERM': 'linux', 10:22:26 INFO - 'TMOUT': '86400', 10:22:26 INFO - 'USER': 'cltbld', 10:22:26 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1470849727.689592-844574423', 10:22:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:22:26 INFO - '_': '/tools/buildbot/bin/python'} 10:22:27 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:22:27 INFO - Downloading/unpacking jsonschema==2.5.1 10:22:27 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:22:27 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:22:27 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:22:27 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:22:27 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:22:27 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:22:29 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 10:22:29 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 10:22:29 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:22:29 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:22:29 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:22:29 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:22:29 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:22:29 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:22:29 INFO - Downloading functools32-3.2.3-2.tar.gz 10:22:29 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 10:22:29 INFO - warning: no files found matching '*.txt' 10:22:29 INFO - no previously-included directories found matching 'build' 10:22:29 INFO - no previously-included directories found matching 'dist' 10:22:29 INFO - no previously-included directories found matching '.git*' 10:22:29 INFO - Installing collected packages: jsonschema, functools32 10:22:29 INFO - Running setup.py install for functools32 10:22:29 INFO - warning: no files found matching '*.txt' 10:22:29 INFO - no previously-included directories found matching 'build' 10:22:29 INFO - no previously-included directories found matching 'dist' 10:22:29 INFO - no previously-included directories found matching '.git*' 10:22:29 INFO - Successfully installed jsonschema functools32 10:22:29 INFO - Cleaning up... 10:22:29 INFO - Return code: 0 10:22:29 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 10:22:29 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:22:29 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:22:29 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:22:29 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:22:29 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:22:29 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:22:29 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 0xdac030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf0f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x106d180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106b3b0>, '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 0x106c2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x106c740>, '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': '82c74bd3bc9a11c5833d2010000001e6-1470849727.689592-844574423', '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:22:29 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:22:29 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:22:29 INFO - Using env: {'DISPLAY': ':0', 10:22:29 INFO - 'HOME': '/home/cltbld', 10:22:29 INFO - 'LANG': 'en_US.UTF-8', 10:22:29 INFO - 'LANGUAGE': 'en_US:en', 10:22:29 INFO - 'LOGNAME': 'cltbld', 10:22:29 INFO - 'MAIL': '/var/mail/cltbld', 10:22:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:22:29 INFO - 'MOZ_NO_REMOTE': '1', 10:22:29 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:22:29 INFO - 'NO_EM_RESTART': '1', 10:22:29 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:22:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:22:29 INFO - 'PWD': '/builds/slave/test', 10:22:29 INFO - 'SHELL': '/bin/bash', 10:22:29 INFO - 'SHLVL': '1', 10:22:29 INFO - 'TERM': 'linux', 10:22:29 INFO - 'TMOUT': '86400', 10:22:29 INFO - 'USER': 'cltbld', 10:22:29 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1470849727.689592-844574423', 10:22:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:22:29 INFO - '_': '/tools/buildbot/bin/python'} 10:22:29 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:22:29 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 10:22:29 INFO - Cleaning up... 10:22:29 INFO - Return code: 0 10:22:29 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 10:22:29 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:22:29 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:22:29 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:22:29 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:22:29 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:22:29 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:22:29 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 0xdac030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf0f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x106d180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106b3b0>, '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 0x106c2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x106c740>, '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': '82c74bd3bc9a11c5833d2010000001e6-1470849727.689592-844574423', '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:22:29 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:22:29 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:22:29 INFO - Using env: {'DISPLAY': ':0', 10:22:29 INFO - 'HOME': '/home/cltbld', 10:22:29 INFO - 'LANG': 'en_US.UTF-8', 10:22:29 INFO - 'LANGUAGE': 'en_US:en', 10:22:29 INFO - 'LOGNAME': 'cltbld', 10:22:29 INFO - 'MAIL': '/var/mail/cltbld', 10:22:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:22:29 INFO - 'MOZ_NO_REMOTE': '1', 10:22:29 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:22:29 INFO - 'NO_EM_RESTART': '1', 10:22:29 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:22:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:22:29 INFO - 'PWD': '/builds/slave/test', 10:22:29 INFO - 'SHELL': '/bin/bash', 10:22:29 INFO - 'SHLVL': '1', 10:22:29 INFO - 'TERM': 'linux', 10:22:29 INFO - 'TMOUT': '86400', 10:22:29 INFO - 'USER': 'cltbld', 10:22:29 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1470849727.689592-844574423', 10:22:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:22:29 INFO - '_': '/tools/buildbot/bin/python'} 10:22:29 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:22:29 INFO - Downloading/unpacking blobuploader==1.2.4 10:22:29 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:22:29 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:22:29 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:22:29 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:22:29 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:22:29 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:22:31 INFO - Downloading blobuploader-1.2.4.tar.gz 10:22:31 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 10:22:31 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 10:22:31 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:22:31 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:22:31 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:22:31 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:22:31 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:22:31 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:22:32 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 10:22:32 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 10:22:32 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:22:32 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:22:32 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:22:32 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:22:32 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:22:32 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:22:32 INFO - Downloading docopt-0.6.1.tar.gz 10:22:32 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 10:22:32 INFO - Installing collected packages: blobuploader, requests, docopt 10:22:32 INFO - Running setup.py install for blobuploader 10:22:32 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 10:22:32 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 10:22:32 INFO - Running setup.py install for requests 10:22:32 INFO - Running setup.py install for docopt 10:22:33 INFO - Successfully installed blobuploader requests docopt 10:22:33 INFO - Cleaning up... 10:22:33 INFO - Return code: 0 10:22:33 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:22:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:22:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:22:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:22:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:22:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:22:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:22:33 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 0xdac030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf0f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x106d180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106b3b0>, '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 0x106c2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x106c740>, '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': '82c74bd3bc9a11c5833d2010000001e6-1470849727.689592-844574423', '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:22:33 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:22:33 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:22:33 INFO - Using env: {'DISPLAY': ':0', 10:22:33 INFO - 'HOME': '/home/cltbld', 10:22:33 INFO - 'LANG': 'en_US.UTF-8', 10:22:33 INFO - 'LANGUAGE': 'en_US:en', 10:22:33 INFO - 'LOGNAME': 'cltbld', 10:22:33 INFO - 'MAIL': '/var/mail/cltbld', 10:22:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:22:33 INFO - 'MOZ_NO_REMOTE': '1', 10:22:33 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:22:33 INFO - 'NO_EM_RESTART': '1', 10:22:33 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:22:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:22:33 INFO - 'PWD': '/builds/slave/test', 10:22:33 INFO - 'SHELL': '/bin/bash', 10:22:33 INFO - 'SHLVL': '1', 10:22:33 INFO - 'TERM': 'linux', 10:22:33 INFO - 'TMOUT': '86400', 10:22:33 INFO - 'USER': 'cltbld', 10:22:33 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1470849727.689592-844574423', 10:22:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:22:33 INFO - '_': '/tools/buildbot/bin/python'} 10:22:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:22:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 10:22:33 INFO - Running setup.py (path:/tmp/pip-HVCLop-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 10:22:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 10:22:33 INFO - Running setup.py (path:/tmp/pip-lJJGoK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 10:22:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 10:22:33 INFO - Running setup.py (path:/tmp/pip-jkpgb1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 10:22:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 10:22:33 INFO - Running setup.py (path:/tmp/pip-HouDGR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 10:22:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 10:22:33 INFO - Running setup.py (path:/tmp/pip-Lme9nm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 10:22:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 10:22:33 INFO - Running setup.py (path:/tmp/pip-gUfvdZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 10:22:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 10:22:33 INFO - Running setup.py (path:/tmp/pip-PVFi42-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 10:22:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 10:22:33 INFO - Running setup.py (path:/tmp/pip-J67Vt9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 10:22:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 10:22:33 INFO - Running setup.py (path:/tmp/pip-ARyAwv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 10:22:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 10:22:34 INFO - Running setup.py (path:/tmp/pip-1o34vT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 10:22:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 10:22:34 INFO - Running setup.py (path:/tmp/pip-DkqPsF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 10:22:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 10:22:34 INFO - Running setup.py (path:/tmp/pip-VXSWfY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 10:22:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 10:22:34 INFO - Running setup.py (path:/tmp/pip-tPd3sd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 10:22:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 10:22:34 INFO - Running setup.py (path:/tmp/pip-eyGP6O-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 10:22:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 10:22:34 INFO - Running setup.py (path:/tmp/pip-G5us50-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 10:22:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 10:22:34 INFO - Running setup.py (path:/tmp/pip-zbgB5O-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 10:22:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 10:22:34 INFO - Running setup.py (path:/tmp/pip-0P3xNc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 10:22:34 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 10:22:34 INFO - Running setup.py install for manifestparser 10:22:34 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 10:22:34 INFO - Running setup.py install for mozcrash 10:22:34 INFO - Running setup.py install for mozdebug 10:22:34 INFO - Running setup.py install for mozdevice 10:22:35 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 10:22:35 INFO - Installing dm script to /builds/slave/test/build/venv/bin 10:22:35 INFO - Running setup.py install for mozfile 10:22:35 INFO - Running setup.py install for mozhttpd 10:22:35 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 10:22:35 INFO - Running setup.py install for mozinfo 10:22:35 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 10:22:35 INFO - Running setup.py install for mozInstall 10:22:35 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 10:22:35 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 10:22:35 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 10:22:35 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 10:22:35 INFO - Running setup.py install for mozleak 10:22:35 INFO - Running setup.py install for mozlog 10:22:35 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 10:22:35 INFO - Running setup.py install for moznetwork 10:22:35 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 10:22:35 INFO - Running setup.py install for mozprocess 10:22:35 INFO - Running setup.py install for mozprofile 10:22:35 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 10:22:35 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 10:22:35 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 10:22:35 INFO - Running setup.py install for mozrunner 10:22:36 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 10:22:36 INFO - Running setup.py install for mozscreenshot 10:22:36 INFO - Running setup.py install for moztest 10:22:36 INFO - Running setup.py install for mozversion 10:22:36 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 10:22:36 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 10:22:36 INFO - Cleaning up... 10:22:36 INFO - Return code: 0 10:22:36 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:22:36 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:22:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:22:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:22:36 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:22:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:22:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:22:36 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 0xdac030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf0f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x106d180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106b3b0>, '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 0x106c2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x106c740>, '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': '82c74bd3bc9a11c5833d2010000001e6-1470849727.689592-844574423', '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:22:36 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:22:36 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:22:36 INFO - Using env: {'DISPLAY': ':0', 10:22:36 INFO - 'HOME': '/home/cltbld', 10:22:36 INFO - 'LANG': 'en_US.UTF-8', 10:22:36 INFO - 'LANGUAGE': 'en_US:en', 10:22:36 INFO - 'LOGNAME': 'cltbld', 10:22:36 INFO - 'MAIL': '/var/mail/cltbld', 10:22:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:22:36 INFO - 'MOZ_NO_REMOTE': '1', 10:22:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:22:36 INFO - 'NO_EM_RESTART': '1', 10:22:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:22:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:22:36 INFO - 'PWD': '/builds/slave/test', 10:22:36 INFO - 'SHELL': '/bin/bash', 10:22:36 INFO - 'SHLVL': '1', 10:22:36 INFO - 'TERM': 'linux', 10:22:36 INFO - 'TMOUT': '86400', 10:22:36 INFO - 'USER': 'cltbld', 10:22:36 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1470849727.689592-844574423', 10:22:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:22:36 INFO - '_': '/tools/buildbot/bin/python'} 10:22:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:22:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 10:22:36 INFO - Running setup.py (path:/tmp/pip-xJrBlr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 10:22:36 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:22:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 10:22:36 INFO - Running setup.py (path:/tmp/pip-xkW0p3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 10:22:36 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:22:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 10:22:36 INFO - Running setup.py (path:/tmp/pip-zAZwDk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 10:22:36 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:22:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 10:22:36 INFO - Running setup.py (path:/tmp/pip-CutOjy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 10:22:36 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:22:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 10:22:36 INFO - Running setup.py (path:/tmp/pip-jHDJgP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 10:22:36 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:22:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 10:22:36 INFO - Running setup.py (path:/tmp/pip-7kAHMr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 10:22:37 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:22:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 10:22:37 INFO - Running setup.py (path:/tmp/pip-QE0twJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 10:22:37 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:22:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 10:22:37 INFO - Running setup.py (path:/tmp/pip-keTJvK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 10:22:37 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:22:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 10:22:37 INFO - Running setup.py (path:/tmp/pip-1qNuRJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 10:22:37 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:22:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 10:22:37 INFO - Running setup.py (path:/tmp/pip-WsDMxS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 10:22:37 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:22:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 10:22:37 INFO - Running setup.py (path:/tmp/pip-YYzAjq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 10:22:37 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:22:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 10:22:37 INFO - Running setup.py (path:/tmp/pip-tY6ZZL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 10:22:37 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:22:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 10:22:37 INFO - Running setup.py (path:/tmp/pip-95Fg5q-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 10:22:37 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:22:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 10:22:37 INFO - Running setup.py (path:/tmp/pip-WQcxou-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 10:22:37 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:22:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 10:22:37 INFO - Running setup.py (path:/tmp/pip-mRqVUB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 10:22:37 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:22:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 10:22:37 INFO - Running setup.py (path:/tmp/pip-zscDew-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 10:22:37 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:22:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 10:22:37 INFO - Running setup.py (path:/tmp/pip-ArhSF5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 10:22:37 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:22:37 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:22:37 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:22:37 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:22:37 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:22:37 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:22:37 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.3->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 10:22:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:22:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:22:37 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:22:37 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:22:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:22:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:22:39 INFO - Downloading blessings-1.6.tar.gz 10:22:39 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 10:22:39 INFO - Installing collected packages: blessings 10:22:39 INFO - Running setup.py install for blessings 10:22:39 INFO - Successfully installed blessings 10:22:39 INFO - Cleaning up... 10:22:39 INFO - Return code: 0 10:22:39 INFO - Done creating virtualenv /builds/slave/test/build/venv. 10:22:39 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 10:22:39 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 10:22:40 INFO - Reading from file tmpfile_stdout 10:22:40 INFO - Current package versions: 10:22:40 INFO - argparse == 1.2.1 10:22:40 INFO - blessings == 1.6 10:22:40 INFO - blobuploader == 1.2.4 10:22:40 INFO - docopt == 0.6.1 10:22:40 INFO - functools32 == 3.2.3-2 10:22:40 INFO - jsonschema == 2.5.1 10:22:40 INFO - manifestparser == 1.1 10:22:40 INFO - mozInstall == 1.12 10:22:40 INFO - mozcrash == 0.17 10:22:40 INFO - mozdebug == 0.1 10:22:40 INFO - mozdevice == 0.48 10:22:40 INFO - mozfile == 1.2 10:22:40 INFO - mozhttpd == 0.7 10:22:40 INFO - mozinfo == 0.9 10:22:40 INFO - mozleak == 0.1 10:22:40 INFO - mozlog == 3.3 10:22:40 INFO - moznetwork == 0.27 10:22:40 INFO - mozprocess == 0.23 10:22:40 INFO - mozprofile == 0.28 10:22:40 INFO - mozrunner == 6.12 10:22:40 INFO - mozscreenshot == 0.1 10:22:40 INFO - mozsystemmonitor == 0.3 10:22:40 INFO - moztest == 0.7 10:22:40 INFO - mozversion == 1.4 10:22:40 INFO - psutil == 3.1.1 10:22:40 INFO - requests == 1.2.3 10:22:40 INFO - wsgiref == 0.1.2 10:22:40 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:22:40 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:22:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:22:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:22:40 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:22:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:22:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:22:40 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 0xdac030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf0f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x106d180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106b3b0>, '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 0x106c2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x106c740>, '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': '82c74bd3bc9a11c5833d2010000001e6-1470849727.689592-844574423', '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:22:40 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:22:40 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:22:40 INFO - Using env: {'DISPLAY': ':0', 10:22:40 INFO - 'HOME': '/home/cltbld', 10:22:40 INFO - 'LANG': 'en_US.UTF-8', 10:22:40 INFO - 'LANGUAGE': 'en_US:en', 10:22:40 INFO - 'LOGNAME': 'cltbld', 10:22:40 INFO - 'MAIL': '/var/mail/cltbld', 10:22:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:22:40 INFO - 'MOZ_NO_REMOTE': '1', 10:22:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:22:40 INFO - 'NO_EM_RESTART': '1', 10:22:40 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:22:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:22:40 INFO - 'PWD': '/builds/slave/test', 10:22:40 INFO - 'SHELL': '/bin/bash', 10:22:40 INFO - 'SHLVL': '1', 10:22:40 INFO - 'TERM': 'linux', 10:22:40 INFO - 'TMOUT': '86400', 10:22:40 INFO - 'USER': 'cltbld', 10:22:40 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1470849727.689592-844574423', 10:22:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:22:40 INFO - '_': '/tools/buildbot/bin/python'} 10:22:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:22:40 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:22:40 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:22:40 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:22:40 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:22:40 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:22:40 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:22:40 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:22:40 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:22:40 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:22:40 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:22:40 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:22:40 INFO - Cleaning up... 10:22:40 INFO - Return code: 0 10:22:40 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 10:22:40 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:22:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:22:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:22:40 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:22:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:22:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:22:40 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 0xdac030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf0f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x106d180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x106b3b0>, '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 0x106c2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x106c740>, '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': '82c74bd3bc9a11c5833d2010000001e6-1470849727.689592-844574423', '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:22:40 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:22:40 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:22:40 INFO - Using env: {'DISPLAY': ':0', 10:22:40 INFO - 'HOME': '/home/cltbld', 10:22:40 INFO - 'LANG': 'en_US.UTF-8', 10:22:40 INFO - 'LANGUAGE': 'en_US:en', 10:22:40 INFO - 'LOGNAME': 'cltbld', 10:22:40 INFO - 'MAIL': '/var/mail/cltbld', 10:22:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:22:40 INFO - 'MOZ_NO_REMOTE': '1', 10:22:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:22:40 INFO - 'NO_EM_RESTART': '1', 10:22:40 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:22:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:22:40 INFO - 'PWD': '/builds/slave/test', 10:22:40 INFO - 'SHELL': '/bin/bash', 10:22:40 INFO - 'SHLVL': '1', 10:22:40 INFO - 'TERM': 'linux', 10:22:40 INFO - 'TMOUT': '86400', 10:22:40 INFO - 'USER': 'cltbld', 10:22:40 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1470849727.689592-844574423', 10:22:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:22:40 INFO - '_': '/tools/buildbot/bin/python'} 10:22:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:22:40 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 10:22:40 INFO - Cleaning up... 10:22:40 INFO - Return code: 0 10:22:40 INFO - Running post-action listener: _resource_record_post_action 10:22:40 INFO - Running post-action listener: _start_resource_monitoring 10:22:40 INFO - Starting resource monitoring. 10:22:40 INFO - [mozharness: 2016-08-10 17:22:40.642263Z] Finished create-virtualenv step (success) 10:22:40 INFO - [mozharness: 2016-08-10 17:22:40.642755Z] Running install step. 10:22:40 INFO - Running pre-action listener: _resource_record_pre_action 10:22:40 INFO - Running main action method: install 10:22:40 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 10:22:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 10:22:40 INFO - Reading from file tmpfile_stdout 10:22:40 INFO - Detecting whether we're running mozinstall >=1.0... 10:22:40 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 10:22:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 10:22:40 INFO - Reading from file tmpfile_stdout 10:22:40 INFO - Output received: 10:22:40 INFO - Usage: mozinstall [options] installer 10:22:40 INFO - Options: 10:22:40 INFO - -h, --help show this help message and exit 10:22:40 INFO - -d DEST, --destination=DEST 10:22:40 INFO - Directory to install application into. [default: 10:22:40 INFO - "/builds/slave/test"] 10:22:40 INFO - --app=APP Application being installed. [default: firefox] 10:22:40 INFO - mkdir: /builds/slave/test/build/application 10:22:40 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:22:40 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:22:57 INFO - Reading from file tmpfile_stdout 10:22:57 INFO - Output received: 10:22:57 INFO - /builds/slave/test/build/application/firefox/firefox 10:22:57 INFO - Running post-action listener: _resource_record_post_action 10:22:57 INFO - [mozharness: 2016-08-10 17:22:57.839366Z] Finished install step (success) 10:22:57 INFO - [mozharness: 2016-08-10 17:22:57.839704Z] Running run-tests step. 10:22:57 INFO - Running pre-action listener: _resource_record_pre_action 10:22:57 INFO - Running main action method: run_tests 10:22:57 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 10:22:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 10:22:57 INFO - Python 2.7.3 10:22:57 INFO - Return code: 0 10:22:57 INFO - grabbing minidump binary from tooltool 10:22: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:22:57 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 0x106b3b0>, '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 0x106c2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x106c740>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 10:22:57 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:22:57 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:22:57 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:22:57 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 10:22:57 INFO - Return code: 0 10:22:57 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 10:22:57 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 10:22:57 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 10:22:57 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 10:22:57 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 10:22:57 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-066', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 10:22:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-066 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 10:22:57 INFO - Using env: {'DISPLAY': ':0', 10:22:57 INFO - 'HOME': '/home/cltbld', 10:22:57 INFO - 'LANG': 'en_US.UTF-8', 10:22:57 INFO - 'LANGUAGE': 'en_US:en', 10:22:57 INFO - 'LOGNAME': 'cltbld', 10:22:57 INFO - 'MAIL': '/var/mail/cltbld', 10:22:57 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 10:22:57 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 10:22:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:22:57 INFO - 'MOZ_NO_REMOTE': '1', 10:22:57 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 10:22:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:22:57 INFO - 'NO_EM_RESTART': '1', 10:22:57 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:22:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:22:57 INFO - 'PWD': '/builds/slave/test', 10:22:57 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 10:22:57 INFO - 'SHELL': '/bin/bash', 10:22:57 INFO - 'SHLVL': '1', 10:22:57 INFO - 'TERM': 'linux', 10:22:57 INFO - 'TMOUT': '86400', 10:22:57 INFO - 'USER': 'cltbld', 10:22:57 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1470849727.689592-844574423', 10:22:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:22:57 INFO - '_': '/tools/buildbot/bin/python'} 10:22:57 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-066', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 10:22:58 INFO - mozversion application_buildid: 20160810083014 10:22:58 INFO - mozversion application_changeset: 531100c1d950c8857dda172573fbd23360f7619b 10:22:58 INFO - mozversion application_display_name: Nightly 10:22:58 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 10:22:58 INFO - mozversion application_name: Firefox 10:22:58 INFO - mozversion application_remotingname: firefox 10:22:58 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 10:22:58 INFO - mozversion application_vendor: Mozilla 10:22:58 INFO - mozversion application_version: 51.0a1 10:22:58 INFO - mozversion platform_buildid: 20160810083014 10:22:58 INFO - mozversion platform_changeset: 531100c1d950c8857dda172573fbd23360f7619b 10:22:58 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 10:22:58 INFO - mozversion platform_version: 51.0a1 10:22:58 INFO - using testdate: 1470849778 10:22:58 INFO - actual date: 1470849778 10:22:58 INFO - starting webserver on 'localhost:55353' 10:22:58 INFO - SUITE-START | Running 2 tests 10:22:58 INFO - TEST-START | dromaeo_css 10:22:58 INFO - operating with platform_type : linux_ 10:22:58 INFO - Initialising browser for dromaeo_css test... 10:22:58 INFO - TEST-INFO | started process 26348 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpGnqkBt/profile http://localhost:55353/getInfo.html) 10:23:02 INFO - PROCESS | 26348 | __metrics Screen width/height:1600/1200 10:23:02 INFO - PROCESS | 26348 | colorDepth:24 10:23:02 INFO - PROCESS | 26348 | Browser inner width/height: 1024/697 10:23:02 INFO - PROCESS | 26348 | __metrics 10:23:03 INFO - PROCESS | 26348 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 10:23:03 INFO - PROCESS | 26348 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 122: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 10:23:04 INFO - TEST-INFO | 26348: exit 0 10:23:04 INFO - Browser initialized. 10:23:04 INFO - Running cycle 1/1 for dromaeo_css test... 10:23:04 INFO - TEST-INFO | started process 26428 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpGnqkBt/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 10:23:16 INFO - PROCESS | 26428 | RSS: Main: 156012544 10:23:16 INFO - PROCESS | 26428 | 10:24:07 INFO - PROCESS | 26428 | 1470849847242 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:26:17 INFO - PROCESS | 26428 | Cycle 1(1): loaded http://localhost:55353/tests/dromaeo/cssquery-dojo.html (next: http://localhost:55353/tests/dromaeo/cssquery-ext.html) 10:26:18 INFO - PROCESS | 26428 | RSS: Main: 285618176 10:26:18 INFO - PROCESS | 26428 | 10:29:20 INFO - PROCESS | 26428 | Cycle 1(1): loaded http://localhost:55353/tests/dromaeo/cssquery-ext.html (next: http://localhost:55353/tests/dromaeo/cssquery-jquery.html) 10:29:21 INFO - PROCESS | 26428 | RSS: Main: 240693248 10:29:21 INFO - PROCESS | 26428 | 10:32:23 INFO - PROCESS | 26428 | Cycle 1(1): loaded http://localhost:55353/tests/dromaeo/cssquery-jquery.html (next: http://localhost:55353/tests/dromaeo/cssquery-mootools.html) 10:32:23 INFO - PROCESS | 26428 | RSS: Main: 219561984 10:32:23 INFO - PROCESS | 26428 | 10:35:25 INFO - PROCESS | 26428 | Cycle 1(1): loaded http://localhost:55353/tests/dromaeo/cssquery-mootools.html (next: http://localhost:55353/tests/dromaeo/cssquery-prototype.html) 10:35:26 INFO - PROCESS | 26428 | RSS: Main: 190799872 10:35:26 INFO - PROCESS | 26428 | 10:38:29 INFO - PROCESS | 26428 | Cycle 1(1): loaded http://localhost:55353/tests/dromaeo/cssquery-prototype.html (next: http://localhost:55353/tests/dromaeo/cssquery-yui.html) 10:38:29 INFO - PROCESS | 26428 | RSS: Main: 183586816 10:38:29 INFO - PROCESS | 26428 | 10:41:32 INFO - PROCESS | 26428 | Cycle 1(1): loaded http://localhost:55353/tests/dromaeo/cssquery-yui.html (next: http://localhost:55353/tests/dromaeo/cssquery-dojo.html) 10:41:32 INFO - PROCESS | 26428 | RSS: Main: 257978368 10:41:32 INFO - PROCESS | 26428 | 10:41:32 INFO - PROCESS | 26428 | __start_tp_report 10:41:32 INFO - PROCESS | 26428 | _x_x_mozilla_page_load 10:41:32 INFO - PROCESS | 26428 | _x_x_mozilla_page_load_details 10:41:32 INFO - PROCESS | 26428 | |i|pagename|runs| 10:41:32 INFO - PROCESS | 26428 | |0;dojo.html;3047.527633216851;3066.75465962723;3093.1648454917186;3094.5300982033536;3111.222194451387;5192.818251361203;5200.583953283738;5246.449122842104;5310.548603368714;5313.229581710654;5238.476152384759;5303.284056652351;5329.813456529022;5385.838424847261;5444.809431669893;4748.76256187191;4757.90484190316;4785.377900872882;4794.2329227323635;4906.460289368167;4809.495003024685;4836.564709176174;4847.272909063651;4867.92905560776;4889.926651100236;4749.810007599692;4787.066522028206;4811.061842940628;4840.636952228597;4845.588125009396;4843.4187897452175;4851.223804191348;4863.27050942358;4863.975680121612;4864.78108485119;4696.319033740088;4704.270838020112;4748.928766068477;4754.286856971447;4827.61379089672;5233.110371236899;5244.39689435716;5311.840644780663;5370.5435038021815;5383.192521121824;5689.943100569024;5730.140478928152;5739.799107031234;5743.798967036176;5746.310442746855;5504.669719816824;5577.52591029763;5588.944110558924;5605.831825045255;5695.231143795576;5300.814471493518;5319.042572337016;5320.866978325535;5323.334583177064;5328.17413300939;5597.468240517144;5740.770369185269;5749.223854779635;5791.073428251544;5803.129530570363;5436.646617969898;5502.697351645618;5508.91736623951;5544;5601.887962240732;5580.218769372291;5622.100463925753;5671.574631902624;5676.602637815313;5677.403872593401;5484.478974497416;5610.971945140248;5615.298087739033;5626.521745651584;5660.981023415742;5537.446255374511;5580.107182850725;5597.328320601554;5678;5685.3177618685195;4326.848560300437;4335.176316499855;4336.34954756789;4338.891527711832;4379.1460665170625;3840.635139661728;3860.729748917549;3870.245302166051;3904.648581627667;3906.5898080701686;5239.214117882349;5264.815731449381;5293.761780719877;5313.840584782462;5322.121849894724;5605.299337582802;5629.746661400247;5638.295213098363;5669.943300567024;5690.6870122142855;5312.096943519611;5325.813596524103;5326.520613144836;5327.094393953037;5328.573714102862;4761.833335833229;4865.343178670905;4883.438404583448;4915.508449155056;4922.187839006524;5914.0241860093465;5916.822495325147;5945.16767652529;5969.134475501028;5981.252343457068;5659.830205093854;5665.716714164358;5691.060974939254;5704.600677952503;5738.454846789548;5770.740316685843;5800.071988481823;5813.912791308049;5930.762769489172;5938.317093534299;5523.585731070266;5537.307836520435;5541.113421852484;5585.581081418829;5602.887942241214;5643.492085712305;5647.237622921018;5664.546836253172;5666.065099258576;5678.517326027169;5420.810271640474;5472.50747432733;5496.258005169251;5528.668279903219;5531.751071201725;5535.612507124623;5537.944620553904;5565.02612042899;5601.859953501195;5617.466340697627;5449.100898351886;5523.861903452445;5535.3634332050715;5553.139263414178;5570.58220633446;5397.8380648580605;5466.808661696821;5482.28730265079;5652.830415087554;5654.886902262014;5427.782888684408;5432.0765469871;5437.945620543744;5448.291722076105;5462.453754624506 10:41:32 INFO - PROCESS | 26428 | |1;ext.html;577.7457918515853;607.6870411737956;616.9444749972502;618.270440879762;634.6985182038535;42659;43766.56233437665;44026.339604905916;46966;47118.76440617801;44866.775666121706;45426;45451.0909781805;45451.77274113625;45476.545234547644;8810.559472026405;8945.64217431302;8949.284057275403;8952.552372381355;8953.418027828171;8925.375223734341;9006.054364291753;9019.368644194908;9025.052369501174;9025.232855207316;9041.050689677588;9082.046385129566;9082.54587270637;9088.772780680503;9089.772755681095;8976.102389761038;8988.146126118008;9022.09779022099;9025.323100767402;9028.8645670315;8948.373613847034;8973.551322433917;8975.326850486239;8994.0556241595;9012.909870901272;41333.793331033456;41573.792131039154;41670.1665966679;41681.4991100535;41778.16443671109;3523.9295214095573;3548.361294966931;3570.1431656402538;3607.963920360789;3714.5542534895717;32173.51739723906;32559.186020349443;32565.185870353194;32604.673953260637;32719.50920736167;4197.391378250167;4345.41336919515;4382.057857560608;4562.771861406916;4566.246569316092;267046;267115.9999999981;267425;268290.65854670794;268715;50422;57205.42794572084;57745.711271443375;57749;57795.71102144462;51445.48554514407;51685.74157129265;51717.48282517202;52410.475895241325;52473.2129018065;14360.784588231185;14371;14387.424503019762;14412.279386030867;14433.494827680981;10559.47202639865;10562.31344962575;10642.521086551124;10678.252522323519;10704.678859634223;14290.714185716435;16057.839421605868;16503.33986640521;16536.503904882873;16800.15999200035;5748.310202775694;5791.797287094932;5989.4609485145675;6006.519478441714;6102.847428814226;972.6498460554195;1077.7952189084049;1098.5441041967495;1201.4533387308754;1220.1702842067302;32839;33078.50382244268;33118.337633247684;33225;33383.332333353195;1098.1215027977587;1159.287038471334;1167.5855071449682;1191.3566673996118;1195.4381440722846;17578.89053313585;17982.460526184237;18213;18402.26390944374;19315.4205373839;579742;583400;585036;585742;587341;58700;58810.70594646999;59035.114473282076;59037.70481147567;59184;1344.1196016609138;1390.2423179367067;1396;1402.747505449029;1406.592088294383;31475.527867081553;33754;33864.15339616529;34110.317793644484;34433.13917151991;51335;51554.74222629013;51610.48389516207;51646.74176629093;51771.482285176666;453121;453808;454694;456365;459116;23274.76725232726;24860.37849053788;28107.859460702566;28129.578056328763;28775;46224.30663540117;46522.30216546687;46900.29649555327;47338.28992565045;47490.28764568603;38312;39523.60476395199;39590.12575687019;40764.592354077264;41161;38950;39337.81986540408;39923;40188;40703.79648101741;39433;40535.594644053184;40989.38515922323;41188.794056029525;41404.79297603493;31861.68138318587;35263.64736352603;35766.46350304696;36254.27491450103;36537.451938220416;27989;28034.299142520784;28161.71838281673;28274.43451131007;28329 10:41:32 INFO - PROCESS | 26428 | |2;jquery.html;368.9372806622874;391.4500127321113;399.51458977342526;399.73417677244635;418.61500779336455;16901.746473802887;19780.703289450652;20037.499062523446;20369.388918332435;20996.685049724267;11144.554217831297;11304.208705390625;15532.689346213068;17906;18439.262429502804;5244.737763111839;5451.672899626015;5458.836234912959;5460.781568737246;5463.562914966813;5093.2105523643895;5342.572594192456;5414.242006119146;5421.539169170605;5424.593155513333;5382.138857782756;5419.943111093338;5421.376541697696;5429.185622156689;5435.130379139338;5234.7120908350025;5398.676079435227;5433.049216387156;5436.374816896068;5437.13005919051;5144.022635699205;5273.551748101416;5278.366596008504;5280.867978300535;5283.973580132075;22914.77085229143;23001.76998230013;23096;23418.414539636477;23699.407514812094;2332.976670233293;2350.8343186191946;2357.964630530543;2419.6249581314923;2440.3533063738123;9627.566759495769;9845.360051596623;10106.39361638304;10346;10471.581136754521;1915.3095755554928;1984.4641946674462;2044.6217449771839;2111.493241622015;2136.113512892148;86531.56734216351;88614;88691.11308886894;89209.55395223112;89502;10978.505967231495;11050.834237486444;11190.720231994264;11257.831132533018;11328.603498877499;15656.843431565767;15683.215839207995;15684.372625094868;15684.529464116094;15734.842651573566;7636.121845987672;7913.920860791319;7925.445218834741;7941.8411631768195;8034.357251419872;7482.925170748223;7566;7725.961370193113;7769.4949828262115;7838.294553490213;4656.650751193674;4742.66801323904;4777.4267087949665;4810.7835147418455;4906.9263961040615;1995.9900200499194;1998.280618977167;2020.4746765840987;2032.4004418696225;2032.9835082458771;904.7511934218011;975.7999610079917;983.6606370802205;985.8028394321165;1013.2957594471918;20038.899805500878;20805.791942080687;20863.478413039797;20918.686219706717;21146.577068458853;967.0812727908375;990.7473594233425;1000.4997501249376;1002.8997100290059;1036.2746077745608;10770.56917723298;11275.154363422613;11484.19610627248;11556.88443115575;11565.710857228469;480753;488217;492542;493026.069739298;494731;57551.71224143936;59110;66221;94056;95411.52294238485;993.145894530703;1008.9545970431349;1014.7260239735377;1073.1951036722458;1076.4510099849133;18291;18592.535186620444;18953;19135.90432047831;19158.23367065302;43853;43887.2533418204;44687.77656111699;44866.551334486234;45831.31253031274;57836.4216357831;58953.70523147357;63027.6848615754;63328.68335658292;63994.68002659957;8583.356248281529;8635.870461943201;8749.562521873753;8949.32880033987;8973.820523589622;7563.7352692655495;11841.940790296338;12026.879731202926;12157.845004724537;12839.422225999666;11306.547738090385;11462.713432164262;11473.139514536277;11544.88455115438;11677.182597218112;10881.292715973437;10959.835602466128;11054.944725276322;11448.542058317575;11494.195406321478;11855.34795586251;12027.45876435545;12083;12190.878091219329;12260.38698065111;8678;8722.302215822845;8745.431546949429;9052.3210759192;9144.451332920045;8770.254528364905;11168.83116883117;11495.712607184887;11622.535098595961;11898.167128300936 10:41:32 INFO - PROCESS | 26428 | |3;mootools.html;1352.4387379237617;1462;1522.086747951229;1633.4609578838983;1776.3516316544465;8567.228949394554;8867.201951824334;8976.955115224422;9289.44263344198;9295.30285228609;9068.773280667987;9201.125893040167;9224.446533207996;9224.769380765485;9226.031266716998;2414.034386245503;2432.2581612608146;2434.4035711250767;2436.6588677585064;2443.8778061096873;2357.7524359942217;2420.818438617102;2422.5760491913934;2426.5561990615556;2428.295794219683;2414.8188885833547;2437.768412000857;2445.6942882139733;2448.2655203438985;2448.2899959011866;2380.67860838788;2395.712514498263;2408.385861605297;2410.035985605763;2419.7459266777087;2335.2177020698086;2344.75380085092;2347.061175529802;2349.0955981946904;2357.552065107624;8601.354898382584;8674.306055515544;8684.305255579538;8833.558322083934;8935.553222338856;5164.018836421068;5362.302900622933;5365.892682146336;5367.0339338918975;5371;3352.513885486615;3406.8977930662118;3417.128632198798;3440.3119376124873;3449.4653328733834;1098.1653943003296;1122.81473556863;1145.5532342386475;1147.0479502013309;1158.7173268660724;12890.097693161482;12891.419886105148;12924.54764083262;13008.219506829526;13046.478140874353;4422.314541246112;4515.932261016087;4646.7444290564345;4679.251319788817;4699.083678682624;10059;10060.39637621745;10069.899301006895;10120.493975301206;10126.746831329276;5351.491608297206;5364.088105022156;5366.838994830161;5372.892542149213;5379.300690910157;4405.625521830616;4892.363992680928;5011.047900898818;5034.345535080416;5055.115354812893;3671.375866102769;3678.668919797231;3770.9825243494597;3800.771953682788;3839.0594304395604;1123.2361993844102;1125.426032723317;1128.5316593613559;1129.6723950054557;1131.8415421840948;937.4469063252577;1011.1910471622673;1017.0998666180484;1035.3735989726108;1042.9791404171874;6131.63210207389;6169.994499041089;6337.081123237105;6368;6484.740610375627;462.24423068282925;464.12744041202996;473.4153320648996;476.3164858428167;476.86886106320344;4467.932981005288;4482.843100491467;4485.551444855489;4557.908841823145;4565.680402371869;10713.83929241062;10928.562857485771;11051.447427628586;11063.72340691473;11073.944630276797;11340.489677964511;11661.067114630809;11676.76646467066;11680.474378652982;11684;8450.112738162527;8559.914400856036;8621.180987806274;8674.826503469896;8689.913100868911;6335.556511044183;6572.507061970467;6629.07192992991;6632;6720.899186512304;10502;10654.467276635982;10658.094062004817;10664.200184986003;10867.239293249397;10578.8942110581;10771.6229931952;10995.285306455055;11090.722731931766;11116.555337786398;7251.963740181265;7457.366123879531;7462.738804141829;8210.343172546302;8394.328453723565;8463;8586.699465518677;8763.167499087576;8812.339074569305;8827.735167944971;7800.726974555863;7863.606819659109;7926.762197134095;8114.391420643357;8228;7958.84082318362;8058.637361318638;8303;8303.543305118035;8543.188397102265;7212.89180662301;7222.422206223595;7351.963240183979;7356.043714317105;7412.888806667796;5558.861028474321;5637.830865074055;5647.971760141173;5746.2529871116485;5802.854928626818;5566.415526369673;5569.35952365467;5578.191162281365;5604.075327571069;5633.549316054788 10:41:32 INFO - PROCESS | 26428 | |4;prototype.html;291.4564337510542;308.16333654129033;310.7094866300008;316.47623183631083;323.08244585377525;5029.195328747401;5059.443461219263;5180.507851754087;5223.112070947938;5228.424873263938;5139.306193663854;5153.871153221171;5160.638755287131;5170.715610641413;5189.974050129744;4063.5936406359424;4067.2272268268935;4072.2669919414493;4080.510338759353;4098.561355993194;3705.888823335304;3800.7909564973916;4075.246079475292;4094.877153685394;4117.588241175873;3970.225805967823;3983.4423180754716;4000.799960002003;4004.599540046001;4007;3982.3429134192825;3989.202159568098;3991.882272963575;3992.940105898414;4015.4177644241568;3486.267883744417;3486.511888335635;3498.6151523332414;3500.2824420993634;3514.7539672222956;4943.678660887067;5008.574271186953;5061.215511595708;5062.265971434122;5111.284420181178;4526.977365113186;4537.9773101134615;4543.31850222466;4544.431946006749;4563.383943167663;5357.624966252364;5381.327334083239;5382.219578161184;5407.972960135174;5461.9453805461835;3734.8319325630414;3840.9423858642144;3843.0392401899526;3849;3861.2084522673067;5491.780328786884;5558.9715902558155;5562.582806289544;5567.8886422271735;5570.972145139289;3877.709171812069;3884.6309600587897;3897.1815918656835;3926.450296958428;3943.9802800985813;3806.6764325032127;3859.286032084073;3940.0937784309194;3984.7210695251633;3985.322495175827;4476.552344765562;4489.147062058199;4492.528284530143;4503.527129651339;4507.098580283956;5333.813316533902;5340.25236466895;5350.384705758887;5359.892802143935;5360.249565060894;1310.5347601601295;1312.3962977030674;1356.416740801445;1361.4418088583832;1373.6497193215666;930.8138372325562;945.4043952310001;945.7021038372891;948.2414068744977;960.519740129935;5193.84418467439;5197.636165468457;5205.141151710001;5215.895682086413;5221.686698798084;5400.513953744182;5523.558115350762;5527.876749636523;5545.861353466195;5562.193481945095;5163.715995620202;5172.534471897472;5174.327337446108;5179;5202.97398513005;2568.678915135608;2570.3060173752983;2576.4460640962284;2576.948461030769;2593.766561009518;4712.835050773207;4946.826861059845;5011.423686276052;5025.221090730943;5025.874353141201;4934.235193545006;4934.9013019739405;4941.925871111936;4943.975280123576;4963.404391473046;4994.2508623706735;5007.6494645375205;5011.749412529359;5012.874678133149;5025.597952163818;4859.732714700725;4869.174059727602;5121.411037730709;5543.667379957054;5570.359408667893;5509.889802203853;5537.446255374431;5545.310524395745;5556.222128902038;5556.722163891708;5660.20757093999;5782.114113574024;5791.305043394819;5819.912701309399;5832.591718579659;3919.5884432134217;3936.881893543198;3940.9802950985063;3945.7040721945395;3955.4462375268063;5535.197396377423;5550.195221692751;5552.69460179694;5566.8289367146035;5612.382637909908;5271.815486458109;5459.208414779914;5469.617126801086;5471.042567550742;5476.151196564539;5420.53925416344;5439.5920305976415;5444.891102178013;5454.836354909359;5456.972715136399;5214.392803598201;5300.893982120413;5431.402545720047;5447.891042179213;5459.317585301837;5474.808381706621;5476.589255805751;5506.504414602705;5509.449055094458;5520.199571062254;5148.120935858459;5358.97320513395;5371.462853714754;5372.785088596569;5387.730613469233 10:41:32 INFO - PROCESS | 26428 | |5;yui.html;743.9702411903525;769.9923000769992;789.8301865099006;796.7414171254642;882.488156869016;15956.68086638268;17016.149192540386;17050.23273952672;17055.57361065974;17107.40124095657;15237.085774853489;15237.390504379811;15246.695066098671;15258.771118433204;15338.309776060076;653.7744478155029;773.5938632218074;775.2054144501902;806.9233422824851;807.422692774666;740.3595889555522;740.5704691279072;740.5778706137504;741.1958025542266;741.8516296740646;860.2086080805674;860.7331727164568;860.9182127697859;860.9483430994161;861.3970220845401;691.7302252121676;701.2216439751896;705.2453874354443;843.5360551696542;859.5401460218784;611.9724612392453;613;616.072810420319;619.6560908695673;619.7613918641356;16001.519954401387;16043.598910027225;16104.19479026044;16115.113668748214;16134.273957671816;15639.530814075482;15870.28583713724;16050.919745401316;16051.117188554625;16185;12749.235045897276;12862.935685321514;12888.548900788428;13149.342532873414;13262.86737132626;3932.9803350983348;4026.355783074694;4051.898702532431;4164.0630858057;4166.479190101238;86653;86680;87345.5632721845;87432;89551.55224223837;11439.88560114405;11602.361870097226;11640.88359116398;12043.096767742454;12342.938285308695;22910;22943.770562294496;22952.770472295397;22962.885185574298;23055.769442305696;8571.914280857236;8704.869426958601;8711.825763484821;8740.125987401336;9006.189442950166;4584.174848527297;4860.927086093711;4887.902241955141;4905.852824415202;4953.900921981613;3504.56192975878;3613.1689711366007;3618.203995121069;3619.1856832213066;3622.3298689741955;555.7693557173727;573;580.2051189869821;580.6022874331097;581.2153592649889;723.706898706025;728.8979542864004;736.2229591031115;741.3957624535985;749.673891857033;9351.485668288173;9797.804043919225;10281.588736450458;10745.731356716145;11056.336619802838;573.5325709546789;584.1704779213527;584.5119325363369;672.4452326830384;709.9077119974473;5080.745962701924;5115.948840511622;5180.197069454241;5280.65675731084;5292.047431462373;65825.34174658288;88058;89602.55198723964;125536;129539.35230323976;106736.46631766792;108026.45986770016;108067;108435;111305;95707;95848;98853.50573247232;99139;99368.50315748519;9809.16622087102;9907.950460247652;9958.800823983625;10045.949770251395;10072.697819065439;53079.469205309;54766;55503.72248138895;56398.718006409705;56886.7155664219;49866.501334986184;65119.674401627686;65522.7924928267;75510;75660;13646.658833529242;13653.658658533219;13728.176309421468;13811.585652430444;13907.58277251684;15523.534293971199;15539.145347005571;15757.527274181793;15986.280617372478;16313.910111911477;14661.633459163606;14720.411183552538;14937.626559336104;15167.241637918281;15527;13900.51348202808;14361.497347592784;14646.926765366532;14699.412023519368;14748.63128421798;14170.220637865017;14329.426822926966;14387;14582.125072495684;14829.700980561867;11688.545405464947;11787.587434439753;11868.881311186778;12026.15816892809;12037.819432708342;10325.9483702584;10371.429571373345;10873;11029.889701103208;11873.525058997544 10:41:32 INFO - PROCESS | 26428 | __end_tp_report 10:41:32 INFO - PROCESS | 26428 | __start_cc_report 10:41:32 INFO - PROCESS | 26428 | _x_x_mozilla_cycle_collect,1073 10:41:32 INFO - PROCESS | 26428 | __end_cc_report 10:41:32 INFO - PROCESS | 26428 | __startTimestamp1470850892522__endTimestamp 10:41:32 INFO - PROCESS | 26428 | 10:41:32 INFO - PROCESS | 26428 | ------- Summary: start ------- 10:41:32 INFO - PROCESS | 26428 | Number of tests: 6 10:41:32 INFO - PROCESS | 26428 | 10:41:32 INFO - PROCESS | 26428 | [#0] dojo.html Cycles:165 Average:5255.04 Median:5449.10 stddev:591.97 (10.9%) stddev-sans-first:567.89 10:41:32 INFO - PROCESS | 26428 | Values: 3047.5 3066.8 3093.2 3094.5 3111.2 5192.8 5200.6 5246.4 5310.5 5313.2 5238.5 5303.3 5329.8 5385.8 5444.8 4748.8 4757.9 4785.4 4794.2 4906.5 4809.5 4836.6 4847.3 4867.9 4889.9 4749.8 4787.1 4811.1 4840.6 4845.6 4843.4 4851.2 4863.3 4864.0 4864.8 4696.3 4704.3 4748.9 4754.3 4827.6 5233.1 5244.4 5311.8 5370.5 5383.2 5689.9 5730.1 5739.8 5743.8 5746.3 5504.7 5577.5 5588.9 5605.8 5695.2 5300.8 5319.0 5320.9 5323.3 5328.2 5597.5 5740.8 5749.2 5791.1 5803.1 5436.6 5502.7 5508.9 5544.0 5601.9 5580.2 5622.1 5671.6 5676.6 5677.4 5484.5 5611.0 5615.3 5626.5 5661.0 5537.4 5580.1 5597.3 5678.0 5685.3 4326.8 4335.2 4336.3 4338.9 4379.1 3840.6 3860.7 3870.2 3904.6 3906.6 5239.2 5264.8 5293.8 5313.8 5322.1 5605.3 5629.7 5638.3 5669.9 5690.7 5312.1 5325.8 5326.5 5327.1 5328.6 4761.8 4865.3 4883.4 4915.5 4922.2 5914.0 5916.8 5945.2 5969.1 5981.3 5659.8 5665.7 5691.1 5704.6 5738.5 5770.7 5800.1 5813.9 5930.8 5938.3 5523.6 5537.3 5541.1 5585.6 5602.9 5643.5 5647.2 5664.5 5666.1 5678.5 5420.8 5472.5 5496.3 5528.7 5531.8 5535.6 5537.9 5565.0 5601.9 5617.5 5449.1 5523.9 5535.4 5553.1 5570.6 5397.8 5466.8 5482.3 5652.8 5654.9 5427.8 5432.1 5437.9 5448.3 5462.5 10:41:32 INFO - PROCESS | 26428 | 10:41:32 INFO - PROCESS | 26428 | [#1] ext.html Cycles:180 Average:59357.30 Median:41621.98 stddev:121197.58 (291.2%) stddev-sans-first:121457.22 10:41:32 INFO - PROCESS | 26428 | Values: 577.7 607.7 616.9 618.3 634.7 42659.0 43766.6 44026.3 46966.0 47118.8 44866.8 45426.0 45451.1 45451.8 45476.5 8810.6 8945.6 8949.3 8952.6 8953.4 8925.4 9006.1 9019.4 9025.1 9025.2 9041.1 9082.0 9082.5 9088.8 9089.8 8976.1 8988.1 9022.1 9025.3 9028.9 8948.4 8973.6 8975.3 8994.1 9012.9 41333.8 41573.8 41670.2 41681.5 41778.2 3523.9 3548.4 3570.1 3608.0 3714.6 32173.5 32559.2 32565.2 32604.7 32719.5 4197.4 4345.4 4382.1 4562.8 4566.2 267046.0 267116.0 267425.0 268290.7 268715.0 50422.0 57205.4 57745.7 57749.0 57795.7 51445.5 51685.7 51717.5 52410.5 52473.2 14360.8 14371.0 14387.4 14412.3 14433.5 10559.5 10562.3 10642.5 10678.3 10704.7 14290.7 16057.8 16503.3 16536.5 16800.2 5748.3 5791.8 5989.5 6006.5 6102.8 972.6 1077.8 1098.5 1201.5 1220.2 32839.0 33078.5 33118.3 33225.0 33383.3 1098.1 1159.3 1167.6 1191.4 1195.4 17578.9 17982.5 18213.0 18402.3 19315.4 579742.0 583400.0 585036.0 585742.0 587341.0 58700.0 58810.7 59035.1 59037.7 59184.0 1344.1 1390.2 1396.0 1402.7 1406.6 31475.5 33754.0 33864.2 34110.3 34433.1 51335.0 51554.7 51610.5 51646.7 51771.5 453121.0 453808.0 454694.0 456365.0 459116.0 23274.8 24860.4 28107.9 28129.6 28775.0 46224.3 46522.3 46900.3 47338.3 47490.3 38312.0 39523.6 39590.1 40764.6 41161.0 38950.0 39337.8 39923.0 40188.0 40703.8 39433.0 40535.6 40989.4 41188.8 41404.8 31861.7 35263.6 35766.5 36254.3 36537.5 27989.0 28034.3 28161.7 28274.4 28329.0 10:41:32 INFO - PROCESS | 26428 | 10:41:32 INFO - PROCESS | 26428 | [#2] jquery.html Cycles:180 Average:28780.52 Median:395.48 stddev:80719.15 (20410.3%) stddev-sans-first:80917.40 10:41:32 INFO - PROCESS | 26428 | Values: 368.9 391.5 399.5 399.7 418.6 16901.7 19780.7 20037.5 20369.4 20996.7 11144.6 11304.2 15532.7 17906.0 18439.3 5244.7 5451.7 5458.8 5460.8 5463.6 5093.2 5342.6 5414.2 5421.5 5424.6 5382.1 5419.9 5421.4 5429.2 5435.1 5234.7 5398.7 5433.0 5436.4 5437.1 5144.0 5273.6 5278.4 5280.9 5284.0 22914.8 23001.8 23096.0 23418.4 23699.4 2333.0 2350.8 2358.0 2419.6 2440.4 9627.6 9845.4 10106.4 10346.0 10471.6 1915.3 1984.5 2044.6 2111.5 2136.1 86531.6 88614.0 88691.1 89209.6 89502.0 10978.5 11050.8 11190.7 11257.8 11328.6 15656.8 15683.2 15684.4 15684.5 15734.8 7636.1 7913.9 7925.4 7941.8 8034.4 7482.9 7566.0 7726.0 7769.5 7838.3 4656.7 4742.7 4777.4 4810.8 4906.9 1996.0 1998.3 2020.5 2032.4 2033.0 904.8 975.8 983.7 985.8 1013.3 20038.9 20805.8 20863.5 20918.7 21146.6 967.1 990.7 1000.5 1002.9 1036.3 10770.6 11275.2 11484.2 11556.9 11565.7 480753.0 488217.0 492542.0 493026.1 494731.0 57551.7 59110.0 66221.0 94056.0 95411.5 993.1 1009.0 1014.7 1073.2 1076.5 18291.0 18592.5 18953.0 19135.9 19158.2 43853.0 43887.3 44687.8 44866.6 45831.3 57836.4 58953.7 63027.7 63328.7 63994.7 8583.4 8635.9 8749.6 8949.3 8973.8 7563.7 11841.9 12026.9 12157.8 12839.4 11306.5 11462.7 11473.1 11544.9 11677.2 10881.3 10959.8 11054.9 11448.5 11494.2 11855.3 12027.5 12083.0 12190.9 12260.4 8678.0 8722.3 8745.4 9052.3 9144.5 8770.3 11168.8 11495.7 11622.5 11898.2 10:41:32 INFO - PROCESS | 26428 | 10:41:32 INFO - PROCESS | 26428 | [#3] mootools.html Cycles:180 Average:6000.44 Median:4561.79 stddev:3458.40 (75.8%) stddev-sans-first:3450.46 10:41:32 INFO - PROCESS | 26428 | Values: 1352.4 1462.0 1522.1 1633.5 1776.4 8567.2 8867.2 8977.0 9289.4 9295.3 9068.8 9201.1 9224.4 9224.8 9226.0 2414.0 2432.3 2434.4 2436.7 2443.9 2357.8 2420.8 2422.6 2426.6 2428.3 2414.8 2437.8 2445.7 2448.3 2448.3 2380.7 2395.7 2408.4 2410.0 2419.7 2335.2 2344.8 2347.1 2349.1 2357.6 8601.4 8674.3 8684.3 8833.6 8935.6 5164.0 5362.3 5365.9 5367.0 5371.0 3352.5 3406.9 3417.1 3440.3 3449.5 1098.2 1122.8 1145.6 1147.0 1158.7 12890.1 12891.4 12924.5 13008.2 13046.5 4422.3 4515.9 4646.7 4679.3 4699.1 10059.0 10060.4 10069.9 10120.5 10126.7 5351.5 5364.1 5366.8 5372.9 5379.3 4405.6 4892.4 5011.0 5034.3 5055.1 3671.4 3678.7 3771.0 3800.8 3839.1 1123.2 1125.4 1128.5 1129.7 1131.8 937.4 1011.2 1017.1 1035.4 1043.0 6131.6 6170.0 6337.1 6368.0 6484.7 462.2 464.1 473.4 476.3 476.9 4467.9 4482.8 4485.6 4557.9 4565.7 10713.8 10928.6 11051.4 11063.7 11073.9 11340.5 11661.1 11676.8 11680.5 11684.0 8450.1 8559.9 8621.2 8674.8 8689.9 6335.6 6572.5 6629.1 6632.0 6720.9 10502.0 10654.5 10658.1 10664.2 10867.2 10578.9 10771.6 10995.3 11090.7 11116.6 7252.0 7457.4 7462.7 8210.3 8394.3 8463.0 8586.7 8763.2 8812.3 8827.7 7800.7 7863.6 7926.8 8114.4 8228.0 7958.8 8058.6 8303.0 8303.5 8543.2 7212.9 7222.4 7352.0 7356.0 7412.9 5558.9 5637.8 5648.0 5746.3 5802.9 5566.4 5569.4 5578.2 5604.1 5633.5 10:41:32 INFO - PROCESS | 26428 | 10:41:32 INFO - PROCESS | 26428 | [#4] prototype.html Cycles:180 Average:4469.49 Median:5060.33 stddev:1320.24 (26.1%) stddev-sans-first:1286.16 10:41:32 INFO - PROCESS | 26428 | Values: 291.5 308.2 310.7 316.5 323.1 5029.2 5059.4 5180.5 5223.1 5228.4 5139.3 5153.9 5160.6 5170.7 5190.0 4063.6 4067.2 4072.3 4080.5 4098.6 3705.9 3800.8 4075.2 4094.9 4117.6 3970.2 3983.4 4000.8 4004.6 4007.0 3982.3 3989.2 3991.9 3992.9 4015.4 3486.3 3486.5 3498.6 3500.3 3514.8 4943.7 5008.6 5061.2 5062.3 5111.3 4527.0 4538.0 4543.3 4544.4 4563.4 5357.6 5381.3 5382.2 5408.0 5461.9 3734.8 3840.9 3843.0 3849.0 3861.2 5491.8 5559.0 5562.6 5567.9 5571.0 3877.7 3884.6 3897.2 3926.5 3944.0 3806.7 3859.3 3940.1 3984.7 3985.3 4476.6 4489.1 4492.5 4503.5 4507.1 5333.8 5340.3 5350.4 5359.9 5360.2 1310.5 1312.4 1356.4 1361.4 1373.6 930.8 945.4 945.7 948.2 960.5 5193.8 5197.6 5205.1 5215.9 5221.7 5400.5 5523.6 5527.9 5545.9 5562.2 5163.7 5172.5 5174.3 5179.0 5203.0 2568.7 2570.3 2576.4 2576.9 2593.8 4712.8 4946.8 5011.4 5025.2 5025.9 4934.2 4934.9 4941.9 4944.0 4963.4 4994.3 5007.6 5011.7 5012.9 5025.6 4859.7 4869.2 5121.4 5543.7 5570.4 5509.9 5537.4 5545.3 5556.2 5556.7 5660.2 5782.1 5791.3 5819.9 5832.6 3919.6 3936.9 3941.0 3945.7 3955.4 5535.2 5550.2 5552.7 5566.8 5612.4 5271.8 5459.2 5469.6 5471.0 5476.2 5420.5 5439.6 5444.9 5454.8 5457.0 5214.4 5300.9 5431.4 5447.9 5459.3 5474.8 5476.6 5506.5 5509.4 5520.2 5148.1 5359.0 5371.5 5372.8 5387.7 10:41:32 INFO - PROCESS | 26428 | 10:41:32 INFO - PROCESS | 26428 | [#5] yui.html Cycles:180 Average:21569.67 Median:4165.27 stddev:30778.57 (738.9%) stddev-sans-first:30825.19 10:41:32 INFO - PROCESS | 26428 | Values: 744.0 770.0 789.8 796.7 882.5 15956.7 17016.1 17050.2 17055.6 17107.4 15237.1 15237.4 15246.7 15258.8 15338.3 653.8 773.6 775.2 806.9 807.4 740.4 740.6 740.6 741.2 741.9 860.2 860.7 860.9 860.9 861.4 691.7 701.2 705.2 843.5 859.5 612.0 613.0 616.1 619.7 619.8 16001.5 16043.6 16104.2 16115.1 16134.3 15639.5 15870.3 16050.9 16051.1 16185.0 12749.2 12862.9 12888.5 13149.3 13262.9 3933.0 4026.4 4051.9 4164.1 4166.5 86653.0 86680.0 87345.6 87432.0 89551.6 11439.9 11602.4 11640.9 12043.1 12342.9 22910.0 22943.8 22952.8 22962.9 23055.8 8571.9 8704.9 8711.8 8740.1 9006.2 4584.2 4860.9 4887.9 4905.9 4953.9 3504.6 3613.2 3618.2 3619.2 3622.3 555.8 573.0 580.2 580.6 581.2 723.7 728.9 736.2 741.4 749.7 9351.5 9797.8 10281.6 10745.7 11056.3 573.5 584.2 584.5 672.4 709.9 5080.7 5115.9 5180.2 5280.7 5292.0 65825.3 88058.0 89602.6 125536.0 129539.4 106736.5 108026.5 108067.0 108435.0 111305.0 95707.0 95848.0 98853.5 99139.0 99368.5 9809.2 9908.0 9958.8 10045.9 10072.7 53079.5 54766.0 55503.7 56398.7 56886.7 49866.5 65119.7 65522.8 75510.0 75660.0 13646.7 13653.7 13728.2 13811.6 13907.6 15523.5 15539.1 15757.5 15986.3 16313.9 14661.6 14720.4 14937.6 15167.2 15527.0 13900.5 14361.5 14646.9 14699.4 14748.6 14170.2 14329.4 14387.0 14582.1 14829.7 11688.5 11787.6 11868.9 12026.2 12037.8 10325.9 10371.4 10873.0 11029.9 11873.5 10:41:32 INFO - PROCESS | 26428 | -------- Summary: end -------- 10:41:32 INFO - PROCESS | 26428 | 10:41:33 INFO - TEST-INFO | 26428: exit 0 10:41:33 INFO - TEST-OK | dromaeo_css | took 1115177ms 10:41:33 INFO - TEST-START | kraken 10:41:33 INFO - operating with platform_type : linux_ 10:41:33 INFO - Initialising browser for kraken test... 10:41:33 INFO - TEST-INFO | started process 26617 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpwvhBGH/profile http://localhost:55353/getInfo.html) 10:41:37 INFO - PROCESS | 26617 | __metrics Screen width/height:1600/1200 10:41:37 INFO - PROCESS | 26617 | colorDepth:24 10:41:37 INFO - PROCESS | 26617 | Browser inner width/height: 1024/697 10:41:37 INFO - PROCESS | 26617 | __metrics 10:41:38 INFO - PROCESS | 26617 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 10:41:38 INFO - PROCESS | 26617 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 122: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 10:41:39 INFO - TEST-INFO | 26617: exit 0 10:41:39 INFO - Browser initialized. 10:41:39 INFO - Running cycle 1/1 for kraken test... 10:41:39 INFO - TEST-INFO | started process 26699 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpwvhBGH/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 10:41:51 INFO - PROCESS | 26699 | RSS: Main: 155639808 10:41:51 INFO - PROCESS | 26699 | 10:41:53 INFO - PROCESS | 26699 | Cycle 1(1): loaded http://localhost:55353/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:55353/tests/kraken/driver.html?testName=audio-beat-detection) 10:41:54 INFO - PROCESS | 26699 | RSS: Main: 211419136 10:41:54 INFO - PROCESS | 26699 | 10:41:57 INFO - PROCESS | 26699 | Cycle 1(1): loaded http://localhost:55353/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:55353/tests/kraken/driver.html?testName=audio-dft) 10:41:57 INFO - PROCESS | 26699 | RSS: Main: 186642432 10:41:57 INFO - PROCESS | 26699 | 10:42:00 INFO - PROCESS | 26699 | Cycle 1(1): loaded http://localhost:55353/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:55353/tests/kraken/driver.html?testName=audio-fft) 10:42:01 INFO - PROCESS | 26699 | RSS: Main: 268320768 10:42:01 INFO - PROCESS | 26699 | 10:42:03 INFO - PROCESS | 26699 | Cycle 1(1): loaded http://localhost:55353/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:55353/tests/kraken/driver.html?testName=audio-oscillator) 10:42:04 INFO - PROCESS | 26699 | RSS: Main: 178032640 10:42:04 INFO - PROCESS | 26699 | 10:42:06 INFO - PROCESS | 26699 | Cycle 1(1): loaded http://localhost:55353/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:55353/tests/kraken/driver.html?testName=imaging-gaussian-blur) 10:42:06 INFO - PROCESS | 26699 | RSS: Main: 183164928 10:42:06 INFO - PROCESS | 26699 | 10:42:09 INFO - PROCESS | 26699 | Cycle 1(1): loaded http://localhost:55353/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:55353/tests/kraken/driver.html?testName=imaging-darkroom) 10:42:10 INFO - PROCESS | 26699 | RSS: Main: 218107904 10:42:10 INFO - PROCESS | 26699 | 10:42:13 INFO - PROCESS | 26699 | Cycle 1(1): loaded http://localhost:55353/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:55353/tests/kraken/driver.html?testName=imaging-desaturate) 10:42:14 INFO - PROCESS | 26699 | RSS: Main: 218411008 10:42:14 INFO - PROCESS | 26699 | 10:42:17 INFO - PROCESS | 26699 | Cycle 1(1): loaded http://localhost:55353/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:55353/tests/kraken/driver.html?testName=json-parse-financial) 10:42:17 INFO - PROCESS | 26699 | RSS: Main: 218361856 10:42:17 INFO - PROCESS | 26699 | 10:42:19 INFO - PROCESS | 26699 | Cycle 1(1): loaded http://localhost:55353/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:55353/tests/kraken/driver.html?testName=json-stringify-tinderbox) 10:42:19 INFO - PROCESS | 26699 | RSS: Main: 183054336 10:42:19 INFO - PROCESS | 26699 | 10:42:21 INFO - PROCESS | 26699 | Cycle 1(1): loaded http://localhost:55353/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:55353/tests/kraken/driver.html?testName=stanford-crypto-aes) 10:42:22 INFO - PROCESS | 26699 | RSS: Main: 189800448 10:42:22 INFO - PROCESS | 26699 | 10:42:24 INFO - PROCESS | 26699 | Cycle 1(1): loaded http://localhost:55353/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:55353/tests/kraken/driver.html?testName=stanford-crypto-ccm) 10:42:24 INFO - PROCESS | 26699 | RSS: Main: 193343488 10:42:24 INFO - PROCESS | 26699 | 10:42:27 INFO - PROCESS | 26699 | Cycle 1(1): loaded http://localhost:55353/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:55353/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 10:42:28 INFO - PROCESS | 26699 | RSS: Main: 188805120 10:42:28 INFO - PROCESS | 26699 | 10:42:30 INFO - PROCESS | 26699 | Cycle 1(1): loaded http://localhost:55353/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:55353/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 10:42:31 INFO - PROCESS | 26699 | RSS: Main: 191418368 10:42:31 INFO - PROCESS | 26699 | 10:42:33 INFO - PROCESS | 26699 | Cycle 1(1): loaded http://localhost:55353/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:55353/tests/kraken/driver.html?testName=ai-astar) 10:42:33 INFO - PROCESS | 26699 | RSS: Main: 242683904 10:42:33 INFO - PROCESS | 26699 | 10:42:33 INFO - PROCESS | 26699 | __start_tp_report 10:42:33 INFO - PROCESS | 26699 | _x_x_mozilla_page_load 10:42:33 INFO - PROCESS | 26699 | _x_x_mozilla_page_load_details 10:42:33 INFO - PROCESS | 26699 | |i|pagename|runs| 10:42:33 INFO - PROCESS | 26699 | |0;ai-astar;104;111;114;113;125;113;113;112;114;112 10:42:33 INFO - PROCESS | 26699 | |1;audio-beat-detection;149;121;119;181;119;120;154;118;151;121 10:42:33 INFO - PROCESS | 26699 | |2;audio-dft;160;160;160;160;163;161;161;162;161;162 10:42:33 INFO - PROCESS | 26699 | |3;audio-fft;76;74;76;116;75;76;74;76;106;75 10:42:33 INFO - PROCESS | 26699 | |4;audio-oscillator;85;84;125;85;85;83;121;83;84;125 10:42:33 INFO - PROCESS | 26699 | |5;imaging-gaussian-blur;117;116;117;117;117;117;116;116;117;117 10:42:33 INFO - PROCESS | 26699 | |6;imaging-darkroom;146;146;146;146;147;148;146;145;146;146 10:42:33 INFO - PROCESS | 26699 | |7;imaging-desaturate;95;95;94;94;94;95;95;96;95;95 10:42:33 INFO - PROCESS | 26699 | |8;json-parse-financial;50;50;50;51;50;50;49;50;49;49 10:42:33 INFO - PROCESS | 26699 | |9;json-stringify-tinderbox;61;61;61;61;61;61;62;62;63;62 10:42:33 INFO - PROCESS | 26699 | |10;stanford-crypto-aes;75;77;76;76;75;76;76;75;75;84 10:42:33 INFO - PROCESS | 26699 | |11;stanford-crypto-ccm;121;131;129;126;142;121;120;128;141;122 10:42:33 INFO - PROCESS | 26699 | |12;stanford-crypto-pbkdf2;164;168;162;160;161;162;171;165;164;168 10:42:33 INFO - PROCESS | 26699 | |13;stanford-crypto-sha256-iterative;64;64;63;65;63;64;62;63;64;62 10:42:33 INFO - PROCESS | 26699 | __end_tp_report 10:42:33 INFO - PROCESS | 26699 | __start_cc_report 10:42:33 INFO - PROCESS | 26699 | _x_x_mozilla_cycle_collect,1725 10:42:33 INFO - PROCESS | 26699 | __end_cc_report 10:42:33 INFO - PROCESS | 26699 | __startTimestamp1470850953329__endTimestamp 10:42:33 INFO - PROCESS | 26699 | 10:42:33 INFO - PROCESS | 26699 | ------- Summary: start ------- 10:42:33 INFO - PROCESS | 26699 | Number of tests: 14 10:42:33 INFO - PROCESS | 26699 | 10:42:33 INFO - PROCESS | 26699 | [#0] ai-astar Cycles:10 Average:113.10 Median:113.00 stddev:5.09 (4.5%) stddev-sans-first:4.20 10:42:33 INFO - PROCESS | 26699 | Values: 104.0 111.0 114.0 113.0 125.0 113.0 113.0 112.0 114.0 112.0 10:42:33 INFO - PROCESS | 26699 | 10:42:33 INFO - PROCESS | 26699 | [#1] audio-beat-detection Cycles:10 Average:135.30 Median:135.00 stddev:21.97 (16.3%) stddev-sans-first:22.74 10:42:33 INFO - PROCESS | 26699 | Values: 149.0 121.0 119.0 181.0 119.0 120.0 154.0 118.0 151.0 121.0 10:42:33 INFO - PROCESS | 26699 | 10:42:33 INFO - PROCESS | 26699 | [#2] audio-dft Cycles:10 Average:161.00 Median:161.00 stddev:1.05 (0.7%) stddev-sans-first:1.05 10:42:33 INFO - PROCESS | 26699 | Values: 160.0 160.0 160.0 160.0 163.0 161.0 161.0 162.0 161.0 162.0 10:42:33 INFO - PROCESS | 26699 | 10:42:33 INFO - PROCESS | 26699 | [#3] audio-fft Cycles:10 Average:82.40 Median:75.50 stddev:15.28 (20.2%) stddev-sans-first:16.03 10:42:33 INFO - PROCESS | 26699 | Values: 76.0 74.0 76.0 116.0 75.0 76.0 74.0 76.0 106.0 75.0 10:42:33 INFO - PROCESS | 26699 | 10:42:33 INFO - PROCESS | 26699 | [#4] audio-oscillator Cycles:10 Average:96.00 Median:84.00 stddev:19.14 (22.8%) stddev-sans-first:19.88 10:42:33 INFO - PROCESS | 26699 | Values: 85.0 84.0 125.0 85.0 85.0 83.0 121.0 83.0 84.0 125.0 10:42:33 INFO - PROCESS | 26699 | 10:42:33 INFO - PROCESS | 26699 | [#5] imaging-gaussian-blur Cycles:10 Average:116.70 Median:117.00 stddev:0.48 (0.4%) stddev-sans-first:0.50 10:42:33 INFO - PROCESS | 26699 | Values: 117.0 116.0 117.0 117.0 117.0 117.0 116.0 116.0 117.0 117.0 10:42:33 INFO - PROCESS | 26699 | 10:42:33 INFO - PROCESS | 26699 | [#6] imaging-darkroom Cycles:10 Average:146.20 Median:146.00 stddev:0.79 (0.5%) stddev-sans-first:0.83 10:42:33 INFO - PROCESS | 26699 | Values: 146.0 146.0 146.0 146.0 147.0 148.0 146.0 145.0 146.0 146.0 10:42:33 INFO - PROCESS | 26699 | 10:42:33 INFO - PROCESS | 26699 | [#7] imaging-desaturate Cycles:10 Average:94.80 Median:95.00 stddev:0.63 (0.7%) stddev-sans-first:0.67 10:42:33 INFO - PROCESS | 26699 | Values: 95.0 95.0 94.0 94.0 94.0 95.0 95.0 96.0 95.0 95.0 10:42:33 INFO - PROCESS | 26699 | 10:42:33 INFO - PROCESS | 26699 | [#8] json-parse-financial Cycles:10 Average:49.80 Median:50.00 stddev:0.63 (1.3%) stddev-sans-first:0.67 10:42:33 INFO - PROCESS | 26699 | Values: 50.0 50.0 50.0 51.0 50.0 50.0 49.0 50.0 49.0 49.0 10:42:33 INFO - PROCESS | 26699 | 10:42:33 INFO - PROCESS | 26699 | [#9] json-stringify-tinderbox Cycles:10 Average:61.50 Median:61.50 stddev:0.71 (1.1%) stddev-sans-first:0.73 10:42:33 INFO - PROCESS | 26699 | Values: 61.0 61.0 61.0 61.0 61.0 61.0 62.0 62.0 63.0 62.0 10:42:33 INFO - PROCESS | 26699 | 10:42:33 INFO - PROCESS | 26699 | [#10] stanford-crypto-aes Cycles:10 Average:76.50 Median:76.00 stddev:2.72 (3.6%) stddev-sans-first:2.83 10:42:33 INFO - PROCESS | 26699 | Values: 75.0 77.0 76.0 76.0 75.0 76.0 76.0 75.0 75.0 84.0 10:42:33 INFO - PROCESS | 26699 | 10:42:33 INFO - PROCESS | 26699 | [#11] stanford-crypto-ccm Cycles:10 Average:128.10 Median:128.50 stddev:8.01 (6.2%) stddev-sans-first:8.07 10:42:33 INFO - PROCESS | 26699 | Values: 121.0 131.0 129.0 126.0 142.0 121.0 120.0 128.0 141.0 122.0 10:42:33 INFO - PROCESS | 26699 | 10:42:33 INFO - PROCESS | 26699 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:164.50 Median:164.50 stddev:3.54 (2.1%) stddev-sans-first:3.75 10:42:33 INFO - PROCESS | 26699 | Values: 164.0 168.0 162.0 160.0 161.0 162.0 171.0 165.0 164.0 168.0 10:42:33 INFO - PROCESS | 26699 | 10:42:33 INFO - PROCESS | 26699 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:63.40 Median:64.00 stddev:0.97 (1.5%) stddev-sans-first:1.00 10:42:33 INFO - PROCESS | 26699 | Values: 64.0 64.0 63.0 65.0 63.0 64.0 62.0 63.0 64.0 62.0 10:42:33 INFO - PROCESS | 26699 | -------- Summary: end -------- 10:42:33 INFO - PROCESS | 26699 | 10:42:34 INFO - TEST-INFO | 26699: exit 0 10:42:34 INFO - TEST-OK | kraken | took 61051ms 10:42:34 INFO - SUITE-END | took 1176s 10:42:34 INFO - Completed test suite (00:19:36) 10:42:34 INFO - javascript benchmark 10:42:34 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3047.527633216851, 3066.75465962723, 3093.1648454917186, 3094.5300982033536, 3111.222194451387, 5192.818251361203, 5200.583953283738, 5246.449122842104, 5310.548603368714, 5313.229581710654, 5238.476152384759, 5303.284056652351, 5329.813456529022, 5385.838424847261, 5444.809431669893, 4748.76256187191, 4757.90484190316, 4785.377900872882, 4794.2329227323635, 4906.460289368167, 4809.495003024685, 4836.564709176174, 4847.272909063651, 4867.92905560776, 4889.926651100236, 4749.810007599692, 4787.066522028206, 4811.061842940628, 4840.636952228597, 4845.588125009396, 4843.4187897452175, 4851.223804191348, 4863.27050942358, 4863.975680121612, 4864.78108485119, 4696.319033740088, 4704.270838020112, 4748.928766068477, 4754.286856971447, 4827.61379089672, 5233.110371236899, 5244.39689435716, 5311.840644780663, 5370.5435038021815, 5383.192521121824, 5689.943100569024, 5730.140478928152, 5739.799107031234, 5743.798967036176, 5746.310442746855, 5504.669719816824, 5577.52591029763, 5588.944110558924, 5605.831825045255, 5695.231143795576, 5300.814471493518, 5319.042572337016, 5320.866978325535, 5323.334583177064, 5328.17413300939, 5597.468240517144, 5740.770369185269, 5749.223854779635, 5791.073428251544, 5803.129530570363, 5436.646617969898, 5502.697351645618, 5508.91736623951, 5544.0, 5601.887962240732, 5580.218769372291, 5622.100463925753, 5671.574631902624, 5676.602637815313, 5677.403872593401, 5484.478974497416, 5610.971945140248, 5615.298087739033, 5626.521745651584, 5660.981023415742, 5537.446255374511, 5580.107182850725, 5597.328320601554, 5678.0, 5685.3177618685195, 4326.848560300437, 4335.176316499855, 4336.34954756789, 4338.891527711832, 4379.1460665170625, 3840.635139661728, 3860.729748917549, 3870.245302166051, 3904.648581627667, 3906.5898080701686, 5239.214117882349, 5264.815731449381, 5293.761780719877, 5313.840584782462, 5322.121849894724, 5605.299337582802, 5629.746661400247, 5638.295213098363, 5669.943300567024, 5690.6870122142855, 5312.096943519611, 5325.813596524103, 5326.520613144836, 5327.094393953037, 5328.573714102862, 4761.833335833229, 4865.343178670905, 4883.438404583448, 4915.508449155056, 4922.187839006524, 5914.0241860093465, 5916.822495325147, 5945.16767652529, 5969.134475501028, 5981.252343457068, 5659.830205093854, 5665.716714164358, 5691.060974939254, 5704.600677952503, 5738.454846789548, 5770.740316685843, 5800.071988481823, 5813.912791308049, 5930.762769489172, 5938.317093534299, 5523.585731070266, 5537.307836520435, 5541.113421852484, 5585.581081418829, 5602.887942241214, 5643.492085712305, 5647.237622921018, 5664.546836253172, 5666.065099258576, 5678.517326027169, 5420.810271640474, 5472.50747432733, 5496.258005169251, 5528.668279903219, 5531.751071201725, 5535.612507124623, 5537.944620553904, 5565.02612042899, 5601.859953501195, 5617.466340697627, 5449.100898351886, 5523.861903452445, 5535.3634332050715, 5553.139263414178, 5570.58220633446, 5397.8380648580605, 5466.808661696821, 5482.28730265079, 5652.830415087554, 5654.886902262014, 5427.782888684408, 5432.0765469871, 5437.945620543744, 5448.291722076105, 5462.453754624506], "value": 5215.4862724652585, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [577.7457918515853, 607.6870411737956, 616.9444749972502, 618.270440879762, 634.6985182038535, 42659.0, 43766.56233437665, 44026.339604905916, 46966.0, 47118.76440617801, 44866.775666121706, 45426.0, 45451.0909781805, 45451.77274113625, 45476.545234547644, 8810.559472026405, 8945.64217431302, 8949.284057275403, 8952.552372381355, 8953.418027828171, 8925.375223734341, 9006.054364291753, 9019.368644194908, 9025.052369501174, 9025.232855207316, 9041.050689677588, 9082.046385129566, 9082.54587270637, 9088.772780680503, 9089.772755681095, 8976.102389761038, 8988.146126118008, 9022.09779022099, 9025.323100767402, 9028.8645670315, 8948.373613847034, 8973.551322433917, 8975.326850486239, 8994.0556241595, 9012.909870901272, 41333.793331033456, 41573.792131039154, 41670.1665966679, 41681.4991100535, 41778.16443671109, 3523.9295214095573, 3548.361294966931, 3570.1431656402538, 3607.963920360789, 3714.5542534895717, 32173.51739723906, 32559.186020349443, 32565.185870353194, 32604.673953260637, 32719.50920736167, 4197.391378250167, 4345.41336919515, 4382.057857560608, 4562.771861406916, 4566.246569316092, 267046.0, 267115.9999999981, 267425.0, 268290.65854670794, 268715.0, 50422.0, 57205.42794572084, 57745.711271443375, 57749.0, 57795.71102144462, 51445.48554514407, 51685.74157129265, 51717.48282517202, 52410.475895241325, 52473.2129018065, 14360.784588231185, 14371.0, 14387.424503019762, 14412.279386030867, 14433.494827680981, 10559.47202639865, 10562.31344962575, 10642.521086551124, 10678.252522323519, 10704.678859634223, 14290.714185716435, 16057.839421605868, 16503.33986640521, 16536.503904882873, 16800.15999200035, 5748.310202775694, 5791.797287094932, 5989.4609485145675, 6006.519478441714, 6102.847428814226, 972.6498460554195, 1077.7952189084049, 1098.5441041967495, 1201.4533387308754, 1220.1702842067302, 32839.0, 33078.50382244268, 33118.337633247684, 33225.0, 33383.332333353195, 1098.1215027977587, 1159.287038471334, 1167.5855071449682, 1191.3566673996118, 1195.4381440722846, 17578.89053313585, 17982.460526184237, 18213.0, 18402.26390944374, 19315.4205373839, 579742.0, 583400.0, 585036.0, 585742.0, 587341.0, 58700.0, 58810.70594646999, 59035.114473282076, 59037.70481147567, 59184.0, 1344.1196016609138, 1390.2423179367067, 1396.0, 1402.747505449029, 1406.592088294383, 31475.527867081553, 33754.0, 33864.15339616529, 34110.317793644484, 34433.13917151991, 51335.0, 51554.74222629013, 51610.48389516207, 51646.74176629093, 51771.482285176666, 453121.0, 453808.0, 454694.0, 456365.0, 459116.0, 23274.76725232726, 24860.37849053788, 28107.859460702566, 28129.578056328763, 28775.0, 46224.30663540117, 46522.30216546687, 46900.29649555327, 47338.28992565045, 47490.28764568603, 38312.0, 39523.60476395199, 39590.12575687019, 40764.592354077264, 41161.0, 38950.0, 39337.81986540408, 39923.0, 40188.0, 40703.79648101741, 39433.0, 40535.594644053184, 40989.38515922323, 41188.794056029525, 41404.79297603493, 31861.68138318587, 35263.64736352603, 35766.46350304696, 36254.27491450103, 36537.451938220416, 27989.0, 28034.299142520784, 28161.71838281673, 28274.43451131007, 28329.0], "value": 19733.30110438744, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [368.9372806622874, 391.4500127321113, 399.51458977342526, 399.73417677244635, 418.61500779336455, 16901.746473802887, 19780.703289450652, 20037.499062523446, 20369.388918332435, 20996.685049724267, 11144.554217831297, 11304.208705390625, 15532.689346213068, 17906.0, 18439.262429502804, 5244.737763111839, 5451.672899626015, 5458.836234912959, 5460.781568737246, 5463.562914966813, 5093.2105523643895, 5342.572594192456, 5414.242006119146, 5421.539169170605, 5424.593155513333, 5382.138857782756, 5419.943111093338, 5421.376541697696, 5429.185622156689, 5435.130379139338, 5234.7120908350025, 5398.676079435227, 5433.049216387156, 5436.374816896068, 5437.13005919051, 5144.022635699205, 5273.551748101416, 5278.366596008504, 5280.867978300535, 5283.973580132075, 22914.77085229143, 23001.76998230013, 23096.0, 23418.414539636477, 23699.407514812094, 2332.976670233293, 2350.8343186191946, 2357.964630530543, 2419.6249581314923, 2440.3533063738123, 9627.566759495769, 9845.360051596623, 10106.39361638304, 10346.0, 10471.581136754521, 1915.3095755554928, 1984.4641946674462, 2044.6217449771839, 2111.493241622015, 2136.113512892148, 86531.56734216351, 88614.0, 88691.11308886894, 89209.55395223112, 89502.0, 10978.505967231495, 11050.834237486444, 11190.720231994264, 11257.831132533018, 11328.603498877499, 15656.843431565767, 15683.215839207995, 15684.372625094868, 15684.529464116094, 15734.842651573566, 7636.121845987672, 7913.920860791319, 7925.445218834741, 7941.8411631768195, 8034.357251419872, 7482.925170748223, 7566.0, 7725.961370193113, 7769.4949828262115, 7838.294553490213, 4656.650751193674, 4742.66801323904, 4777.4267087949665, 4810.7835147418455, 4906.9263961040615, 1995.9900200499194, 1998.280618977167, 2020.4746765840987, 2032.4004418696225, 2032.9835082458771, 904.7511934218011, 975.7999610079917, 983.6606370802205, 985.8028394321165, 1013.2957594471918, 20038.899805500878, 20805.791942080687, 20863.478413039797, 20918.686219706717, 21146.577068458853, 967.0812727908375, 990.7473594233425, 1000.4997501249376, 1002.8997100290059, 1036.2746077745608, 10770.56917723298, 11275.154363422613, 11484.19610627248, 11556.88443115575, 11565.710857228469, 480753.0, 488217.0, 492542.0, 493026.069739298, 494731.0, 57551.71224143936, 59110.0, 66221.0, 94056.0, 95411.52294238485, 993.145894530703, 1008.9545970431349, 1014.7260239735377, 1073.1951036722458, 1076.4510099849133, 18291.0, 18592.535186620444, 18953.0, 19135.90432047831, 19158.23367065302, 43853.0, 43887.2533418204, 44687.77656111699, 44866.551334486234, 45831.31253031274, 57836.4216357831, 58953.70523147357, 63027.6848615754, 63328.68335658292, 63994.68002659957, 8583.356248281529, 8635.870461943201, 8749.562521873753, 8949.32880033987, 8973.820523589622, 7563.7352692655495, 11841.940790296338, 12026.879731202926, 12157.845004724537, 12839.422225999666, 11306.547738090385, 11462.713432164262, 11473.139514536277, 11544.88455115438, 11677.182597218112, 10881.292715973437, 10959.835602466128, 11054.944725276322, 11448.542058317575, 11494.195406321478, 11855.34795586251, 12027.45876435545, 12083.0, 12190.878091219329, 12260.38698065111, 8678.0, 8722.302215822845, 8745.431546949429, 9052.3210759192, 9144.451332920045, 8770.254528364905, 11168.83116883117, 11495.712607184887, 11622.535098595961, 11898.167128300936], "value": 9112.27235544291, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1352.4387379237617, 1462.0, 1522.086747951229, 1633.4609578838983, 1776.3516316544465, 8567.228949394554, 8867.201951824334, 8976.955115224422, 9289.44263344198, 9295.30285228609, 9068.773280667987, 9201.125893040167, 9224.446533207996, 9224.769380765485, 9226.031266716998, 2414.034386245503, 2432.2581612608146, 2434.4035711250767, 2436.6588677585064, 2443.8778061096873, 2357.7524359942217, 2420.818438617102, 2422.5760491913934, 2426.5561990615556, 2428.295794219683, 2414.8188885833547, 2437.768412000857, 2445.6942882139733, 2448.2655203438985, 2448.2899959011866, 2380.67860838788, 2395.712514498263, 2408.385861605297, 2410.035985605763, 2419.7459266777087, 2335.2177020698086, 2344.75380085092, 2347.061175529802, 2349.0955981946904, 2357.552065107624, 8601.354898382584, 8674.306055515544, 8684.305255579538, 8833.558322083934, 8935.553222338856, 5164.018836421068, 5362.302900622933, 5365.892682146336, 5367.0339338918975, 5371.0, 3352.513885486615, 3406.8977930662118, 3417.128632198798, 3440.3119376124873, 3449.4653328733834, 1098.1653943003296, 1122.81473556863, 1145.5532342386475, 1147.0479502013309, 1158.7173268660724, 12890.097693161482, 12891.419886105148, 12924.54764083262, 13008.219506829526, 13046.478140874353, 4422.314541246112, 4515.932261016087, 4646.7444290564345, 4679.251319788817, 4699.083678682624, 10059.0, 10060.39637621745, 10069.899301006895, 10120.493975301206, 10126.746831329276, 5351.491608297206, 5364.088105022156, 5366.838994830161, 5372.892542149213, 5379.300690910157, 4405.625521830616, 4892.363992680928, 5011.047900898818, 5034.345535080416, 5055.115354812893, 3671.375866102769, 3678.668919797231, 3770.9825243494597, 3800.771953682788, 3839.0594304395604, 1123.2361993844102, 1125.426032723317, 1128.5316593613559, 1129.6723950054557, 1131.8415421840948, 937.4469063252577, 1011.1910471622673, 1017.0998666180484, 1035.3735989726108, 1042.9791404171874, 6131.63210207389, 6169.994499041089, 6337.081123237105, 6368.0, 6484.740610375627, 462.24423068282925, 464.12744041202996, 473.4153320648996, 476.3164858428167, 476.86886106320344, 4467.932981005288, 4482.843100491467, 4485.551444855489, 4557.908841823145, 4565.680402371869, 10713.83929241062, 10928.562857485771, 11051.447427628586, 11063.72340691473, 11073.944630276797, 11340.489677964511, 11661.067114630809, 11676.76646467066, 11680.474378652982, 11684.0, 8450.112738162527, 8559.914400856036, 8621.180987806274, 8674.826503469896, 8689.913100868911, 6335.556511044183, 6572.507061970467, 6629.07192992991, 6632.0, 6720.899186512304, 10502.0, 10654.467276635982, 10658.094062004817, 10664.200184986003, 10867.239293249397, 10578.8942110581, 10771.6229931952, 10995.285306455055, 11090.722731931766, 11116.555337786398, 7251.963740181265, 7457.366123879531, 7462.738804141829, 8210.343172546302, 8394.328453723565, 8463.0, 8586.699465518677, 8763.167499087576, 8812.339074569305, 8827.735167944971, 7800.726974555863, 7863.606819659109, 7926.762197134095, 8114.391420643357, 8228.0, 7958.84082318362, 8058.637361318638, 8303.0, 8303.543305118035, 8543.188397102265, 7212.89180662301, 7222.422206223595, 7351.963240183979, 7356.043714317105, 7412.888806667796, 5558.861028474321, 5637.830865074055, 5647.971760141173, 5746.2529871116485, 5802.854928626818, 5566.415526369673, 5569.35952365467, 5578.191162281365, 5604.075327571069, 5633.549316054788], "value": 4689.499508401537, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [291.4564337510542, 308.16333654129033, 310.7094866300008, 316.47623183631083, 323.08244585377525, 5029.195328747401, 5059.443461219263, 5180.507851754087, 5223.112070947938, 5228.424873263938, 5139.306193663854, 5153.871153221171, 5160.638755287131, 5170.715610641413, 5189.974050129744, 4063.5936406359424, 4067.2272268268935, 4072.2669919414493, 4080.510338759353, 4098.561355993194, 3705.888823335304, 3800.7909564973916, 4075.246079475292, 4094.877153685394, 4117.588241175873, 3970.225805967823, 3983.4423180754716, 4000.799960002003, 4004.599540046001, 4007.0, 3982.3429134192825, 3989.202159568098, 3991.882272963575, 3992.940105898414, 4015.4177644241568, 3486.267883744417, 3486.511888335635, 3498.6151523332414, 3500.2824420993634, 3514.7539672222956, 4943.678660887067, 5008.574271186953, 5061.215511595708, 5062.265971434122, 5111.284420181178, 4526.977365113186, 4537.9773101134615, 4543.31850222466, 4544.431946006749, 4563.383943167663, 5357.624966252364, 5381.327334083239, 5382.219578161184, 5407.972960135174, 5461.9453805461835, 3734.8319325630414, 3840.9423858642144, 3843.0392401899526, 3849.0, 3861.2084522673067, 5491.780328786884, 5558.9715902558155, 5562.582806289544, 5567.8886422271735, 5570.972145139289, 3877.709171812069, 3884.6309600587897, 3897.1815918656835, 3926.450296958428, 3943.9802800985813, 3806.6764325032127, 3859.286032084073, 3940.0937784309194, 3984.7210695251633, 3985.322495175827, 4476.552344765562, 4489.147062058199, 4492.528284530143, 4503.527129651339, 4507.098580283956, 5333.813316533902, 5340.25236466895, 5350.384705758887, 5359.892802143935, 5360.249565060894, 1310.5347601601295, 1312.3962977030674, 1356.416740801445, 1361.4418088583832, 1373.6497193215666, 930.8138372325562, 945.4043952310001, 945.7021038372891, 948.2414068744977, 960.519740129935, 5193.84418467439, 5197.636165468457, 5205.141151710001, 5215.895682086413, 5221.686698798084, 5400.513953744182, 5523.558115350762, 5527.876749636523, 5545.861353466195, 5562.193481945095, 5163.715995620202, 5172.534471897472, 5174.327337446108, 5179.0, 5202.97398513005, 2568.678915135608, 2570.3060173752983, 2576.4460640962284, 2576.948461030769, 2593.766561009518, 4712.835050773207, 4946.826861059845, 5011.423686276052, 5025.221090730943, 5025.874353141201, 4934.235193545006, 4934.9013019739405, 4941.925871111936, 4943.975280123576, 4963.404391473046, 4994.2508623706735, 5007.6494645375205, 5011.749412529359, 5012.874678133149, 5025.597952163818, 4859.732714700725, 4869.174059727602, 5121.411037730709, 5543.667379957054, 5570.359408667893, 5509.889802203853, 5537.446255374431, 5545.310524395745, 5556.222128902038, 5556.722163891708, 5660.20757093999, 5782.114113574024, 5791.305043394819, 5819.912701309399, 5832.591718579659, 3919.5884432134217, 3936.881893543198, 3940.9802950985063, 3945.7040721945395, 3955.4462375268063, 5535.197396377423, 5550.195221692751, 5552.69460179694, 5566.8289367146035, 5612.382637909908, 5271.815486458109, 5459.208414779914, 5469.617126801086, 5471.042567550742, 5476.151196564539, 5420.53925416344, 5439.5920305976415, 5444.891102178013, 5454.836354909359, 5456.972715136399, 5214.392803598201, 5300.893982120413, 5431.402545720047, 5447.891042179213, 5459.317585301837, 5474.808381706621, 5476.589255805751, 5506.504414602705, 5509.449055094458, 5520.199571062254, 5148.120935858459, 5358.97320513395, 5371.462853714754, 5372.785088596569, 5387.730613469233], "value": 4047.7581610576585, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [743.9702411903525, 769.9923000769992, 789.8301865099006, 796.7414171254642, 882.488156869016, 15956.68086638268, 17016.149192540386, 17050.23273952672, 17055.57361065974, 17107.40124095657, 15237.085774853489, 15237.390504379811, 15246.695066098671, 15258.771118433204, 15338.309776060076, 653.7744478155029, 773.5938632218074, 775.2054144501902, 806.9233422824851, 807.422692774666, 740.3595889555522, 740.5704691279072, 740.5778706137504, 741.1958025542266, 741.8516296740646, 860.2086080805674, 860.7331727164568, 860.9182127697859, 860.9483430994161, 861.3970220845401, 691.7302252121676, 701.2216439751896, 705.2453874354443, 843.5360551696542, 859.5401460218784, 611.9724612392453, 613.0, 616.072810420319, 619.6560908695673, 619.7613918641356, 16001.519954401387, 16043.598910027225, 16104.19479026044, 16115.113668748214, 16134.273957671816, 15639.530814075482, 15870.28583713724, 16050.919745401316, 16051.117188554625, 16185.0, 12749.235045897276, 12862.935685321514, 12888.548900788428, 13149.342532873414, 13262.86737132626, 3932.9803350983348, 4026.355783074694, 4051.898702532431, 4164.0630858057, 4166.479190101238, 86653.0, 86680.0, 87345.5632721845, 87432.0, 89551.55224223837, 11439.88560114405, 11602.361870097226, 11640.88359116398, 12043.096767742454, 12342.938285308695, 22910.0, 22943.770562294496, 22952.770472295397, 22962.885185574298, 23055.769442305696, 8571.914280857236, 8704.869426958601, 8711.825763484821, 8740.125987401336, 9006.189442950166, 4584.174848527297, 4860.927086093711, 4887.902241955141, 4905.852824415202, 4953.900921981613, 3504.56192975878, 3613.1689711366007, 3618.203995121069, 3619.1856832213066, 3622.3298689741955, 555.7693557173727, 573.0, 580.2051189869821, 580.6022874331097, 581.2153592649889, 723.706898706025, 728.8979542864004, 736.2229591031115, 741.3957624535985, 749.673891857033, 9351.485668288173, 9797.804043919225, 10281.588736450458, 10745.731356716145, 11056.336619802838, 573.5325709546789, 584.1704779213527, 584.5119325363369, 672.4452326830384, 709.9077119974473, 5080.745962701924, 5115.948840511622, 5180.197069454241, 5280.65675731084, 5292.047431462373, 65825.34174658288, 88058.0, 89602.55198723964, 125536.0, 129539.35230323976, 106736.46631766792, 108026.45986770016, 108067.0, 108435.0, 111305.0, 95707.0, 95848.0, 98853.50573247232, 99139.0, 99368.50315748519, 9809.16622087102, 9907.950460247652, 9958.800823983625, 10045.949770251395, 10072.697819065439, 53079.469205309, 54766.0, 55503.72248138895, 56398.718006409705, 56886.7155664219, 49866.501334986184, 65119.674401627686, 65522.7924928267, 75510.0, 75660.0, 13646.658833529242, 13653.658658533219, 13728.176309421468, 13811.585652430444, 13907.58277251684, 15523.534293971199, 15539.145347005571, 15757.527274181793, 15986.280617372478, 16313.910111911477, 14661.633459163606, 14720.411183552538, 14937.626559336104, 15167.241637918281, 15527.0, 13900.51348202808, 14361.497347592784, 14646.926765366532, 14699.412023519368, 14748.63128421798, 14170.220637865017, 14329.426822926966, 14387.0, 14582.125072495684, 14829.700980561867, 11688.545405464947, 11787.587434439753, 11868.881311186778, 12026.15816892809, 12037.819432708342, 10325.9483702584, 10371.429571373345, 10873.0, 11029.889701103208, 11873.525058997544], "value": 7765.022404304792, "unit": "score"}], "name": "dromaeo_css", "value": 7190.767241354635, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [104.0, 111.0, 114.0, 113.0, 125.0, 113.0, 113.0, 112.0, 114.0, 112.0], "value": 113.1, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [149.0, 121.0, 119.0, 181.0, 119.0, 120.0, 154.0, 118.0, 151.0, 121.0], "value": 135.3, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [160.0, 160.0, 160.0, 160.0, 163.0, 161.0, 161.0, 162.0, 161.0, 162.0], "value": 161.0, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 74.0, 76.0, 116.0, 75.0, 76.0, 74.0, 76.0, 106.0, 75.0], "value": 82.4, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 84.0, 125.0, 85.0, 85.0, 83.0, 121.0, 83.0, 84.0, 125.0], "value": 96.0, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 116.0, 117.0, 117.0, 117.0, 117.0, 116.0, 116.0, 117.0, 117.0], "value": 116.7, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 146.0, 146.0, 146.0, 147.0, 148.0, 146.0, 145.0, 146.0, 146.0], "value": 146.2, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 95.0, 94.0, 94.0, 94.0, 95.0, 95.0, 96.0, 95.0, 95.0], "value": 94.8, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [50.0, 50.0, 50.0, 51.0, 50.0, 50.0, 49.0, 50.0, 49.0, 49.0], "value": 49.8, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [61.0, 61.0, 61.0, 61.0, 61.0, 61.0, 62.0, 62.0, 63.0, 62.0], "value": 61.5, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 77.0, 76.0, 76.0, 75.0, 76.0, 76.0, 75.0, 75.0, 84.0], "value": 76.5, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [121.0, 131.0, 129.0, 126.0, 142.0, 121.0, 120.0, 128.0, 141.0, 122.0], "value": 128.1, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [164.0, 168.0, 162.0, 160.0, 161.0, 162.0, 171.0, 165.0, 164.0, 168.0], "value": 164.5, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [64.0, 64.0, 63.0, 65.0, 63.0, 64.0, 62.0, 63.0, 64.0, 62.0], "value": 63.4, "unit": "score"}], "name": "kraken", "value": 1489.3, "alertThreshold": 2.0}]} 10:42:34 INFO - Return code: 0 10:42:34 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 10:42:34 INFO - # TBPL SUCCESS # 10:42:34 INFO - Running post-action listener: _resource_record_post_action 10:42:34 INFO - [mozharness: 2016-08-10 17:42:34.626486Z] Finished run-tests step (success) 10:42:34 INFO - Running post-run listener: _resource_record_post_run 10:42:34 INFO - Total resource usage - Wall time: 1193s; CPU: 13.0%; Read bytes: 4096; Write bytes: 559857664; Read time: 12; Write time: 609692 10:42:34 INFO - TinderboxPrint: CPU usage
13.0% 10:42:34 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 12 10:42:34 INFO - TinderboxPrint: I/O write bytes / time
559,857,664 / 609,692 10:42:34 INFO - TinderboxPrint: CPU idle
8,280.0 (87.0%) 10:42:34 INFO - TinderboxPrint: CPU user
1,194.3 (12.5%) 10:42:34 INFO - TinderboxPrint: Swap in / out
0 / 0 10:42:34 INFO - install - Wall time: 17s; CPU: 14.0%; Read bytes: 0; Write bytes: 268484608; Read time: 0; Write time: 374368 10:42:34 INFO - run-tests - Wall time: 1177s; CPU: 13.0%; Read bytes: 4096; Write bytes: 291020800; Read time: 12; Write time: 235264 10:42:35 INFO - Running post-run listener: _upload_blobber_files 10:42:35 INFO - Blob upload gear active. 10:42:35 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 10:42:35 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 10:42:35 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Fx-Team', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 10:42:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Fx-Team -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 10:42:35 INFO - (blobuploader) - INFO - Open directory for files ... 10:42:35 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 10:42:35 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 10:42:35 INFO - (blobuploader) - INFO - Uploading, attempt #1. 10:42:39 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 10:42:39 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 10:42:39 INFO - (blobuploader) - INFO - Done attempting. 10:42:39 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 10:42:39 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 10:42:39 INFO - (blobuploader) - INFO - Uploading, attempt #1. 10:42:40 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 10:42:40 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 10:42:40 INFO - (blobuploader) - INFO - Done attempting. 10:42:40 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 10:42:40 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 10:42:40 INFO - (blobuploader) - INFO - Uploading, attempt #1. 10:42:41 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 10:42:41 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 10:42:41 INFO - (blobuploader) - INFO - Done attempting. 10:42:41 INFO - (blobuploader) - INFO - Iteration through files over. 10:42:41 INFO - Return code: 0 10:42:41 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 10:42:41 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 10:42:41 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/2c03ce447b816102e215b51ccdc50146d4c59408747a9ddaa3df28f7844370224a2c59935cdf9c07ff14f3c13b0aa9e52a319286c43ec2f0d9d5c13f89d7c0df", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/c01015e40a545253138e5a2f94e50c1a08fb4c35767c7fc8b9fdfa29e50317da627ce839748ddc6d07a8bfee760f3e605d24ae7405314c3f3f4a7518e7f00aeb", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/3ca34d5618cd77710a37393256d9059cfc0521b3ef11068b00a40e33c1240b561724f673c21074e6d499572934b43fcfe9d04f9adfd0200ea48ea0a1ad0f91a0"} 10:42:41 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 10:42:41 INFO - Writing to file /builds/slave/test/properties/blobber_files 10:42:41 INFO - Contents: 10:42:41 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/2c03ce447b816102e215b51ccdc50146d4c59408747a9ddaa3df28f7844370224a2c59935cdf9c07ff14f3c13b0aa9e52a319286c43ec2f0d9d5c13f89d7c0df", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/c01015e40a545253138e5a2f94e50c1a08fb4c35767c7fc8b9fdfa29e50317da627ce839748ddc6d07a8bfee760f3e605d24ae7405314c3f3f4a7518e7f00aeb", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/3ca34d5618cd77710a37393256d9059cfc0521b3ef11068b00a40e33c1240b561724f673c21074e6d499572934b43fcfe9d04f9adfd0200ea48ea0a1ad0f91a0"} 10:42:41 INFO - Running post-run listener: copy_logs_to_upload_dir 10:42:41 INFO - Copying logs to upload dir... 10:42:41 INFO - mkdir: /builds/slave/test/build/upload/logs 10:42:41 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1231.680511 ========= master_lag: -0.00 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 31 secs) (at 2016-08-10 10:42:41.311156) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-08-10 10:42:41.314633) ========= 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=82c74bd3bc9a11c5833d2010000001e6-1470849727.689592-844574423 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/2c03ce447b816102e215b51ccdc50146d4c59408747a9ddaa3df28f7844370224a2c59935cdf9c07ff14f3c13b0aa9e52a319286c43ec2f0d9d5c13f89d7c0df", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/c01015e40a545253138e5a2f94e50c1a08fb4c35767c7fc8b9fdfa29e50317da627ce839748ddc6d07a8bfee760f3e605d24ae7405314c3f3f4a7518e7f00aeb", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/3ca34d5618cd77710a37393256d9059cfc0521b3ef11068b00a40e33c1240b561724f673c21074e6d499572934b43fcfe9d04f9adfd0200ea48ea0a1ad0f91a0"} build_url:https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011287 build_url: 'https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/2c03ce447b816102e215b51ccdc50146d4c59408747a9ddaa3df28f7844370224a2c59935cdf9c07ff14f3c13b0aa9e52a319286c43ec2f0d9d5c13f89d7c0df", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/c01015e40a545253138e5a2f94e50c1a08fb4c35767c7fc8b9fdfa29e50317da627ce839748ddc6d07a8bfee760f3e605d24ae7405314c3f3f4a7518e7f00aeb", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/3ca34d5618cd77710a37393256d9059cfc0521b3ef11068b00a40e33c1240b561724f673c21074e6d499572934b43fcfe9d04f9adfd0200ea48ea0a1ad0f91a0"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-08-10 10:42:41.347885) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-08-10 10:42:41.348227) ========= 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=82c74bd3bc9a11c5833d2010000001e6-1470849727.689592-844574423 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004564 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-08-10 10:42:41.433731) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-08-10 10:42:41.434082) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-08-10 10:42:41.434458) ========= ========= Total master_lag: 0.19 =========