builder: mozilla-inbound_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-052 starttime: 1474378569.95 results: success (0) buildid: 20160920051014 builduid: b8244c0a1f9440259d884611adac6de3 revision: a02925fe4ded04e2f5523fbd7e5ddfa46b190d39 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-09-20 06:36:09.952151) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-09-20 06:36:09.952565) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-09-20 06:36:09.952849) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-09-20 06:36:09.967666) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-09-20 06:36:09.967956) ========= 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=826874ccc97bd7bf541b4875000001d5-1474378568.845861-760121704 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-09-20 06:36:10-- 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% 60.8M=0s 2016-09-20 06:36:10 (60.8 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.181896 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-09-20 06:36:10.162731) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-09-20 06:36:10.163087) ========= 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=826874ccc97bd7bf541b4875000001d5-1474378568.845861-760121704 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.150501 ========= master_lag: 0.01 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-09-20 06:36:10.325385) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-09-20 06:36:10.325744) ========= bash -c 'python archiver_client.py mozharness --repo integration/mozilla-inbound --rev a02925fe4ded04e2f5523fbd7e5ddfa46b190d39 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/mozilla-inbound --rev a02925fe4ded04e2f5523fbd7e5ddfa46b190d39 --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=826874ccc97bd7bf541b4875000001d5-1474378568.845861-760121704 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-09-20 06:36:10,392 truncating revision to first 12 chars 2016-09-20 06:36:10,392 Setting DEBUG logging. 2016-09-20 06:36:10,392 attempt 1/10 2016-09-20 06:36:10,392 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/mozilla-inbound/a02925fe4ded?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-09-20 06:36:11,247 unpacking tar archive at: mozilla-inbound-a02925fe4ded/testing/mozharness/ program finished with exit code 0 elapsedTime=1.206188 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-09-20 06:36:11.545389) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-09-20 06:36:11.545732) ========= script_repo_revision: a02925fe4ded04e2f5523fbd7e5ddfa46b190d39 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-09-20 06:36:11.546114) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-09-20 06:36:11.546380) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-09-20 06:36:11.555896) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 42 secs) (at 2016-09-20 06:36:11.556254) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Inbound --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Inbound in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Inbound', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Inbound'] 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=826874ccc97bd7bf541b4875000001d5-1474378568.845861-760121704 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 06:36:11 INFO - MultiFileLogger online at 20160920 06:36:11 in /builds/slave/test 06:36:11 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Inbound --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Inbound 06:36:11 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 06:36:11 INFO - {'append_to_log': False, 06:36:11 INFO - 'base_work_dir': '/builds/slave/test', 06:36:11 INFO - 'blob_upload_branch': 'Mozilla-Inbound', 06:36:11 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 06:36:11 INFO - 'branch': 'Mozilla-Inbound', 06:36:11 INFO - 'buildbot_json_path': 'buildprops.json', 06:36:11 INFO - 'config_files': ('talos/linux_config.py',), 06:36:11 INFO - 'default_actions': ('clobber', 06:36:11 INFO - 'read-buildbot-config', 06:36:11 INFO - 'download-and-extract', 06:36:11 INFO - 'populate-webroot', 06:36:11 INFO - 'create-virtualenv', 06:36:11 INFO - 'install', 06:36:11 INFO - 'run-tests'), 06:36:11 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 06:36:11 INFO - 'download_minidump_stackwalk': True, 06:36:11 INFO - 'download_symbols': 'ondemand', 06:36:11 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 06:36:11 INFO - 'tooltool.py': '/tools/tooltool.py', 06:36:11 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 06:36:11 INFO - '/tools/misc-python/virtualenv.py')}, 06:36:11 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 06:36:11 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 06:36:11 INFO - 'installer_path': 'installer.exe', 06:36:11 INFO - 'log_level': 'info', 06:36:11 INFO - 'log_name': 'talos', 06:36:11 INFO - 'log_to_console': True, 06:36:11 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 06:36:11 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 06:36:11 INFO - 'opt_config_files': (), 06:36:11 INFO - 'pip_index': False, 06:36:11 INFO - 'sps_profile': False, 06:36:11 INFO - 'sps_profile_interval': 0, 06:36:11 INFO - 'suite': 'dromaeojs-e10s', 06:36:11 INFO - 'system_bits': '32', 06:36:11 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 06:36:11 INFO - 'title': 'talos-linux64-ix-052', 06:36:11 INFO - 'tooltool_cache': '/builds/tooltool_cache', 06:36:11 INFO - 'use_talos_json': True, 06:36:11 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 06:36:11 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 06:36:11 INFO - 'work_dir': 'build'} 06:36:11 INFO - [mozharness: 2016-09-20 13:36:11.797365Z] Running clobber step. 06:36:11 INFO - Running pre-action listener: _resource_record_pre_action 06:36:11 INFO - Running main action method: clobber 06:36:11 INFO - rmtree: /builds/slave/test/build 06:36:11 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 06:36:16 INFO - Running post-action listener: _resource_record_post_action 06:36:16 INFO - [mozharness: 2016-09-20 13:36:16.821119Z] Finished clobber step (success) 06:36:16 INFO - [mozharness: 2016-09-20 13:36:16.821223Z] Running read-buildbot-config step. 06:36:16 INFO - Running pre-action listener: _resource_record_pre_action 06:36:16 INFO - Running main action method: read_buildbot_config 06:36:16 INFO - Using buildbot properties: 06:36:16 INFO - { 06:36:16 INFO - "project": "", 06:36:16 INFO - "product": "firefox", 06:36:16 INFO - "script_repo_revision": "production", 06:36:16 INFO - "builddir": "mozilla-inbound_ubuntu64_hw_test-dromaeojs-e10s", 06:36:16 INFO - "repository": "", 06:36:16 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-inbound pgo talos dromaeojs-e10s", 06:36:16 INFO - "buildid": "20160920051014", 06:36:16 INFO - "stage_platform": "linux64-pgo", 06:36:16 INFO - "basedir": "/builds/slave/test", 06:36:16 INFO - "buildnumber": 1399, 06:36:16 INFO - "platform": "ubuntu64_hw", 06:36:16 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 06:36:16 INFO - "slavebuilddir": "test", 06:36:16 INFO - "branch": "mozilla-inbound", 06:36:16 INFO - "revision": "a02925fe4ded04e2f5523fbd7e5ddfa46b190d39", 06:36:16 INFO - "slavename": "talos-linux64-ix-052", 06:36:16 INFO - "builduid": "b8244c0a1f9440259d884611adac6de3", 06:36:16 INFO - "repo_path": "integration/mozilla-inbound" 06:36:16 INFO - } 06:36:16 INFO - Found installer url https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1474362899/firefox-51.0a1.en-US.linux-x86_64.tar.bz2. 06:36:16 INFO - Found a test packages url https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1474362899/firefox-51.0a1.en-US.linux-x86_64.test_packages.json. 06:36:16 INFO - Running post-action listener: _resource_record_post_action 06:36:16 INFO - [mozharness: 2016-09-20 13:36:16.823640Z] Finished read-buildbot-config step (success) 06:36:16 INFO - [mozharness: 2016-09-20 13:36:16.823730Z] Running download-and-extract step. 06:36:16 INFO - Running pre-action listener: _resource_record_pre_action 06:36:16 INFO - Running main action method: download_and_extract 06:36:16 INFO - mkdir: /builds/slave/test/build/tests 06:36: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')]} 06:36:16 INFO - trying https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1474362899/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 06:36:16 INFO - Downloading https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1474362899/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 06:36:16 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1474362899/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 06:36:16 INFO - Downloaded 1361 bytes. 06:36:16 INFO - Reading from file /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 06:36:16 INFO - Using the following test package requirements: 06:36:16 INFO - {u'common': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'], 06:36:16 INFO - u'cppunittest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 06:36:16 INFO - u'firefox-51.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 06:36:16 INFO - u'gtest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 06:36:16 INFO - u'firefox-51.0a1.en-US.linux-x86_64.gtest.tests.zip'], 06:36:16 INFO - u'jittest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 06:36:16 INFO - u'jsshell-linux-x86_64.zip'], 06:36:16 INFO - u'mochitest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 06:36:16 INFO - u'firefox-51.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 06:36:16 INFO - u'mozbase': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'], 06:36:16 INFO - u'reftest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 06:36:16 INFO - u'firefox-51.0a1.en-US.linux-x86_64.reftest.tests.zip'], 06:36:16 INFO - u'talos': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 06:36:16 INFO - u'firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip'], 06:36:16 INFO - u'web-platform': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 06:36:16 INFO - u'firefox-51.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 06:36:16 INFO - u'xpcshell': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 06:36:16 INFO - u'firefox-51.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 06:36:16 INFO - Downloading packages: [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 06:36: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')]} 06:36:16 INFO - trying https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1474362899/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 06:36:16 INFO - Downloading https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1474362899/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 06:36:16 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1474362899/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 06:36:17 INFO - Downloaded 21824212 bytes. 06:36:17 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'] 06:36:17 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 06:36:18 INFO - Return code: 0 06:36:18 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 06:36:18 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')]} 06:36:18 INFO - trying https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1474362899/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 06:36:18 INFO - Downloading https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1474362899/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 06:36:18 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1474362899/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 06:36:19 INFO - Downloaded 21824212 bytes. 06:36:19 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'] 06:36:19 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 06:36:20 INFO - Return code: 0 06:36:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:36:20 INFO - trying https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1474362899/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip 06:36:20 INFO - Downloading https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1474362899/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 06:36:20 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1474362899/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 06:36:20 INFO - Downloaded 14413723 bytes. 06:36:20 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'] 06:36:20 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 06:36:20 INFO - Return code: 0 06:36:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:36:20 INFO - trying https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1474362899/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 06:36:20 INFO - Downloading https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1474362899/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 06:36:20 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1474362899/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 06:36:21 INFO - Downloaded 59371598 bytes. 06:36:22 INFO - Setting buildbot property build_url to https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1474362899/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 06:36:22 INFO - mkdir: /builds/slave/test/properties 06:36:22 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 06:36:22 INFO - Writing to file /builds/slave/test/properties/build_url 06:36:22 INFO - Contents: 06:36:22 INFO - build_url:https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1474362899/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 06:36:22 INFO - Running post-action listener: _resource_record_post_action 06:36:22 INFO - Running post-action listener: set_extra_try_arguments 06:36:22 INFO - [mozharness: 2016-09-20 13:36:22.557346Z] Finished download-and-extract step (success) 06:36:22 INFO - [mozharness: 2016-09-20 13:36:22.557580Z] Running populate-webroot step. 06:36:22 INFO - Running pre-action listener: _resource_record_pre_action 06:36:22 INFO - Running main action method: populate_webroot 06:36:22 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 06:36:22 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 06:36:22 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 06:36:22 INFO - '--tppagecycles', 06:36:22 INFO - '7'], 06:36:22 INFO - 'tests': ['tsvgm']}}, 06:36:22 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 06:36:22 INFO - 'tests': ['tresize', 'tcanvasmark']}, 06:36:22 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 06:36:22 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 06:36:22 INFO - 'tests': ['dromaeo_css', 'kraken']}, 06:36:22 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 06:36:22 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:36:22 INFO - 'talos_options': ['--disable-e10s'], 06:36:22 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 06:36:22 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:36:22 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 06:36:22 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:36:22 INFO - 'talos_options': ['--disable-e10s'], 06:36:22 INFO - 'tests': ['damp', 'tps']}, 06:36:22 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:36:22 INFO - 'tests': ['damp', 'tps']}, 06:36:22 INFO - 'g3': {'talos_options': ['--disable-e10s'], 06:36:22 INFO - 'tests': ['dromaeo_dom']}, 06:36:22 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 06:36:22 INFO - 'g4': {'talos_options': ['--disable-e10s'], 06:36:22 INFO - 'tests': ['basic_compositor_video']}, 06:36:22 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 06:36:22 INFO - 'other': {'talos_options': ['--disable-e10s'], 06:36:22 INFO - 'tests': ['a11yr', 06:36:22 INFO - 'ts_paint', 06:36:22 INFO - 'tpaint', 06:36:22 INFO - 'sessionrestore', 06:36:22 INFO - 'sessionrestore_no_auto_restore', 06:36:22 INFO - 'tabpaint']}, 06:36:22 INFO - 'other-e10s': {'tests': ['a11yr', 06:36:22 INFO - 'ts_paint', 06:36:22 INFO - 'tpaint', 06:36:22 INFO - 'sessionrestore', 06:36:22 INFO - 'sessionrestore_no_auto_restore', 06:36:22 INFO - 'tabpaint']}, 06:36:22 INFO - 'other-e10s_l64': {'tests': ['a11yr', 06:36:22 INFO - 'ts_paint', 06:36:22 INFO - 'tpaint', 06:36:22 INFO - 'sessionrestore', 06:36:22 INFO - 'sessionrestore_no_auto_restore', 06:36:22 INFO - 'tabpaint']}, 06:36:22 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 06:36:22 INFO - 'ts_paint', 06:36:22 INFO - 'tpaint', 06:36:22 INFO - 'sessionrestore', 06:36:22 INFO - 'sessionrestore_no_auto_restore', 06:36:22 INFO - 'tabpaint']}, 06:36:22 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 06:36:22 INFO - 'tests': ['a11yr', 06:36:22 INFO - 'ts_paint', 06:36:22 INFO - 'tpaint', 06:36:22 INFO - 'sessionrestore', 06:36:22 INFO - 'sessionrestore_no_auto_restore', 06:36:22 INFO - 'tabpaint']}, 06:36:22 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 06:36:22 INFO - 'tests': ['a11yr', 06:36:22 INFO - 'ts_paint', 06:36:22 INFO - 'tpaint', 06:36:22 INFO - 'sessionrestore', 06:36:22 INFO - 'sessionrestore_no_auto_restore', 06:36:22 INFO - 'tabpaint']}, 06:36:22 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 06:36:22 INFO - 'tests': ['tsvgx', 06:36:22 INFO - 'tsvgr_opacity', 06:36:22 INFO - 'tart', 06:36:22 INFO - 'tscrollx', 06:36:22 INFO - 'cart']}, 06:36:22 INFO - 'svgr-e10s': {'tests': ['tsvgx', 06:36:22 INFO - 'tsvgr_opacity', 06:36:22 INFO - 'tart', 06:36:22 INFO - 'tscrollx', 06:36:22 INFO - 'cart']}, 06:36:22 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:36:22 INFO - 'talos_options': ['--disable-e10s'], 06:36:22 INFO - 'tests': ['tp5o']}, 06:36:22 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:36:22 INFO - 'tests': ['tp5o']}, 06:36:22 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:36:22 INFO - 'talos_options': ['--disable-e10s', 06:36:22 INFO - '--xperf_path', 06:36:22 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 06:36:22 INFO - 'tests': ['tp5n']}, 06:36:22 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:36:22 INFO - 'talos_options': ['--xperf_path', 06:36:22 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 06:36:22 INFO - 'tests': ['tp5n']}}, 06:36:22 INFO - 'talos.zip': {'path': '', 06:36:22 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 06:36:22 INFO - Running post-action listener: _resource_record_post_action 06:36:22 INFO - [mozharness: 2016-09-20 13:36:22.579596Z] Finished populate-webroot step (success) 06:36:22 INFO - [mozharness: 2016-09-20 13:36:22.579685Z] Running create-virtualenv step. 06:36:22 INFO - Running pre-action listener: _resource_record_pre_action 06:36:22 INFO - Running main action method: create_virtualenv 06:36:22 INFO - Creating virtualenv /builds/slave/test/build/venv 06:36:22 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 06:36:22 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 06:36:23 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 06:36:23 INFO - Using real prefix '/usr' 06:36:23 INFO - New python executable in /builds/slave/test/build/venv/bin/python 06:36:24 INFO - Installing distribute.............................................................................................................................................................................................done. 06:36:26 INFO - Installing pip.................done. 06:36:26 INFO - Return code: 0 06:36:26 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 06:36: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')]} 06:36:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:36:26 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:36: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')]} 06:36:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:36:26 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:36: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', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xeb2030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10158a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10e1400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1170570>, '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 0x1171470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1171900>, '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': '826874ccc97bd7bf541b4875000001d5-1474378568.845861-760121704', '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 06:36: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', 'pip>=1.5'] in /builds/slave/test/build 06:36: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 pip>=1.5 06:36:26 INFO - Using env: {'DISPLAY': ':0', 06:36:26 INFO - 'HOME': '/home/cltbld', 06:36:26 INFO - 'LANG': 'en_US.UTF-8', 06:36:26 INFO - 'LANGUAGE': 'en_US:en', 06:36:26 INFO - 'LOGNAME': 'cltbld', 06:36:26 INFO - 'MAIL': '/var/mail/cltbld', 06:36:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:36:26 INFO - 'MOZ_NO_REMOTE': '1', 06:36:26 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:36:26 INFO - 'NO_EM_RESTART': '1', 06:36:26 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:36:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:36:26 INFO - 'PWD': '/builds/slave/test', 06:36:26 INFO - 'SHELL': '/bin/bash', 06:36:26 INFO - 'SHLVL': '1', 06:36:26 INFO - 'TERM': 'linux', 06:36:26 INFO - 'TMOUT': '86400', 06:36:26 INFO - 'USER': 'cltbld', 06:36:26 INFO - 'XDG_SESSION_COOKIE': '826874ccc97bd7bf541b4875000001d5-1474378568.845861-760121704', 06:36:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:36:26 INFO - '_': '/tools/buildbot/bin/python'} 06:36:26 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:36:26 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 06:36:26 INFO - Cleaning up... 06:36:26 INFO - Return code: 0 06:36:26 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 06:36: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')]} 06:36:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:36:26 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:36: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')]} 06:36:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:36:26 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:36: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', '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 0xeb2030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10158a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10e1400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1170570>, '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 0x1171470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1171900>, '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': '826874ccc97bd7bf541b4875000001d5-1474378568.845861-760121704', '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 06:36: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', 'psutil>=3.1.1'] in /builds/slave/test/build 06:36: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 psutil>=3.1.1 06:36:26 INFO - Using env: {'DISPLAY': ':0', 06:36:26 INFO - 'HOME': '/home/cltbld', 06:36:26 INFO - 'LANG': 'en_US.UTF-8', 06:36:26 INFO - 'LANGUAGE': 'en_US:en', 06:36:26 INFO - 'LOGNAME': 'cltbld', 06:36:26 INFO - 'MAIL': '/var/mail/cltbld', 06:36:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:36:26 INFO - 'MOZ_NO_REMOTE': '1', 06:36:26 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:36:26 INFO - 'NO_EM_RESTART': '1', 06:36:26 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:36:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:36:26 INFO - 'PWD': '/builds/slave/test', 06:36:26 INFO - 'SHELL': '/bin/bash', 06:36:26 INFO - 'SHLVL': '1', 06:36:26 INFO - 'TERM': 'linux', 06:36:26 INFO - 'TMOUT': '86400', 06:36:26 INFO - 'USER': 'cltbld', 06:36:26 INFO - 'XDG_SESSION_COOKIE': '826874ccc97bd7bf541b4875000001d5-1474378568.845861-760121704', 06:36:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:36:26 INFO - '_': '/tools/buildbot/bin/python'} 06:36:27 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:36:27 INFO - Downloading/unpacking psutil>=3.1.1 06:36: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 06:36: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 06:36: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 06:36: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 06:36: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 06:36: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 06:36:29 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 06:36:35 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 06:36:35 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 06:36:35 INFO - Installing collected packages: psutil 06:36:35 INFO - Running setup.py install for psutil 06:36:35 INFO - building 'psutil._psutil_linux' extension 06:36:35 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 06:36:36 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 06:36:36 INFO - building 'psutil._psutil_posix' extension 06:36:36 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 06:36:36 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 06:36:36 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 06:36:36 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 06:36:36 INFO - Successfully installed psutil 06:36:36 INFO - Cleaning up... 06:36:36 INFO - Return code: 0 06:36:36 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 06:36: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')]} 06:36:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:36:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:36: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')]} 06:36:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:36:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:36:36 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 0xeb2030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10158a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10e1400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1170570>, '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 0x1171470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1171900>, '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': '826874ccc97bd7bf541b4875000001d5-1474378568.845861-760121704', '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 06:36:36 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 06:36:36 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 06:36:36 INFO - Using env: {'DISPLAY': ':0', 06:36:36 INFO - 'HOME': '/home/cltbld', 06:36:36 INFO - 'LANG': 'en_US.UTF-8', 06:36:36 INFO - 'LANGUAGE': 'en_US:en', 06:36:36 INFO - 'LOGNAME': 'cltbld', 06:36:36 INFO - 'MAIL': '/var/mail/cltbld', 06:36:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:36:36 INFO - 'MOZ_NO_REMOTE': '1', 06:36:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:36:36 INFO - 'NO_EM_RESTART': '1', 06:36:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:36:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:36:36 INFO - 'PWD': '/builds/slave/test', 06:36:36 INFO - 'SHELL': '/bin/bash', 06:36:36 INFO - 'SHLVL': '1', 06:36:36 INFO - 'TERM': 'linux', 06:36:36 INFO - 'TMOUT': '86400', 06:36:36 INFO - 'USER': 'cltbld', 06:36:36 INFO - 'XDG_SESSION_COOKIE': '826874ccc97bd7bf541b4875000001d5-1474378568.845861-760121704', 06:36:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:36:36 INFO - '_': '/tools/buildbot/bin/python'} 06:36:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:36:36 INFO - Downloading/unpacking mozsystemmonitor==0.3 06:36:36 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 06:36:36 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 06:36:36 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 06:36:36 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 06:36:36 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 06:36:36 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 06:36:38 INFO - Downloading mozsystemmonitor-0.3.tar.gz 06:36:38 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 06:36:38 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 06:36:38 INFO - Installing collected packages: mozsystemmonitor 06:36:38 INFO - Running setup.py install for mozsystemmonitor 06:36:38 INFO - Successfully installed mozsystemmonitor 06:36:38 INFO - Cleaning up... 06:36:39 INFO - Return code: 0 06:36:39 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 06:36:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:36:39 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:36:39 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:36:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:36:39 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:36:39 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:36:39 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0xeb2030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10158a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10e1400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1170570>, '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 0x1171470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1171900>, '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': '826874ccc97bd7bf541b4875000001d5-1474378568.845861-760121704', '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 06:36:39 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 06:36:39 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 06:36:39 INFO - Using env: {'DISPLAY': ':0', 06:36:39 INFO - 'HOME': '/home/cltbld', 06:36:39 INFO - 'LANG': 'en_US.UTF-8', 06:36:39 INFO - 'LANGUAGE': 'en_US:en', 06:36:39 INFO - 'LOGNAME': 'cltbld', 06:36:39 INFO - 'MAIL': '/var/mail/cltbld', 06:36:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:36:39 INFO - 'MOZ_NO_REMOTE': '1', 06:36:39 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:36:39 INFO - 'NO_EM_RESTART': '1', 06:36:39 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:36:39 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:36:39 INFO - 'PWD': '/builds/slave/test', 06:36:39 INFO - 'SHELL': '/bin/bash', 06:36:39 INFO - 'SHLVL': '1', 06:36:39 INFO - 'TERM': 'linux', 06:36:39 INFO - 'TMOUT': '86400', 06:36:39 INFO - 'USER': 'cltbld', 06:36:39 INFO - 'XDG_SESSION_COOKIE': '826874ccc97bd7bf541b4875000001d5-1474378568.845861-760121704', 06:36:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:36:39 INFO - '_': '/tools/buildbot/bin/python'} 06:36:39 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:36:39 INFO - Downloading/unpacking jsonschema==2.5.1 06:36:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:36:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:36:39 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:36:39 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:36:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:36:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:36:41 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 06:36:41 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 06:36:41 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:36:41 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:36:41 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:36:41 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:36:41 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:36:41 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:36:41 INFO - Downloading functools32-3.2.3-2.tar.gz 06:36:41 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 06:36:41 INFO - warning: no files found matching '*.txt' 06:36:41 INFO - no previously-included directories found matching 'build' 06:36:41 INFO - no previously-included directories found matching 'dist' 06:36:41 INFO - no previously-included directories found matching '.git*' 06:36:41 INFO - Installing collected packages: jsonschema, functools32 06:36:41 INFO - Running setup.py install for functools32 06:36:41 INFO - warning: no files found matching '*.txt' 06:36:41 INFO - no previously-included directories found matching 'build' 06:36:41 INFO - no previously-included directories found matching 'dist' 06:36:41 INFO - no previously-included directories found matching '.git*' 06:36:41 INFO - Successfully installed jsonschema functools32 06:36:41 INFO - Cleaning up... 06:36:41 INFO - Return code: 0 06:36:41 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 06:36:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:36:41 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:36:41 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:36:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:36:41 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:36:41 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:36:41 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 0xeb2030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10158a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10e1400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1170570>, '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 0x1171470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1171900>, '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': '826874ccc97bd7bf541b4875000001d5-1474378568.845861-760121704', '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 06:36:41 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 06:36:41 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 06:36:41 INFO - Using env: {'DISPLAY': ':0', 06:36:41 INFO - 'HOME': '/home/cltbld', 06:36:41 INFO - 'LANG': 'en_US.UTF-8', 06:36:41 INFO - 'LANGUAGE': 'en_US:en', 06:36:41 INFO - 'LOGNAME': 'cltbld', 06:36:41 INFO - 'MAIL': '/var/mail/cltbld', 06:36:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:36:41 INFO - 'MOZ_NO_REMOTE': '1', 06:36:41 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:36:41 INFO - 'NO_EM_RESTART': '1', 06:36:41 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:36:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:36:41 INFO - 'PWD': '/builds/slave/test', 06:36:41 INFO - 'SHELL': '/bin/bash', 06:36:41 INFO - 'SHLVL': '1', 06:36:41 INFO - 'TERM': 'linux', 06:36:41 INFO - 'TMOUT': '86400', 06:36:41 INFO - 'USER': 'cltbld', 06:36:41 INFO - 'XDG_SESSION_COOKIE': '826874ccc97bd7bf541b4875000001d5-1474378568.845861-760121704', 06:36:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:36:41 INFO - '_': '/tools/buildbot/bin/python'} 06:36:41 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:36:41 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 06:36:41 INFO - Cleaning up... 06:36:41 INFO - Return code: 0 06:36:41 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 06:36:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:36:41 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:36:41 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:36:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:36:41 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:36:41 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:36:41 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 0xeb2030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10158a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10e1400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1170570>, '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 0x1171470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1171900>, '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': '826874ccc97bd7bf541b4875000001d5-1474378568.845861-760121704', '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 06:36:41 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 06:36:41 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 06:36:41 INFO - Using env: {'DISPLAY': ':0', 06:36:41 INFO - 'HOME': '/home/cltbld', 06:36:41 INFO - 'LANG': 'en_US.UTF-8', 06:36:41 INFO - 'LANGUAGE': 'en_US:en', 06:36:41 INFO - 'LOGNAME': 'cltbld', 06:36:41 INFO - 'MAIL': '/var/mail/cltbld', 06:36:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:36:41 INFO - 'MOZ_NO_REMOTE': '1', 06:36:41 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:36:41 INFO - 'NO_EM_RESTART': '1', 06:36:41 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:36:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:36:41 INFO - 'PWD': '/builds/slave/test', 06:36:41 INFO - 'SHELL': '/bin/bash', 06:36:41 INFO - 'SHLVL': '1', 06:36:41 INFO - 'TERM': 'linux', 06:36:41 INFO - 'TMOUT': '86400', 06:36:41 INFO - 'USER': 'cltbld', 06:36:41 INFO - 'XDG_SESSION_COOKIE': '826874ccc97bd7bf541b4875000001d5-1474378568.845861-760121704', 06:36:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:36:41 INFO - '_': '/tools/buildbot/bin/python'} 06:36:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:36:42 INFO - Downloading/unpacking blobuploader==1.2.4 06:36:42 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:36:42 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:36:42 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:36:42 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:36:42 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:36:42 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:36:43 INFO - Downloading blobuploader-1.2.4.tar.gz 06:36:43 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 06:36:44 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 06:36:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:36:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:36:44 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:36:44 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:36:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:36:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:36:44 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 06:36:44 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 06:36:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:36:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:36:44 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:36:44 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:36:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:36:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:36:44 INFO - Downloading docopt-0.6.1.tar.gz 06:36:44 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 06:36:44 INFO - Installing collected packages: blobuploader, requests, docopt 06:36:44 INFO - Running setup.py install for blobuploader 06:36:44 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 06:36:44 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 06:36:44 INFO - Running setup.py install for requests 06:36:45 INFO - Running setup.py install for docopt 06:36:45 INFO - Successfully installed blobuploader requests docopt 06:36:45 INFO - Cleaning up... 06:36:45 INFO - Return code: 0 06:36:45 INFO - Installing None into virtualenv /builds/slave/test/build/venv 06:36:45 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')]} 06:36:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:36:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:36:45 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')]} 06:36:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:36:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:36:45 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 0xeb2030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10158a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10e1400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1170570>, '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 0x1171470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1171900>, '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': '826874ccc97bd7bf541b4875000001d5-1474378568.845861-760121704', '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 06:36:45 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 06:36:45 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 06:36:45 INFO - Using env: {'DISPLAY': ':0', 06:36:45 INFO - 'HOME': '/home/cltbld', 06:36:45 INFO - 'LANG': 'en_US.UTF-8', 06:36:45 INFO - 'LANGUAGE': 'en_US:en', 06:36:45 INFO - 'LOGNAME': 'cltbld', 06:36:45 INFO - 'MAIL': '/var/mail/cltbld', 06:36:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:36:45 INFO - 'MOZ_NO_REMOTE': '1', 06:36:45 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:36:45 INFO - 'NO_EM_RESTART': '1', 06:36:45 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:36:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:36:45 INFO - 'PWD': '/builds/slave/test', 06:36:45 INFO - 'SHELL': '/bin/bash', 06:36:45 INFO - 'SHLVL': '1', 06:36:45 INFO - 'TERM': 'linux', 06:36:45 INFO - 'TMOUT': '86400', 06:36:45 INFO - 'USER': 'cltbld', 06:36:45 INFO - 'XDG_SESSION_COOKIE': '826874ccc97bd7bf541b4875000001d5-1474378568.845861-760121704', 06:36:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:36:45 INFO - '_': '/tools/buildbot/bin/python'} 06:36:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:36:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 06:36:45 INFO - Running setup.py (path:/tmp/pip-EDGNdg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 06:36:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 06:36:45 INFO - Running setup.py (path:/tmp/pip-c9VklW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 06:36:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 06:36:45 INFO - Running setup.py (path:/tmp/pip-cZOpfc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 06:36:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 06:36:45 INFO - Running setup.py (path:/tmp/pip-STPlWM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 06:36:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 06:36:45 INFO - Running setup.py (path:/tmp/pip-PtEDQW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 06:36:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 06:36:45 INFO - Running setup.py (path:/tmp/pip-q_49QA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 06:36:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 06:36:45 INFO - Running setup.py (path:/tmp/pip-30KAo5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 06:36:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 06:36:46 INFO - Running setup.py (path:/tmp/pip-AzC9wJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 06:36:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 06:36:46 INFO - Running setup.py (path:/tmp/pip-LZDRwe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 06:36:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 06:36:46 INFO - Running setup.py (path:/tmp/pip-4q8Ovh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 06:36:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 06:36:46 INFO - Running setup.py (path:/tmp/pip-yRuQp0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 06:36:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 06:36:46 INFO - Running setup.py (path:/tmp/pip-FORpXO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 06:36:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 06:36:46 INFO - Running setup.py (path:/tmp/pip-0ockCS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 06:36:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 06:36:46 INFO - Running setup.py (path:/tmp/pip-TH0kyU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 06:36:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 06:36:46 INFO - Running setup.py (path:/tmp/pip-z7p1kM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 06:36:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 06:36:46 INFO - Running setup.py (path:/tmp/pip-aYytee-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 06:36:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 06:36:46 INFO - Running setup.py (path:/tmp/pip-nWx5W5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 06:36:46 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 06:36:46 INFO - Running setup.py install for manifestparser 06:36:46 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 06:36:46 INFO - Running setup.py install for mozcrash 06:36:46 INFO - Running setup.py install for mozdebug 06:36:47 INFO - Running setup.py install for mozdevice 06:36:47 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 06:36:47 INFO - Installing dm script to /builds/slave/test/build/venv/bin 06:36:47 INFO - Running setup.py install for mozfile 06:36:47 INFO - Running setup.py install for mozhttpd 06:36:47 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 06:36:47 INFO - Running setup.py install for mozinfo 06:36:47 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 06:36:47 INFO - Running setup.py install for mozInstall 06:36:47 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 06:36:47 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 06:36:47 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 06:36:47 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 06:36:47 INFO - Running setup.py install for mozleak 06:36:47 INFO - Running setup.py install for mozlog 06:36:47 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 06:36:47 INFO - Running setup.py install for moznetwork 06:36:47 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 06:36:47 INFO - Running setup.py install for mozprocess 06:36:48 INFO - Running setup.py install for mozprofile 06:36:48 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 06:36:48 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 06:36:48 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 06:36:48 INFO - Running setup.py install for mozrunner 06:36:48 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 06:36:48 INFO - Running setup.py install for mozscreenshot 06:36:48 INFO - Running setup.py install for moztest 06:36:48 INFO - Running setup.py install for mozversion 06:36:48 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 06:36:48 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 06:36:48 INFO - Cleaning up... 06:36:48 INFO - Return code: 0 06:36:48 INFO - Installing None into virtualenv /builds/slave/test/build/venv 06:36:48 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')]} 06:36:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:36:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:36:48 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')]} 06:36:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:36:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:36:48 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 0xeb2030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10158a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10e1400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1170570>, '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 0x1171470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1171900>, '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': '826874ccc97bd7bf541b4875000001d5-1474378568.845861-760121704', '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 06:36:48 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 06:36:48 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 06:36:48 INFO - Using env: {'DISPLAY': ':0', 06:36:48 INFO - 'HOME': '/home/cltbld', 06:36:48 INFO - 'LANG': 'en_US.UTF-8', 06:36:48 INFO - 'LANGUAGE': 'en_US:en', 06:36:48 INFO - 'LOGNAME': 'cltbld', 06:36:48 INFO - 'MAIL': '/var/mail/cltbld', 06:36:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:36:48 INFO - 'MOZ_NO_REMOTE': '1', 06:36:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:36:48 INFO - 'NO_EM_RESTART': '1', 06:36:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:36:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:36:48 INFO - 'PWD': '/builds/slave/test', 06:36:48 INFO - 'SHELL': '/bin/bash', 06:36:48 INFO - 'SHLVL': '1', 06:36:48 INFO - 'TERM': 'linux', 06:36:48 INFO - 'TMOUT': '86400', 06:36:48 INFO - 'USER': 'cltbld', 06:36:48 INFO - 'XDG_SESSION_COOKIE': '826874ccc97bd7bf541b4875000001d5-1474378568.845861-760121704', 06:36:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:36:48 INFO - '_': '/tools/buildbot/bin/python'} 06:36:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:36:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 06:36:48 INFO - Running setup.py (path:/tmp/pip-Gtm_k0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 06:36:48 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)) 06:36:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 06:36:48 INFO - Running setup.py (path:/tmp/pip-A3CWPh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 06:36:48 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)) 06:36:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 06:36:48 INFO - Running setup.py (path:/tmp/pip-RivAUw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 06:36:49 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)) 06:36:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 06:36:49 INFO - Running setup.py (path:/tmp/pip-dIsN4_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 06:36:49 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)) 06:36:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 06:36:49 INFO - Running setup.py (path:/tmp/pip-63pXJM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 06:36:49 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)) 06:36:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 06:36:49 INFO - Running setup.py (path:/tmp/pip-TEPlXV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 06:36:49 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)) 06:36:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 06:36:49 INFO - Running setup.py (path:/tmp/pip-WreCuR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 06:36:49 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)) 06:36:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 06:36:49 INFO - Running setup.py (path:/tmp/pip-Nn1GkM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 06:36:49 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)) 06:36:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 06:36:49 INFO - Running setup.py (path:/tmp/pip-zU6bkI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 06:36:49 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)) 06:36:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 06:36:49 INFO - Running setup.py (path:/tmp/pip-VgcwI9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 06:36:49 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)) 06:36:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 06:36:49 INFO - Running setup.py (path:/tmp/pip-XFIMmy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 06:36:49 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)) 06:36:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 06:36:49 INFO - Running setup.py (path:/tmp/pip-fk8Bmw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 06:36:49 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)) 06:36:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 06:36:49 INFO - Running setup.py (path:/tmp/pip-uUELxk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 06:36:49 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)) 06:36:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 06:36:49 INFO - Running setup.py (path:/tmp/pip-ITZ8nt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 06:36:49 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)) 06:36:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 06:36:49 INFO - Running setup.py (path:/tmp/pip-osbWRo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 06:36:49 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)) 06:36:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 06:36:49 INFO - Running setup.py (path:/tmp/pip-1anHm8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 06:36:49 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)) 06:36:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 06:36:50 INFO - Running setup.py (path:/tmp/pip-MZYfx1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 06:36:50 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)) 06:36:50 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)) 06:36:50 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)) 06:36:50 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)) 06:36:50 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)) 06:36:50 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)) 06:36:50 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.3->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 06:36:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:36:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:36:50 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:36:50 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:36:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:36:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:36:51 INFO - Downloading blessings-1.6.tar.gz 06:36:51 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 06:36:52 INFO - Installing collected packages: blessings 06:36:52 INFO - Running setup.py install for blessings 06:36:52 INFO - Successfully installed blessings 06:36:52 INFO - Cleaning up... 06:36:52 INFO - Return code: 0 06:36:52 INFO - Done creating virtualenv /builds/slave/test/build/venv. 06:36:52 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 06:36:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 06:36:52 INFO - Reading from file tmpfile_stdout 06:36:52 INFO - Current package versions: 06:36:52 INFO - argparse == 1.2.1 06:36:52 INFO - blessings == 1.6 06:36:52 INFO - blobuploader == 1.2.4 06:36:52 INFO - docopt == 0.6.1 06:36:52 INFO - functools32 == 3.2.3-2 06:36:52 INFO - jsonschema == 2.5.1 06:36:52 INFO - manifestparser == 1.1 06:36:52 INFO - mozInstall == 1.12 06:36:52 INFO - mozcrash == 0.17 06:36:52 INFO - mozdebug == 0.1 06:36:52 INFO - mozdevice == 0.48 06:36:52 INFO - mozfile == 1.2 06:36:52 INFO - mozhttpd == 0.7 06:36:52 INFO - mozinfo == 0.9 06:36:52 INFO - mozleak == 0.1 06:36:52 INFO - mozlog == 3.3 06:36:52 INFO - moznetwork == 0.27 06:36:52 INFO - mozprocess == 0.23 06:36:52 INFO - mozprofile == 0.28 06:36:52 INFO - mozrunner == 6.12 06:36:52 INFO - mozscreenshot == 0.1 06:36:52 INFO - mozsystemmonitor == 0.3 06:36:52 INFO - moztest == 0.7 06:36:52 INFO - mozversion == 1.4 06:36:52 INFO - psutil == 3.1.1 06:36:52 INFO - requests == 1.2.3 06:36:52 INFO - wsgiref == 0.1.2 06:36:52 INFO - Installing None into virtualenv /builds/slave/test/build/venv 06:36:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:36:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:36:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:36:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:36:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:36:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:36:52 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 0xeb2030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10158a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10e1400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1170570>, '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 0x1171470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1171900>, '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': '826874ccc97bd7bf541b4875000001d5-1474378568.845861-760121704', '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 06:36:52 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 06:36:52 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 06:36:52 INFO - Using env: {'DISPLAY': ':0', 06:36:52 INFO - 'HOME': '/home/cltbld', 06:36:52 INFO - 'LANG': 'en_US.UTF-8', 06:36:52 INFO - 'LANGUAGE': 'en_US:en', 06:36:52 INFO - 'LOGNAME': 'cltbld', 06:36:52 INFO - 'MAIL': '/var/mail/cltbld', 06:36:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:36:52 INFO - 'MOZ_NO_REMOTE': '1', 06:36:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:36:52 INFO - 'NO_EM_RESTART': '1', 06:36:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:36:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:36:52 INFO - 'PWD': '/builds/slave/test', 06:36:52 INFO - 'SHELL': '/bin/bash', 06:36:52 INFO - 'SHLVL': '1', 06:36:52 INFO - 'TERM': 'linux', 06:36:52 INFO - 'TMOUT': '86400', 06:36:52 INFO - 'USER': 'cltbld', 06:36:52 INFO - 'XDG_SESSION_COOKIE': '826874ccc97bd7bf541b4875000001d5-1474378568.845861-760121704', 06:36:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:36:52 INFO - '_': '/tools/buildbot/bin/python'} 06:36:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:36:52 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)) 06:36:52 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)) 06:36:52 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)) 06:36:52 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)) 06:36:52 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)) 06:36:52 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)) 06:36:52 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)) 06:36:52 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)) 06:36:52 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)) 06:36:52 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)) 06:36:52 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)) 06:36:52 INFO - Cleaning up... 06:36:52 INFO - Return code: 0 06:36:52 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 06:36:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:36:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:36:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:36:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:36:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:36:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:36:52 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xeb2030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10158a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10e1400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1170570>, '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 0x1171470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1171900>, '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': '826874ccc97bd7bf541b4875000001d5-1474378568.845861-760121704', '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 06:36:52 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 06:36:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 06:36:52 INFO - Using env: {'DISPLAY': ':0', 06:36:52 INFO - 'HOME': '/home/cltbld', 06:36:52 INFO - 'LANG': 'en_US.UTF-8', 06:36:52 INFO - 'LANGUAGE': 'en_US:en', 06:36:52 INFO - 'LOGNAME': 'cltbld', 06:36:52 INFO - 'MAIL': '/var/mail/cltbld', 06:36:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:36:52 INFO - 'MOZ_NO_REMOTE': '1', 06:36:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:36:52 INFO - 'NO_EM_RESTART': '1', 06:36:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:36:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:36:52 INFO - 'PWD': '/builds/slave/test', 06:36:52 INFO - 'SHELL': '/bin/bash', 06:36:52 INFO - 'SHLVL': '1', 06:36:52 INFO - 'TERM': 'linux', 06:36:52 INFO - 'TMOUT': '86400', 06:36:52 INFO - 'USER': 'cltbld', 06:36:52 INFO - 'XDG_SESSION_COOKIE': '826874ccc97bd7bf541b4875000001d5-1474378568.845861-760121704', 06:36:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:36:52 INFO - '_': '/tools/buildbot/bin/python'} 06:36:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:36:52 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 06:36:52 INFO - Cleaning up... 06:36:52 INFO - Return code: 0 06:36:52 INFO - Running post-action listener: _resource_record_post_action 06:36:52 INFO - Running post-action listener: _start_resource_monitoring 06:36:52 INFO - Starting resource monitoring. 06:36:52 INFO - [mozharness: 2016-09-20 13:36:52.981587Z] Finished create-virtualenv step (success) 06:36:52 INFO - [mozharness: 2016-09-20 13:36:52.982008Z] Running install step. 06:36:52 INFO - Running pre-action listener: _resource_record_pre_action 06:36:52 INFO - Running main action method: install 06:36:52 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 06:36:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 06:36:53 INFO - Reading from file tmpfile_stdout 06:36:53 INFO - Detecting whether we're running mozinstall >=1.0... 06:36:53 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 06:36:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 06:36:53 INFO - Reading from file tmpfile_stdout 06:36:53 INFO - Output received: 06:36:53 INFO - Usage: mozinstall [options] installer 06:36:53 INFO - Options: 06:36:53 INFO - -h, --help show this help message and exit 06:36:53 INFO - -d DEST, --destination=DEST 06:36:53 INFO - Directory to install application into. [default: 06:36:53 INFO - "/builds/slave/test"] 06:36:53 INFO - --app=APP Application being installed. [default: firefox] 06:36:53 INFO - mkdir: /builds/slave/test/build/application 06:36:53 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'] 06:36:53 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 06:37:10 INFO - Reading from file tmpfile_stdout 06:37:10 INFO - Output received: 06:37:10 INFO - /builds/slave/test/build/application/firefox/firefox 06:37:10 INFO - Running post-action listener: _resource_record_post_action 06:37:10 INFO - [mozharness: 2016-09-20 13:37:10.126846Z] Finished install step (success) 06:37:10 INFO - [mozharness: 2016-09-20 13:37:10.127200Z] Running run-tests step. 06:37:10 INFO - Running pre-action listener: _resource_record_pre_action 06:37:10 INFO - Running main action method: run_tests 06:37:10 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 06:37:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 06:37:10 INFO - Python 2.7.3 06:37:10 INFO - Return code: 0 06:37:10 INFO - grabbing minidump binary from tooltool 06:37:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:37:10 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 0x1170570>, '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 0x1171470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1171900>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 06:37:10 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 06:37:10 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 06:37:10 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 06:37:10 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 06:37:10 INFO - Return code: 0 06:37:10 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 06:37:10 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 06:37:10 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 06:37:10 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 06:37:10 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 06:37:10 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Inbound', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1474362899/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-052', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 06:37:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Inbound --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1474362899/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-052 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 06:37:10 INFO - Using env: {'DISPLAY': ':0', 06:37:10 INFO - 'HOME': '/home/cltbld', 06:37:10 INFO - 'LANG': 'en_US.UTF-8', 06:37:10 INFO - 'LANGUAGE': 'en_US:en', 06:37:10 INFO - 'LOGNAME': 'cltbld', 06:37:10 INFO - 'MAIL': '/var/mail/cltbld', 06:37:10 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 06:37:10 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 06:37:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:37:10 INFO - 'MOZ_NO_REMOTE': '1', 06:37:10 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 06:37:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:37:10 INFO - 'NO_EM_RESTART': '1', 06:37:10 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:37:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:37:10 INFO - 'PWD': '/builds/slave/test', 06:37:10 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 06:37:10 INFO - 'SHELL': '/bin/bash', 06:37:10 INFO - 'SHLVL': '1', 06:37:10 INFO - 'TERM': 'linux', 06:37:10 INFO - 'TMOUT': '86400', 06:37:10 INFO - 'USER': 'cltbld', 06:37:10 INFO - 'XDG_SESSION_COOKIE': '826874ccc97bd7bf541b4875000001d5-1474378568.845861-760121704', 06:37:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:37:10 INFO - '_': '/tools/buildbot/bin/python'} 06:37:10 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Inbound', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1474362899/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-052', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 06:37:10 INFO - mozversion application_buildid: 20160920021459 06:37:10 INFO - mozversion application_changeset: a02925fe4ded04e2f5523fbd7e5ddfa46b190d39 06:37:10 INFO - mozversion application_display_name: Nightly 06:37:10 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 06:37:10 INFO - mozversion application_name: Firefox 06:37:10 INFO - mozversion application_remotingname: firefox 06:37:10 INFO - mozversion application_repository: https://hg.mozilla.org/integration/mozilla-inbound 06:37:10 INFO - mozversion application_vendor: Mozilla 06:37:10 INFO - mozversion application_version: 51.0a1 06:37:10 INFO - mozversion platform_buildid: 20160920021459 06:37:10 INFO - mozversion platform_changeset: a02925fe4ded04e2f5523fbd7e5ddfa46b190d39 06:37:10 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/mozilla-inbound 06:37:10 INFO - mozversion platform_version: 51.0a1 06:37:10 INFO - using testdate: 1474378630 06:37:10 INFO - actual date: 1474378630 06:37:10 INFO - starting webserver on 'localhost:40286' 06:37:10 INFO - SUITE-START | Running 2 tests 06:37:10 INFO - TEST-START | dromaeo_css 06:37:10 INFO - operating with platform_type : linux_ 06:37:10 INFO - Initialising browser for dromaeo_css test... 06:37:10 INFO - TEST-INFO | started process 3288 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpx9FcbI/profile http://localhost:40286/getInfo.html) 06:37:17 INFO - PROCESS | 3288 | __metrics Screen width/height:1600/1200 06:37:17 INFO - PROCESS | 3288 | colorDepth:24 06:37:17 INFO - PROCESS | 3288 | Browser inner width/height: 1024/697 06:37:17 INFO - PROCESS | 3288 | __metrics 06:37:17 ERROR - PROCESS | 3288 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2968: TypeError: this.tabs is undefined 06:37:18 INFO - TEST-INFO | 3288: exit 0 06:37:18 INFO - Browser initialized. 06:37:18 INFO - Running cycle 1/1 for dromaeo_css test... 06:37:18 INFO - TEST-INFO | started process 3409 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpx9FcbI/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 06:37:30 INFO - PROCESS | 3409 | RSS: Main: 163512320 06:37:30 INFO - PROCESS | 3409 | 06:38:19 INFO - PROCESS | 3409 | 1474378699941 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] 06:40:29 INFO - PROCESS | 3409 | Cycle 1(1): loaded http://localhost:40286/tests/dromaeo/cssquery-dojo.html (next: http://localhost:40286/tests/dromaeo/cssquery-ext.html) 06:40:30 INFO - PROCESS | 3409 | RSS: Main: 169308160 06:40:30 INFO - PROCESS | 3409 | 06:43:32 INFO - PROCESS | 3409 | Cycle 1(1): loaded http://localhost:40286/tests/dromaeo/cssquery-ext.html (next: http://localhost:40286/tests/dromaeo/cssquery-jquery.html) 06:43:33 INFO - PROCESS | 3409 | RSS: Main: 166760448 06:43:33 INFO - PROCESS | 3409 | 06:46:35 INFO - PROCESS | 3409 | Cycle 1(1): loaded http://localhost:40286/tests/dromaeo/cssquery-jquery.html (next: http://localhost:40286/tests/dromaeo/cssquery-mootools.html) 06:46:35 INFO - PROCESS | 3409 | RSS: Main: 169852928 06:46:35 INFO - PROCESS | 3409 | 06:49:37 INFO - PROCESS | 3409 | Cycle 1(1): loaded http://localhost:40286/tests/dromaeo/cssquery-mootools.html (next: http://localhost:40286/tests/dromaeo/cssquery-prototype.html) 06:49:38 INFO - PROCESS | 3409 | RSS: Main: 164622336 06:49:38 INFO - PROCESS | 3409 | 06:52:40 INFO - PROCESS | 3409 | Cycle 1(1): loaded http://localhost:40286/tests/dromaeo/cssquery-prototype.html (next: http://localhost:40286/tests/dromaeo/cssquery-yui.html) 06:52:41 INFO - PROCESS | 3409 | RSS: Main: 167043072 06:52:41 INFO - PROCESS | 3409 | 06:55:44 INFO - PROCESS | 3409 | Cycle 1(1): loaded http://localhost:40286/tests/dromaeo/cssquery-yui.html (next: http://localhost:40286/tests/dromaeo/cssquery-dojo.html) 06:55:44 INFO - PROCESS | 3409 | RSS: Main: 170336256 06:55:44 INFO - PROCESS | 3409 | 06:55:44 INFO - PROCESS | 3409 | __start_tp_report 06:55:44 INFO - PROCESS | 3409 | _x_x_mozilla_page_load 06:55:44 INFO - PROCESS | 3409 | _x_x_mozilla_page_load_details 06:55:44 INFO - PROCESS | 3409 | |i|pagename|runs| 06:55:44 INFO - PROCESS | 3409 | |0;dojo.html;3063.785535012549;3081.861316240769;3084.5373194020895;3103.4103520331137;3108.75129989601;5318.308619879415;5362.839114826552;5369.087255166616;5415.241866138744;5423.620346575742;5259.474052594748;5330;5340.866478338044;5343.251944727741;5443.972780136104;4864.391951006133;4952.851414457572;4970.179920313144;5005.749712514378;5040.269160971675;4949.059678661061;4977.178765503688;4996.4503904570465;5049.621278404116;5060.418051924021;4722.291656251556;4784.091022705675;4873.6832105913;4919.065377578248;4937.0125974805005;4823;4890.535399137112;4908.730019848943;4938.987507560977;4940.950590494085;4818.204996175627;4857.975710121462;4873.220284754422;4876.683015603974;4898.975505122487;5197.324347834758;5203.739813009334;5291.57667386612;5328.254044433782;5384.380796208407;5563.860903477405;5664.376918538998;5667.603267771257;5676.517496012844;5677.659340439545;5685.260916080924;5690.687012214326;5694.800681976111;5695.5443564514735;5699.031164702011;5216.035033518811;5315.627906046579;5321.760520776575;5324.687003527155;5353.598480114007;5863.413658634187;5921.851953701106;5926.585139040312;5968.940310596925;5976.760929562769;5679.801206957819;5682.659040457585;5696.401877802854;5696.572757043238;5697.971510142505;5505.889882202334;5610.046292130348;5769.336526299446;5776.740046697909;5782.190493330937;5614.606977511535;5648.926703926241;5651.0675738503505;5721.828345149652;5724.484796368347;5642.322921249476;5665.348484924204;5681.829545113653;5684.687342196219;5701.116326969326;4281.357796330513;4282.6359759420175;4362.563743625612;4373.147236288957;4408.889777755582;3856.7685938843197;3885.048163200034;3928.273269445162;3935.6064393560414;3947.0921688011917;5428.212909128154;5428.647137936022;5465.344158700902;5470.480304371078;5474.124140137559;5565.276514053228;5648.717564121777;5710.942890571041;5712.257406537124;5714.971425142848;5390.757415916293;5419.34967803866;5444.754986025639;5463.3717122530625;5469.726513674301;4870.220764677634;4873.951260487421;4878.170710979071;4879.682820616648;4891.755412229374;5816.767329306865;5878.735456904535;5909.2908850938165;5917.55618328627;5930;5703.971480142573;5749.195112684311;5753.482186603226;5801.82594522165;5807.448292412214;5918.112283157561;5955.315138759098;5956.225690660186;5967.6419414835245;5970.134330522137;5418.458154184707;5607.271054762855;5615.747291371817;5643.068893632505;5648.322201335866;5784.190213370048;5816.563757718272;5825.300963884191;5831.4168583141345;5877.794277200449;5632.85917852057;5636.661800291996;5646.463585959327;5665.66006039639;5681.346645135697;5320.866978325418;5547.389787123494;5583.8883222336135;5615.7192140392;5624.606277560695;5527.723613819373;5557.3331200256225;5577.219189313419;5593.0491816390495;5628.774849005994;5634.464725851038;5651.491365777099;5702.971485142548;5708.743106560131;5719.142128680731;5341.7062061586985;5428.728563571726;5459.071957767269;5546.667199968015;5563.221149039218 06:55:44 INFO - PROCESS | 3409 | |1;ext.html;543.7159883543185;585.7715490958524;592.2212290837548;596.8209537138858;607.7447472061733;38056.42915356268;42366.57633423665;42367.15265694684;42421;42439.15121697564;42662.36006459906;43004.13991720164;43120.353194702104;43159.78420107903;43200;8749.16882896124;8835.602397892078;8861.379703420764;8883.689070882521;8889.066648001964;8811.867821982676;8877.245434138074;8923.330750193729;8925.509096999662;8933.64265429382;8929;8931.821363572724;8940.15068568485;8981.101889811032;8984.371094023389;8886.644534218623;8906.821863562725;8915.063918288552;8934.017258101636;8975.775605609846;8762.86855697165;8800.515971621558;8832.8675069874;8833.558322083934;8838.29293656506;40423.7978810104;40464.79767601172;40664.796676016726;40743.7962810187;40874.38688419676;3716.888493345204;3801.8479260829536;3838.481804956351;3938.940915886264;4346.239408103601;32508.349833003445;32524;33045.6695433045;33151.502727459105;34373.6562634373;4178.895527611804;4290.785460726951;4388.517263101056;4416.160929423431;4456.977715111404;359318;360108;360310;360478;360557;58791.70604146952;58954.41045589489;59522;59597;59630.40369596335;35933.8203308987;37217.81391093027;37270.25459490849;63022.36977630257;63246;15295.770563441558;15360.692786144438;15365.231738413035;15379.46171884001;15385.615359616098;13364.39860206293;13425.395857186255;13442.126261792951;13443.193408395528;13474.191548506926;19211.32760353381;19311.806881931283;19332.4200273992;19354.70967935454;19457.318993835146;7059.18819335783;7066.258042905523;7344.522606030591;7422.888656670154;7438.66526006331;973.3916302311055;1026.0662796854976;1111.4942701070993;1117.6032508459543;1132.1678566253797;33166;33400;33522.47319414502;33553.496697549555;33884.83057584745;1110.622388387952;1130.9434528273553;1139.7093741095966;1146.4439746722833;1162.581470670558;17264.309427622753;17468.47594572165;17612.559686007953;17638.294468221127;17704.734428983575;559074;561282;562720;563571;564661;58341;58650.12024819631;58896.41103588995;59038.70480647569;59122.704386477795;1336.4988129451456;1343.4693296147966;1350.952716654932;1357.2942070123481;1398.6433459467974;30881.227969300948;31655.683443166196;32578.348433031682;32904.177395565304;33100.83449582737;50537.74731126321;50627;50634;50705;50879.131317273175;422250;422340.4361694652;423142;423507;425436;28475.145745627666;28764.137075887757;28875.133745987652;28983.275418114717;29172.124836254945;47760;47984;48916.75541622269;49258.50741492539;49862.750686246334;39604.96782881893;40609.79695101624;40969.59030409658;41121;42591.7870410646;40596;41038.589614103475;41183.58816411797;41882.1623567533;42101;35480.82259588686;40493.39259911163;40667.1866562673;40719.796401017804;41504.37743433911;34859.30281394409;36423.81788091043;37188.81405593063;37211;37738;28472;28647;28854.711452885203;28974.565381519715;28979.710202897702 06:55:44 INFO - PROCESS | 3409 | |2;jquery.html;385.22954091816365;388.25842640556505;398.6770715720267;399.74416373520944;420.5605142625956;13724.313784310769;18000.369987050457;19266.51833704158;19706.605867882652;19734.70397944032;18710.62578748424;18928.62142757144;19067.332643357484;19687.5078123047;19933.302334418262;5521.723913804293;5746.48281654651;5776.335721392041;5793.4206579341935;5962.522998160159;5800.941990580103;5847.473727364536;5854.912176317359;5891.469767720904;5895.764169433218;5822.563307751914;5862.472377486026;5871.941280587203;5879.32387775407;5879.382664820197;5801.883962320751;5802.82591522255;5820.796272130477;5840.912386314209;5865.530757539386;5612.214289999403;5632.183333416631;5797.855053623651;5873.2658417697785;5879.823605291848;14157.929210353985;14441.35013924376;14488.782668259984;25711.48577028468;26226.475470490674;2522.659440975463;2573.4724381501933;2743.917682469529;3023.516237402027;3267.722243609296;14921;15552.688946221126;16121.596960075974;16594.50216493495;16626.83373166265;2018.2229841510978;2064.421961850684;2155.7628660847295;2211.8562293450873;2254.6730724044924;89820.71255012152;91433.08566914313;91889;94093;94321;17498.737518937225;17694.29222831098;17934.641307173784;17989.460316190536;18281.521027348386;31291.843540782607;31755.841220793747;31897.681023189936;31975.840120799247;32169;9877.40735555869;10129.392236465836;10129.797404051878;10142;10416.531256093494;8288.254057134887;8403;8424.53665048416;8654.740357789276;8655.870161947576;8582.313414926792;9024.458532488072;9059.773505662411;9061.818763624822;9112.8633070504;3348.68187522185;3412.914677133042;3436.879709210166;3534.6995505381815;3660.743747937619;874.4884242718081;1001.6544292219173;1040.2926010312908;1084.9620263290747;1106.181425744943;19862.54567781404;20158.496037599176;20228.29200977988;20298.391048268575;20455.4886127848;995.4624502768424;995.6166875752888;1012.3520946594039;1020.6172685243034;1025.3437799808128;10646.520906559068;11085.560937164919;11200.943995280135;11215.775684486265;11247.268927519684;492809;493991;494277;501213;506318;88558;88868;90227;91240.54379728192;94213.5289323549;1002.2633364477249;1014.6144465103362;1025.702546261576;1032.6540608895955;1043.6712435582767;16503;16778;17541.298348065935;17997.820021799613;18208.81791182071;28744.71255287504;32891.67108328982;36867.26265474729;41705.58294417017;43317.13365732731;56379;56717.14924276056;59021.409785903306;59209.40790592211;59835;7772.92227077722;8021.077576078826;8755.605997730245;8902.065283145435;8933.419327743675;13352.799708004582;13674.042817003112;13721.794173087212;13834.446622135001;13843.307834608431;11872.584459543874;11938.820917686067;12119.333436661069;12264;12297;11822.40887955616;11966.521339146684;11987.820182697442;12077.939610301892;12181.634550963485;11822.940885295518;11928.1053920958;11962.641120766391;12352.197107188003;12356;8061.113277539584;8253.215944485264;8326.25063744266;8339.749807505785;8360.12218717026;11627.244229125079;11846;11876.643700688994;11975.64073077809;12433.93783031079 06:55:44 INFO - PROCESS | 3409 | |3;mootools.html;1462.1592584264044;1463.341496326653;1564.4759005733079;1734.0636056529474;1739.2521215877175;7284.854302913938;7661.770146895588;7916.564588947613;8497.490150590962;8504;7936;7976.680932762697;7995.800104997378;8006.319462845665;8012.519248845073;2320.396696858816;2322.7677232276806;2328.1153161798493;2337.6026075567192;2341.695579574653;2223.288547664748;2263.581237471073;2277.464795772992;2282.6005449046434;2285.885705714716;2258.8080013198896;2261.5589959957815;2282.3951652811934;2367.988160059197;2370.3718514593647;2243.5064285857084;2271.5002699406023;2276.146445083094;2276.6243569811045;2277.555876604063;2187.671849222613;2205.162038425388;2209.591225623265;2215.069670738294;2223.021870377045;8102;8123.553204573746;8164.1427650096475;8166.142555031695;8168.67325306987;4912.5578697917;5065.316182315414;5124.026434977342;5138.794448222066;5143.357080364917;3049.9390012199856;3083.953740693891;3206.601002936871;3239.8866039688496;3254.495553189259;1048.7325731938306;1093.1582681335408;1093.2456604942565;1105.7125147461638;1110.3726394587113;11597.130215233807;11643.35961522116;11704.18070735049;11708.180427370002;11716.297022178696;4316.676249281317;4385.7149285296355;4561.908761824811;4572.74849883253;4588.564086411786;9721.076497732704;9783.119519243302;9785.559649815776;9791.069848364394;9795.21638268951;4872.098661747517;4945.579625731853;4955.058538877602;4960.454350021495;4967.4784147664695;4132.5454200037975;4567.657425693086;4579.427571553556;4684.4378674559275;4709.246520556694;3739.8691045813266;3910.9608903911167;3942.6648734857285;3954.6440820326306;4040.2929487340184;1257.4718618180386;1263.8420197475316;1264.2667252993242;1269.6508460173527;1276.8850803427736;938.6526985015452;939.9436033837854;945.9716208513755;949.0437287848303;981.9459929703792;5590.385057643656;5693.202951586781;5693.743781529841;5806.21616081832;5907.940920590825;432.47886297012025;439.936209249657;455.13978580482916;460.0890237330105;460.49115727121716;3754.3805272129794;3920.921581568353;3961.6830653547645;3968.5634580196156;4018.2767101921936;10030.598776049022;10486.318389304823;10490.475476226158;10502.947485262677;10527.052565269163;10087.646932357333;10161.441120738282;10264.435456049989;10326.690199294033;10367.9481602593;7820.335271501872;7845.215478452109;7914.208579142155;7981.600919953979;7993.72021979228;5528.087865502308;5537.086380747292;5560.777568897361;5583.497485226349;5718.399568045462;9622.422654640744;9640.373375730554;9666.661666841626;9723.756906077122;9754.951225244113;9323.580438880132;9589.328746987643;9719.46542940145;9731.367461115005;9882.654107106217;6727.966360168168;7219.891701624585;7330.340269375782;7430.7027718892805;7513.060867391576;7938.841223175619;8125.187481251827;8133.308668763221;8153.1846815317995;8158.469699469515;7513.1359893612935;7626.8855967159425;7662.885056724265;7741.496802707806;7747.883781743166;7322.487425880137;7326.230745771617;7344.96327518359;7463.216362282099;7564.848703025798;6549.181352330958;6701.731930722912;6702.731890724512;6707;6724.865502689821;4919.754012299442;4947.802087916443;5000;5099.490050994871;5116.846494605168;4814.855554333376;4933.58064564516;4983.775730092227;5001.499850015115;5071.695698257969 06:55:44 INFO - PROCESS | 3409 | |4;prototype.html;331.2199769542727;338.8813915129705;339.4229809324148;343.8126221209441;344.9655034496552;5305.408377486749;5437.728113594324;5491.286132802735;5568.192612071252;5572.888542229153;5456.672599644025;5478.822053258548;5488.106603221882;5526.281583394163;5537.224788529609;4282.2656823986335;4295.7852107394665;4311.762853043081;4317.978410107945;4334.436523251973;4176.4893914572185;4259.318509038554;4279.2083464559;4315.525292217853;4330.545292744264;4228.386883901832;4232.195882782277;4236.322188449849;4244.511881133678;4253.893652658693;4251.4685664291965;4253.341196933198;4257.46781652295;4272.46594175728;4277.887749185204;3674.8713795017316;3768.679662228714;3776.490173826553;3786.8863934082024;3796.54441467023;5268.973655131738;5310.522053015247;5319.521243088141;5329.760160792774;5353.411124776271;4853.107288157621;4880.463149053601;4884.29177769225;4889.899772551147;4895.8776030599165;5539.833804985857;5703.207367100873;5705.4579814917515;5729.828105156852;5742.569307301969;4054.959450405517;4069.47096877407;4072.165206132736;4101.425800387948;4116.435754413334;6007.279126504804;6014.51883849291;6028.306744724369;6047;6057.757689692451;3985.4021896715726;4147.087640719037;4204.936925946114;4215.515215750228;4228.365745138254;4200.600942910419;4210.7473551587;4216.156768646221;4231.576842315744;4234.809433575497;4826.203676393426;4845.515448455127;4853.781579828917;4865.537773911473;4885.364902562644;5703.800366987219;5785.971070144707;5791.82624521265;5814.244148260699;5817.807349493343;1439.79842822005;1466.3694611317023;1466.4061055272632;1468.9779653305209;1469.632591852037;923.4828496042238;950.5199874063553;966.4008314844841;979.1383582447401;983.1790454970037;4840.201366774513;4874.53691899269;4885.949520853033;4947.579455746302;4968.310774336743;5186.481351864859;5187.714675692798;5249.763760630781;5263.184206448007;5315.760790764425;4653.278741795028;4895.6083513318845;4970.577500912391;4975.303457515951;5023.673461225008;2734.9589756153673;2746.807723459339;2772.9029483967965;2773.611694362791;2775.613751223504;5334.759935802898;5344.706041167773;5354.544863686552;5355.892882142413;5400.270963419966;5201.323827902348;5215.452377500308;5582.748776305076;6053.3946605339115;6063.6664983426335;6198.318184999646;6198.6280823150755;6203.7828675997025;6207.006878899445;6221.222347206599;5676.318841738853;5948.13752005948;5970.880582388415;5978.970105149447;5995.340512543529;5914.6877748461;5927.762889484545;5942.316633587193;5952.8809423812145;5961.701914904324;6238.656873871981;6239.812805615838;6252.406021427957;6272.8118156455375;6317.684115794284;4032.314506533955;4149.37759336102;4172.645325147397;4194.2450358935685;4195.811188496586;5904.498117660047;5915.201447804663;5961.314448838266;6001.969990150196;6044;5612.382637909745;5785.942140578541;5821.563382746226;5828.708564571839;5846.152307915413;5696.686682232351;5701.263393571192;5724.370319264961;5734.197212390185;5755.079187330007;5698.287714035746;5700.515456186271;5750.166225897138;5770.480656740913;5794.623349482439;5578;5792.420757924174;5808.332041815245;5861.1501332307425;5865.736041878211;5653.575981801299;5659.292588426447;5659.717014149359;5683.8863222736145;5724.885502289848 06:55:44 INFO - PROCESS | 3409 | |5;yui.html;751.9436042296829;765.3876898481213;806.1293802693092;810.793247721831;841.9115992820757;15574.766378504317;16509;16527.256273467694;16589;16618.501444956655;14955;14981.625459363522;14984.475543355984;15011.699766004673;15014.549563513085;626.9592476489037;757.8976838126865;761.801931497809;774.3224678406394;787.4566549081144;773.880048592469;778.9182135875736;783.420269000941;783.4554984285895;785.0814546980047;837.736113124367;840.9285210757093;842.4481964313385;843.784834867108;844.1727107434717;837.196291560106;840.1052878684243;840.2689659995842;840.474703310431;841.9621117049717;616.3959319866556;616.4852348289139;616.5930485879343;617.4998251416322;617.9721912513947;14892.62768430787;15065.246737663074;15066.246687665682;15080.472183473526;15092.24538773068;14917.850821491755;14943;15061.849381506154;15181.924090379587;15340.769888451681;11621.128415368798;11627.767444651145;11657.825132623017;11691.941540292244;12217.511299548007;3835.9683007446847;3959.9604003960167;3974.225026119908;4026.7583944963394;4089.7955102245064;78894;81388.18611813807;82004;82032.58983705103;82453.58773206155;11520.711982200512;11557.826632600518;11574;11845.111616628616;11890.762184756257;23474;23492.530149396916;23510.059597615902;23516.29451116469;23665.526689466114;8786.384953053353;8802.955985220033;8916.242119419792;8954.23888969432;9204.171624553823;4712.64655150865;4712.81148754046;4847.200211965057;4917.754112294371;4935.7532123393685;3356.916077098092;3464.6362131976284;3486.337595856779;3487.982560087183;3494.7029502492574;586.4165155670136;595.1221947627301;610.7984365159487;612.5773216480703;618.2951435363689;567.4013915319296;716.2658275267892;726.3390314813599;726.6657337624646;734.2914087905198;9403.29475289356;9594.760130996781;9652.372595781393;9658.75853103664;9747.512624368754;711.164381851333;740.6889106575252;766.1227894061269;785.2775446589152;791.7466410748506;4444.066830928557;4595.9080818383445;4806.399200099988;4901.166801643729;4939.703617782944;123926;126493;126646;130175.34912325378;130207;110884.89115108908;114415;114739.42630286796;115543;115751.42124289325;55866.441335586125;83007.58496207601;93616;94912;95430.99999999862;9139.720439138393;9256.352055356061;9404.670836520689;9430.245580353418;9439.622415103593;55787.44212557822;56262;56369;56627;58329.70835145797;76245;81950.18049819426;82564;84339.5783021081;85043;12380.566680166512;12481.126321157431;12537.749245014866;12607.49570017189;13044.739105218032;13099.148555344253;13134.343282835629;13343.466261349437;13607;14035.789463158266;12787.424565894744;12819.230846149261;12887.548935787203;12908.935455322664;13618.86381136176;12847.807282890577;12867.356632168541;12942.731408374679;12988.870111299144;13014;12123.878761212627;12318.322492263012;12381.814272785736;12707.428165732379;12783;9857.802843942938;10287.948560257151;10402;10458.26792124544;10871.130309575374;8651.567421628768;9541.188998935168;10664.253502254767;10830.620928267474;10857.728556786144 06:55:44 INFO - PROCESS | 3409 | __end_tp_report 06:55:44 INFO - PROCESS | 3409 | __start_cc_report 06:55:44 INFO - PROCESS | 3409 | _x_x_mozilla_cycle_collect,343 06:55:44 INFO - PROCESS | 3409 | __end_cc_report 06:55:44 INFO - PROCESS | 3409 | __startTimestamp1474379744618__endTimestamp 06:55:44 INFO - PROCESS | 3409 | 06:55:44 INFO - PROCESS | 3409 | ------- Summary: start ------- 06:55:44 INFO - PROCESS | 3409 | Number of tests: 6 06:55:44 INFO - PROCESS | 3409 | 06:55:44 INFO - PROCESS | 3409 | [#0] dojo.html Cycles:165 Average:5321.72 Median:5546.67 stddev:604.11 (10.9%) stddev-sans-first:579.41 06:55:44 INFO - PROCESS | 3409 | Values: 3063.8 3081.9 3084.5 3103.4 3108.8 5318.3 5362.8 5369.1 5415.2 5423.6 5259.5 5330.0 5340.9 5343.3 5444.0 4864.4 4952.9 4970.2 5005.7 5040.3 4949.1 4977.2 4996.5 5049.6 5060.4 4722.3 4784.1 4873.7 4919.1 4937.0 4823.0 4890.5 4908.7 4939.0 4941.0 4818.2 4858.0 4873.2 4876.7 4899.0 5197.3 5203.7 5291.6 5328.3 5384.4 5563.9 5664.4 5667.6 5676.5 5677.7 5685.3 5690.7 5694.8 5695.5 5699.0 5216.0 5315.6 5321.8 5324.7 5353.6 5863.4 5921.9 5926.6 5968.9 5976.8 5679.8 5682.7 5696.4 5696.6 5698.0 5505.9 5610.0 5769.3 5776.7 5782.2 5614.6 5648.9 5651.1 5721.8 5724.5 5642.3 5665.3 5681.8 5684.7 5701.1 4281.4 4282.6 4362.6 4373.1 4408.9 3856.8 3885.0 3928.3 3935.6 3947.1 5428.2 5428.6 5465.3 5470.5 5474.1 5565.3 5648.7 5710.9 5712.3 5715.0 5390.8 5419.3 5444.8 5463.4 5469.7 4870.2 4874.0 4878.2 4879.7 4891.8 5816.8 5878.7 5909.3 5917.6 5930.0 5704.0 5749.2 5753.5 5801.8 5807.4 5918.1 5955.3 5956.2 5967.6 5970.1 5418.5 5607.3 5615.7 5643.1 5648.3 5784.2 5816.6 5825.3 5831.4 5877.8 5632.9 5636.7 5646.5 5665.7 5681.3 5320.9 5547.4 5583.9 5615.7 5624.6 5527.7 5557.3 5577.2 5593.0 5628.8 5634.5 5651.5 5703.0 5708.7 5719.1 5341.7 5428.7 5459.1 5546.7 5563.2 06:55:44 INFO - PROCESS | 3409 | 06:55:44 INFO - PROCESS | 3409 | [#1] ext.html Cycles:180 Average:60580.34 Median:41079.79 stddev:121137.10 (294.9%) stddev-sans-first:121393.05 06:55:44 INFO - PROCESS | 3409 | Values: 543.7 585.8 592.2 596.8 607.7 38056.4 42366.6 42367.2 42421.0 42439.2 42662.4 43004.1 43120.4 43159.8 43200.0 8749.2 8835.6 8861.4 8883.7 8889.1 8811.9 8877.2 8923.3 8925.5 8933.6 8929.0 8931.8 8940.2 8981.1 8984.4 8886.6 8906.8 8915.1 8934.0 8975.8 8762.9 8800.5 8832.9 8833.6 8838.3 40423.8 40464.8 40664.8 40743.8 40874.4 3716.9 3801.8 3838.5 3938.9 4346.2 32508.3 32524.0 33045.7 33151.5 34373.7 4178.9 4290.8 4388.5 4416.2 4457.0 359318.0 360108.0 360310.0 360478.0 360557.0 58791.7 58954.4 59522.0 59597.0 59630.4 35933.8 37217.8 37270.3 63022.4 63246.0 15295.8 15360.7 15365.2 15379.5 15385.6 13364.4 13425.4 13442.1 13443.2 13474.2 19211.3 19311.8 19332.4 19354.7 19457.3 7059.2 7066.3 7344.5 7422.9 7438.7 973.4 1026.1 1111.5 1117.6 1132.2 33166.0 33400.0 33522.5 33553.5 33884.8 1110.6 1130.9 1139.7 1146.4 1162.6 17264.3 17468.5 17612.6 17638.3 17704.7 559074.0 561282.0 562720.0 563571.0 564661.0 58341.0 58650.1 58896.4 59038.7 59122.7 1336.5 1343.5 1351.0 1357.3 1398.6 30881.2 31655.7 32578.3 32904.2 33100.8 50537.7 50627.0 50634.0 50705.0 50879.1 422250.0 422340.4 423142.0 423507.0 425436.0 28475.1 28764.1 28875.1 28983.3 29172.1 47760.0 47984.0 48916.8 49258.5 49862.8 39605.0 40609.8 40969.6 41121.0 42591.8 40596.0 41038.6 41183.6 41882.2 42101.0 35480.8 40493.4 40667.2 40719.8 41504.4 34859.3 36423.8 37188.8 37211.0 37738.0 28472.0 28647.0 28854.7 28974.6 28979.7 06:55:44 INFO - PROCESS | 3409 | 06:55:44 INFO - PROCESS | 3409 | [#2] jquery.html Cycles:180 Average:30372.98 Median:17157.68 stddev:82036.30 (478.1%) stddev-sans-first:82235.53 06:55:44 INFO - PROCESS | 3409 | Values: 385.2 388.3 398.7 399.7 420.6 13724.3 18000.4 19266.5 19706.6 19734.7 18710.6 18928.6 19067.3 19687.5 19933.3 5521.7 5746.5 5776.3 5793.4 5962.5 5800.9 5847.5 5854.9 5891.5 5895.8 5822.6 5862.5 5871.9 5879.3 5879.4 5801.9 5802.8 5820.8 5840.9 5865.5 5612.2 5632.2 5797.9 5873.3 5879.8 14157.9 14441.4 14488.8 25711.5 26226.5 2522.7 2573.5 2743.9 3023.5 3267.7 14921.0 15552.7 16121.6 16594.5 16626.8 2018.2 2064.4 2155.8 2211.9 2254.7 89820.7 91433.1 91889.0 94093.0 94321.0 17498.7 17694.3 17934.6 17989.5 18281.5 31291.8 31755.8 31897.7 31975.8 32169.0 9877.4 10129.4 10129.8 10142.0 10416.5 8288.3 8403.0 8424.5 8654.7 8655.9 8582.3 9024.5 9059.8 9061.8 9112.9 3348.7 3412.9 3436.9 3534.7 3660.7 874.5 1001.7 1040.3 1085.0 1106.2 19862.5 20158.5 20228.3 20298.4 20455.5 995.5 995.6 1012.4 1020.6 1025.3 10646.5 11085.6 11200.9 11215.8 11247.3 492809.0 493991.0 494277.0 501213.0 506318.0 88558.0 88868.0 90227.0 91240.5 94213.5 1002.3 1014.6 1025.7 1032.7 1043.7 16503.0 16778.0 17541.3 17997.8 18208.8 28744.7 32891.7 36867.3 41705.6 43317.1 56379.0 56717.1 59021.4 59209.4 59835.0 7772.9 8021.1 8755.6 8902.1 8933.4 13352.8 13674.0 13721.8 13834.4 13843.3 11872.6 11938.8 12119.3 12264.0 12297.0 11822.4 11966.5 11987.8 12077.9 12181.6 11822.9 11928.1 11962.6 12352.2 12356.0 8061.1 8253.2 8326.3 8339.7 8360.1 11627.2 11846.0 11876.6 11975.6 12433.9 06:55:44 INFO - PROCESS | 3409 | 06:55:44 INFO - PROCESS | 3409 | [#3] mootools.html Cycles:180 Average:5516.93 Median:4946.69 stddev:3113.64 (62.9%) stddev-sans-first:3107.46 06:55:44 INFO - PROCESS | 3409 | Values: 1462.2 1463.3 1564.5 1734.1 1739.3 7284.9 7661.8 7916.6 8497.5 8504.0 7936.0 7976.7 7995.8 8006.3 8012.5 2320.4 2322.8 2328.1 2337.6 2341.7 2223.3 2263.6 2277.5 2282.6 2285.9 2258.8 2261.6 2282.4 2368.0 2370.4 2243.5 2271.5 2276.1 2276.6 2277.6 2187.7 2205.2 2209.6 2215.1 2223.0 8102.0 8123.6 8164.1 8166.1 8168.7 4912.6 5065.3 5124.0 5138.8 5143.4 3049.9 3084.0 3206.6 3239.9 3254.5 1048.7 1093.2 1093.2 1105.7 1110.4 11597.1 11643.4 11704.2 11708.2 11716.3 4316.7 4385.7 4561.9 4572.7 4588.6 9721.1 9783.1 9785.6 9791.1 9795.2 4872.1 4945.6 4955.1 4960.5 4967.5 4132.5 4567.7 4579.4 4684.4 4709.2 3739.9 3911.0 3942.7 3954.6 4040.3 1257.5 1263.8 1264.3 1269.7 1276.9 938.7 939.9 946.0 949.0 981.9 5590.4 5693.2 5693.7 5806.2 5907.9 432.5 439.9 455.1 460.1 460.5 3754.4 3920.9 3961.7 3968.6 4018.3 10030.6 10486.3 10490.5 10502.9 10527.1 10087.6 10161.4 10264.4 10326.7 10367.9 7820.3 7845.2 7914.2 7981.6 7993.7 5528.1 5537.1 5560.8 5583.5 5718.4 9622.4 9640.4 9666.7 9723.8 9755.0 9323.6 9589.3 9719.5 9731.4 9882.7 6728.0 7219.9 7330.3 7430.7 7513.1 7938.8 8125.2 8133.3 8153.2 8158.5 7513.1 7626.9 7662.9 7741.5 7747.9 7322.5 7326.2 7345.0 7463.2 7564.8 6549.2 6701.7 6702.7 6707.0 6724.9 4919.8 4947.8 5000.0 5099.5 5116.8 4814.9 4933.6 4983.8 5001.5 5071.7 06:55:44 INFO - PROCESS | 3409 | 06:55:44 INFO - PROCESS | 3409 | [#4] prototype.html Cycles:180 Average:4764.32 Median:5324.64 stddev:1419.75 (26.7%) stddev-sans-first:1384.19 06:55:44 INFO - PROCESS | 3409 | Values: 331.2 338.9 339.4 343.8 345.0 5305.4 5437.7 5491.3 5568.2 5572.9 5456.7 5478.8 5488.1 5526.3 5537.2 4282.3 4295.8 4311.8 4318.0 4334.4 4176.5 4259.3 4279.2 4315.5 4330.5 4228.4 4232.2 4236.3 4244.5 4253.9 4251.5 4253.3 4257.5 4272.5 4277.9 3674.9 3768.7 3776.5 3786.9 3796.5 5269.0 5310.5 5319.5 5329.8 5353.4 4853.1 4880.5 4884.3 4889.9 4895.9 5539.8 5703.2 5705.5 5729.8 5742.6 4055.0 4069.5 4072.2 4101.4 4116.4 6007.3 6014.5 6028.3 6047.0 6057.8 3985.4 4147.1 4204.9 4215.5 4228.4 4200.6 4210.7 4216.2 4231.6 4234.8 4826.2 4845.5 4853.8 4865.5 4885.4 5703.8 5786.0 5791.8 5814.2 5817.8 1439.8 1466.4 1466.4 1469.0 1469.6 923.5 950.5 966.4 979.1 983.2 4840.2 4874.5 4885.9 4947.6 4968.3 5186.5 5187.7 5249.8 5263.2 5315.8 4653.3 4895.6 4970.6 4975.3 5023.7 2735.0 2746.8 2772.9 2773.6 2775.6 5334.8 5344.7 5354.5 5355.9 5400.3 5201.3 5215.5 5582.7 6053.4 6063.7 6198.3 6198.6 6203.8 6207.0 6221.2 5676.3 5948.1 5970.9 5979.0 5995.3 5914.7 5927.8 5942.3 5952.9 5961.7 6238.7 6239.8 6252.4 6272.8 6317.7 4032.3 4149.4 4172.6 4194.2 4195.8 5904.5 5915.2 5961.3 6002.0 6044.0 5612.4 5785.9 5821.6 5828.7 5846.2 5696.7 5701.3 5724.4 5734.2 5755.1 5698.3 5700.5 5750.2 5770.5 5794.6 5578.0 5792.4 5808.3 5861.2 5865.7 5653.6 5659.3 5659.7 5683.9 5724.9 06:55:44 INFO - PROCESS | 3409 | 06:55:44 INFO - PROCESS | 3409 | [#5] yui.html Cycles:180 Average:21981.22 Median:4759.61 stddev:33018.52 (693.7%) stddev-sans-first:33072.67 06:55:44 INFO - PROCESS | 3409 | Values: 751.9 765.4 806.1 810.8 841.9 15574.8 16509.0 16527.3 16589.0 16618.5 14955.0 14981.6 14984.5 15011.7 15014.5 627.0 757.9 761.8 774.3 787.5 773.9 778.9 783.4 783.5 785.1 837.7 840.9 842.4 843.8 844.2 837.2 840.1 840.3 840.5 842.0 616.4 616.5 616.6 617.5 618.0 14892.6 15065.2 15066.2 15080.5 15092.2 14917.9 14943.0 15061.8 15181.9 15340.8 11621.1 11627.8 11657.8 11691.9 12217.5 3836.0 3960.0 3974.2 4026.8 4089.8 78894.0 81388.2 82004.0 82032.6 82453.6 11520.7 11557.8 11574.0 11845.1 11890.8 23474.0 23492.5 23510.1 23516.3 23665.5 8786.4 8803.0 8916.2 8954.2 9204.2 4712.6 4712.8 4847.2 4917.8 4935.8 3356.9 3464.6 3486.3 3488.0 3494.7 586.4 595.1 610.8 612.6 618.3 567.4 716.3 726.3 726.7 734.3 9403.3 9594.8 9652.4 9658.8 9747.5 711.2 740.7 766.1 785.3 791.7 4444.1 4595.9 4806.4 4901.2 4939.7 123926.0 126493.0 126646.0 130175.3 130207.0 110884.9 114415.0 114739.4 115543.0 115751.4 55866.4 83007.6 93616.0 94912.0 95431.0 9139.7 9256.4 9404.7 9430.2 9439.6 55787.4 56262.0 56369.0 56627.0 58329.7 76245.0 81950.2 82564.0 84339.6 85043.0 12380.6 12481.1 12537.7 12607.5 13044.7 13099.1 13134.3 13343.5 13607.0 14035.8 12787.4 12819.2 12887.5 12908.9 13618.9 12847.8 12867.4 12942.7 12988.9 13014.0 12123.9 12318.3 12381.8 12707.4 12783.0 9857.8 10287.9 10402.0 10458.3 10871.1 8651.6 9541.2 10664.3 10830.6 10857.7 06:55:44 INFO - PROCESS | 3409 | -------- Summary: end -------- 06:55:44 INFO - PROCESS | 3409 | 06:55:45 INFO - TEST-INFO | 3409: exit 0 06:55:45 INFO - TEST-OK | dromaeo_css | took 1114838ms 06:55:45 INFO - TEST-START | kraken 06:55:45 INFO - operating with platform_type : linux_ 06:55:45 INFO - Initialising browser for kraken test... 06:55:45 INFO - TEST-INFO | started process 3684 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpnXr6Ls/profile http://localhost:40286/getInfo.html) 06:55:50 INFO - PROCESS | 3684 | __metrics Screen width/height:1600/1200 06:55:50 INFO - PROCESS | 3684 | colorDepth:24 06:55:50 INFO - PROCESS | 3684 | Browser inner width/height: 1024/697 06:55:50 INFO - PROCESS | 3684 | __metrics 06:55:50 ERROR - PROCESS | 3684 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2968: TypeError: this.tabs is undefined 06:55:51 INFO - TEST-INFO | 3684: exit 0 06:55:51 INFO - Browser initialized. 06:55:51 INFO - Running cycle 1/1 for kraken test... 06:55:51 INFO - TEST-INFO | started process 3802 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpnXr6Ls/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 06:56:03 INFO - PROCESS | 3802 | RSS: Main: 163979264 06:56:03 INFO - PROCESS | 3802 | 06:56:06 INFO - PROCESS | 3802 | Cycle 1(1): loaded http://localhost:40286/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:40286/tests/kraken/driver.html?testName=audio-beat-detection) 06:56:06 INFO - PROCESS | 3802 | RSS: Main: 169136128 06:56:06 INFO - PROCESS | 3802 | 06:56:09 INFO - PROCESS | 3802 | Cycle 1(1): loaded http://localhost:40286/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:40286/tests/kraken/driver.html?testName=audio-dft) 06:56:10 INFO - PROCESS | 3802 | RSS: Main: 168550400 06:56:10 INFO - PROCESS | 3802 | 06:56:13 INFO - PROCESS | 3802 | Cycle 1(1): loaded http://localhost:40286/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:40286/tests/kraken/driver.html?testName=audio-fft) 06:56:13 INFO - PROCESS | 3802 | RSS: Main: 165134336 06:56:13 INFO - PROCESS | 3802 | 06:56:15 INFO - PROCESS | 3802 | Cycle 1(1): loaded http://localhost:40286/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:40286/tests/kraken/driver.html?testName=audio-oscillator) 06:56:16 INFO - PROCESS | 3802 | RSS: Main: 165564416 06:56:16 INFO - PROCESS | 3802 | 06:56:18 INFO - PROCESS | 3802 | Cycle 1(1): loaded http://localhost:40286/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:40286/tests/kraken/driver.html?testName=imaging-gaussian-blur) 06:56:19 INFO - PROCESS | 3802 | RSS: Main: 166453248 06:56:19 INFO - PROCESS | 3802 | 06:56:22 INFO - PROCESS | 3802 | Cycle 1(1): loaded http://localhost:40286/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:40286/tests/kraken/driver.html?testName=imaging-darkroom) 06:56:23 INFO - PROCESS | 3802 | RSS: Main: 166588416 06:56:23 INFO - PROCESS | 3802 | 06:56:26 INFO - PROCESS | 3802 | Cycle 1(1): loaded http://localhost:40286/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:40286/tests/kraken/driver.html?testName=imaging-desaturate) 06:56:27 INFO - PROCESS | 3802 | RSS: Main: 163770368 06:56:27 INFO - PROCESS | 3802 | 06:56:30 INFO - PROCESS | 3802 | Cycle 1(1): loaded http://localhost:40286/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:40286/tests/kraken/driver.html?testName=json-parse-financial) 06:56:30 INFO - PROCESS | 3802 | RSS: Main: 165982208 06:56:30 INFO - PROCESS | 3802 | 06:56:32 INFO - PROCESS | 3802 | Cycle 1(1): loaded http://localhost:40286/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:40286/tests/kraken/driver.html?testName=json-stringify-tinderbox) 06:56:32 INFO - PROCESS | 3802 | RSS: Main: 165527552 06:56:32 INFO - PROCESS | 3802 | 06:56:34 INFO - PROCESS | 3802 | Cycle 1(1): loaded http://localhost:40286/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:40286/tests/kraken/driver.html?testName=stanford-crypto-aes) 06:56:35 INFO - PROCESS | 3802 | RSS: Main: 166318080 06:56:35 INFO - PROCESS | 3802 | 06:56:37 INFO - PROCESS | 3802 | Cycle 1(1): loaded http://localhost:40286/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:40286/tests/kraken/driver.html?testName=stanford-crypto-ccm) 06:56:38 INFO - PROCESS | 3802 | RSS: Main: 166240256 06:56:38 INFO - PROCESS | 3802 | 06:56:40 INFO - PROCESS | 3802 | Cycle 1(1): loaded http://localhost:40286/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:40286/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 06:56:41 INFO - PROCESS | 3802 | RSS: Main: 165986304 06:56:41 INFO - PROCESS | 3802 | 06:56:44 INFO - PROCESS | 3802 | Cycle 1(1): loaded http://localhost:40286/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:40286/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 06:56:44 INFO - PROCESS | 3802 | RSS: Main: 166879232 06:56:44 INFO - PROCESS | 3802 | 06:56:46 INFO - PROCESS | 3802 | Cycle 1(1): loaded http://localhost:40286/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:40286/tests/kraken/driver.html?testName=ai-astar) 06:56:46 INFO - PROCESS | 3802 | RSS: Main: 167063552 06:56:46 INFO - PROCESS | 3802 | 06:56:46 INFO - PROCESS | 3802 | __start_tp_report 06:56:46 INFO - PROCESS | 3802 | _x_x_mozilla_page_load 06:56:46 INFO - PROCESS | 3802 | _x_x_mozilla_page_load_details 06:56:46 INFO - PROCESS | 3802 | |i|pagename|runs| 06:56:46 INFO - PROCESS | 3802 | |0;ai-astar;104;113;108;114;112;114;114;112;112;115 06:56:46 INFO - PROCESS | 3802 | |1;audio-beat-detection;148;118;146;173;118;150;147;119;190;119 06:56:46 INFO - PROCESS | 3802 | |2;audio-dft;164;162;163;163;163;167;168;165;162;161 06:56:46 INFO - PROCESS | 3802 | |3;audio-fft;74;75;76;184;85;75;76;98;176;75 06:56:46 INFO - PROCESS | 3802 | |4;audio-oscillator;85;86;143;84;84;86;134;83;85;153 06:56:46 INFO - PROCESS | 3802 | |5;imaging-gaussian-blur;117;118;117;117;117;117;118;117;118;117 06:56:46 INFO - PROCESS | 3802 | |6;imaging-darkroom;147;147;148;147;147;146;146;147;146;147 06:56:46 INFO - PROCESS | 3802 | |7;imaging-desaturate;101;97;96;95;95;96;97;97;95;95 06:56:46 INFO - PROCESS | 3802 | |8;json-parse-financial;53;52;52;52;54;59;53;53;55;54 06:56:46 INFO - PROCESS | 3802 | |9;json-stringify-tinderbox;61;60;60;61;61;61;62;62;61;61 06:56:46 INFO - PROCESS | 3802 | |10;stanford-crypto-aes;79;77;76;75;87;79;76;77;80;77 06:56:46 INFO - PROCESS | 3802 | |11;stanford-crypto-ccm;126;125;138;127;130;123;150;133;125;148 06:56:46 INFO - PROCESS | 3802 | |12;stanford-crypto-pbkdf2;165;162;162;160;166;161;160;164;161;167 06:56:46 INFO - PROCESS | 3802 | |13;stanford-crypto-sha256-iterative;63;67;64;64;65;66;64;65;63;67 06:56:46 INFO - PROCESS | 3802 | __end_tp_report 06:56:46 INFO - PROCESS | 3802 | __start_cc_report 06:56:46 INFO - PROCESS | 3802 | _x_x_mozilla_cycle_collect,882 06:56:46 INFO - PROCESS | 3802 | __end_cc_report 06:56:46 INFO - PROCESS | 3802 | __startTimestamp1474379806711__endTimestamp 06:56:46 INFO - PROCESS | 3802 | 06:56:46 INFO - PROCESS | 3802 | ------- Summary: start ------- 06:56:46 INFO - PROCESS | 3802 | Number of tests: 14 06:56:46 INFO - PROCESS | 3802 | 06:56:46 INFO - PROCESS | 3802 | [#0] ai-astar Cycles:10 Average:111.80 Median:113.50 stddev:3.36 (3.0%) stddev-sans-first:2.06 06:56:46 INFO - PROCESS | 3802 | Values: 104.0 113.0 108.0 114.0 112.0 114.0 114.0 112.0 112.0 115.0 06:56:46 INFO - PROCESS | 3802 | 06:56:46 INFO - PROCESS | 3802 | [#1] audio-beat-detection Cycles:10 Average:142.80 Median:147.50 stddev:24.97 (16.9%) stddev-sans-first:26.41 06:56:46 INFO - PROCESS | 3802 | Values: 148.0 118.0 146.0 173.0 118.0 150.0 147.0 119.0 190.0 119.0 06:56:46 INFO - PROCESS | 3802 | 06:56:46 INFO - PROCESS | 3802 | [#2] audio-dft Cycles:10 Average:163.80 Median:163.50 stddev:2.25 (1.4%) stddev-sans-first:2.39 06:56:46 INFO - PROCESS | 3802 | Values: 164.0 162.0 163.0 163.0 163.0 167.0 168.0 165.0 162.0 161.0 06:56:46 INFO - PROCESS | 3802 | 06:56:46 INFO - PROCESS | 3802 | [#3] audio-fft Cycles:10 Average:99.40 Median:75.50 stddev:43.15 (57.2%) stddev-sans-first:44.78 06:56:46 INFO - PROCESS | 3802 | Values: 74.0 75.0 76.0 184.0 85.0 75.0 76.0 98.0 176.0 75.0 06:56:46 INFO - PROCESS | 3802 | 06:56:46 INFO - PROCESS | 3802 | [#4] audio-oscillator Cycles:10 Average:102.30 Median:84.50 stddev:28.68 (33.9%) stddev-sans-first:29.73 06:56:46 INFO - PROCESS | 3802 | Values: 85.0 86.0 143.0 84.0 84.0 86.0 134.0 83.0 85.0 153.0 06:56:46 INFO - PROCESS | 3802 | 06:56:46 INFO - PROCESS | 3802 | [#5] imaging-gaussian-blur Cycles:10 Average:117.30 Median:117.00 stddev:0.48 (0.4%) stddev-sans-first:0.50 06:56:46 INFO - PROCESS | 3802 | Values: 117.0 118.0 117.0 117.0 117.0 117.0 118.0 117.0 118.0 117.0 06:56:46 INFO - PROCESS | 3802 | 06:56:46 INFO - PROCESS | 3802 | [#6] imaging-darkroom Cycles:10 Average:146.80 Median:147.00 stddev:0.63 (0.4%) stddev-sans-first:0.67 06:56:46 INFO - PROCESS | 3802 | Values: 147.0 147.0 148.0 147.0 147.0 146.0 146.0 147.0 146.0 147.0 06:56:46 INFO - PROCESS | 3802 | 06:56:46 INFO - PROCESS | 3802 | [#7] imaging-desaturate Cycles:10 Average:96.40 Median:96.00 stddev:1.84 (1.9%) stddev-sans-first:0.93 06:56:46 INFO - PROCESS | 3802 | Values: 101.0 97.0 96.0 95.0 95.0 96.0 97.0 97.0 95.0 95.0 06:56:46 INFO - PROCESS | 3802 | 06:56:46 INFO - PROCESS | 3802 | [#8] json-parse-financial Cycles:10 Average:53.70 Median:53.50 stddev:2.11 (3.9%) stddev-sans-first:2.22 06:56:46 INFO - PROCESS | 3802 | Values: 53.0 52.0 52.0 52.0 54.0 59.0 53.0 53.0 55.0 54.0 06:56:46 INFO - PROCESS | 3802 | 06:56:46 INFO - PROCESS | 3802 | [#9] json-stringify-tinderbox Cycles:10 Average:61.00 Median:61.00 stddev:0.67 (1.1%) stddev-sans-first:0.71 06:56:46 INFO - PROCESS | 3802 | Values: 61.0 60.0 60.0 61.0 61.0 61.0 62.0 62.0 61.0 61.0 06:56:46 INFO - PROCESS | 3802 | 06:56:46 INFO - PROCESS | 3802 | [#10] stanford-crypto-aes Cycles:10 Average:78.30 Median:78.00 stddev:3.43 (4.4%) stddev-sans-first:3.63 06:56:46 INFO - PROCESS | 3802 | Values: 79.0 77.0 76.0 75.0 87.0 79.0 76.0 77.0 80.0 77.0 06:56:46 INFO - PROCESS | 3802 | 06:56:46 INFO - PROCESS | 3802 | [#11] stanford-crypto-ccm Cycles:10 Average:132.50 Median:131.50 stddev:9.77 (7.4%) stddev-sans-first:10.07 06:56:46 INFO - PROCESS | 3802 | Values: 126.0 125.0 138.0 127.0 130.0 123.0 150.0 133.0 125.0 148.0 06:56:46 INFO - PROCESS | 3802 | 06:56:46 INFO - PROCESS | 3802 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:162.80 Median:163.00 stddev:2.53 (1.6%) stddev-sans-first:2.55 06:56:46 INFO - PROCESS | 3802 | Values: 165.0 162.0 162.0 160.0 166.0 161.0 160.0 164.0 161.0 167.0 06:56:46 INFO - PROCESS | 3802 | 06:56:46 INFO - PROCESS | 3802 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:64.80 Median:65.00 stddev:1.48 (2.3%) stddev-sans-first:1.41 06:56:46 INFO - PROCESS | 3802 | Values: 63.0 67.0 64.0 64.0 65.0 66.0 64.0 65.0 63.0 67.0 06:56:46 INFO - PROCESS | 3802 | -------- Summary: end -------- 06:56:46 INFO - PROCESS | 3802 | 06:56:47 INFO - TEST-INFO | 3802: exit 0 06:56:47 INFO - TEST-OK | kraken | took 62334ms 06:56:47 INFO - SUITE-END | took 1177s 06:56:47 INFO - Completed test suite (00:19:37) 06:56:47 INFO - javascript benchmark 06:56:47 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7330.870733065652, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3063.785535012549, 3081.861316240769, 3084.5373194020895, 3103.4103520331137, 3108.75129989601, 5318.308619879415, 5362.839114826552, 5369.087255166616, 5415.241866138744, 5423.620346575742, 5259.474052594748, 5330.0, 5340.866478338044, 5343.251944727741, 5443.972780136104, 4864.391951006133, 4952.851414457572, 4970.179920313144, 5005.749712514378, 5040.269160971675, 4949.059678661061, 4977.178765503688, 4996.4503904570465, 5049.621278404116, 5060.418051924021, 4722.291656251556, 4784.091022705675, 4873.6832105913, 4919.065377578248, 4937.0125974805005, 4823.0, 4890.535399137112, 4908.730019848943, 4938.987507560977, 4940.950590494085, 4818.204996175627, 4857.975710121462, 4873.220284754422, 4876.683015603974, 4898.975505122487, 5197.324347834758, 5203.739813009334, 5291.57667386612, 5328.254044433782, 5384.380796208407, 5563.860903477405, 5664.376918538998, 5667.603267771257, 5676.517496012844, 5677.659340439545, 5685.260916080924, 5690.687012214326, 5694.800681976111, 5695.5443564514735, 5699.031164702011, 5216.035033518811, 5315.627906046579, 5321.760520776575, 5324.687003527155, 5353.598480114007, 5863.413658634187, 5921.851953701106, 5926.585139040312, 5968.940310596925, 5976.760929562769, 5679.801206957819, 5682.659040457585, 5696.401877802854, 5696.572757043238, 5697.971510142505, 5505.889882202334, 5610.046292130348, 5769.336526299446, 5776.740046697909, 5782.190493330937, 5614.606977511535, 5648.926703926241, 5651.0675738503505, 5721.828345149652, 5724.484796368347, 5642.322921249476, 5665.348484924204, 5681.829545113653, 5684.687342196219, 5701.116326969326, 4281.357796330513, 4282.6359759420175, 4362.563743625612, 4373.147236288957, 4408.889777755582, 3856.7685938843197, 3885.048163200034, 3928.273269445162, 3935.6064393560414, 3947.0921688011917, 5428.212909128154, 5428.647137936022, 5465.344158700902, 5470.480304371078, 5474.124140137559, 5565.276514053228, 5648.717564121777, 5710.942890571041, 5712.257406537124, 5714.971425142848, 5390.757415916293, 5419.34967803866, 5444.754986025639, 5463.3717122530625, 5469.726513674301, 4870.220764677634, 4873.951260487421, 4878.170710979071, 4879.682820616648, 4891.755412229374, 5816.767329306865, 5878.735456904535, 5909.2908850938165, 5917.55618328627, 5930.0, 5703.971480142573, 5749.195112684311, 5753.482186603226, 5801.82594522165, 5807.448292412214, 5918.112283157561, 5955.315138759098, 5956.225690660186, 5967.6419414835245, 5970.134330522137, 5418.458154184707, 5607.271054762855, 5615.747291371817, 5643.068893632505, 5648.322201335866, 5784.190213370048, 5816.563757718272, 5825.300963884191, 5831.4168583141345, 5877.794277200449, 5632.85917852057, 5636.661800291996, 5646.463585959327, 5665.66006039639, 5681.346645135697, 5320.866978325418, 5547.389787123494, 5583.8883222336135, 5615.7192140392, 5624.606277560695, 5527.723613819373, 5557.3331200256225, 5577.219189313419, 5593.0491816390495, 5628.774849005994, 5634.464725851038, 5651.491365777099, 5702.971485142548, 5708.743106560131, 5719.142128680731, 5341.7062061586985, 5428.728563571726, 5459.071957767269, 5546.667199968015, 5563.221149039218], "value": 5280.814692430983, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [543.7159883543185, 585.7715490958524, 592.2212290837548, 596.8209537138858, 607.7447472061733, 38056.42915356268, 42366.57633423665, 42367.15265694684, 42421.0, 42439.15121697564, 42662.36006459906, 43004.13991720164, 43120.353194702104, 43159.78420107903, 43200.0, 8749.16882896124, 8835.602397892078, 8861.379703420764, 8883.689070882521, 8889.066648001964, 8811.867821982676, 8877.245434138074, 8923.330750193729, 8925.509096999662, 8933.64265429382, 8929.0, 8931.821363572724, 8940.15068568485, 8981.101889811032, 8984.371094023389, 8886.644534218623, 8906.821863562725, 8915.063918288552, 8934.017258101636, 8975.775605609846, 8762.86855697165, 8800.515971621558, 8832.8675069874, 8833.558322083934, 8838.29293656506, 40423.7978810104, 40464.79767601172, 40664.796676016726, 40743.7962810187, 40874.38688419676, 3716.888493345204, 3801.8479260829536, 3838.481804956351, 3938.940915886264, 4346.239408103601, 32508.349833003445, 32524.0, 33045.6695433045, 33151.502727459105, 34373.6562634373, 4178.895527611804, 4290.785460726951, 4388.517263101056, 4416.160929423431, 4456.977715111404, 359318.0, 360108.0, 360310.0, 360478.0, 360557.0, 58791.70604146952, 58954.41045589489, 59522.0, 59597.0, 59630.40369596335, 35933.8203308987, 37217.81391093027, 37270.25459490849, 63022.36977630257, 63246.0, 15295.770563441558, 15360.692786144438, 15365.231738413035, 15379.46171884001, 15385.615359616098, 13364.39860206293, 13425.395857186255, 13442.126261792951, 13443.193408395528, 13474.191548506926, 19211.32760353381, 19311.806881931283, 19332.4200273992, 19354.70967935454, 19457.318993835146, 7059.18819335783, 7066.258042905523, 7344.522606030591, 7422.888656670154, 7438.66526006331, 973.3916302311055, 1026.0662796854976, 1111.4942701070993, 1117.6032508459543, 1132.1678566253797, 33166.0, 33400.0, 33522.47319414502, 33553.496697549555, 33884.83057584745, 1110.622388387952, 1130.9434528273553, 1139.7093741095966, 1146.4439746722833, 1162.581470670558, 17264.309427622753, 17468.47594572165, 17612.559686007953, 17638.294468221127, 17704.734428983575, 559074.0, 561282.0, 562720.0, 563571.0, 564661.0, 58341.0, 58650.12024819631, 58896.41103588995, 59038.70480647569, 59122.704386477795, 1336.4988129451456, 1343.4693296147966, 1350.952716654932, 1357.2942070123481, 1398.6433459467974, 30881.227969300948, 31655.683443166196, 32578.348433031682, 32904.177395565304, 33100.83449582737, 50537.74731126321, 50627.0, 50634.0, 50705.0, 50879.131317273175, 422250.0, 422340.4361694652, 423142.0, 423507.0, 425436.0, 28475.145745627666, 28764.137075887757, 28875.133745987652, 28983.275418114717, 29172.124836254945, 47760.0, 47984.0, 48916.75541622269, 49258.50741492539, 49862.750686246334, 39604.96782881893, 40609.79695101624, 40969.59030409658, 41121.0, 42591.7870410646, 40596.0, 41038.589614103475, 41183.58816411797, 41882.1623567533, 42101.0, 35480.82259588686, 40493.39259911163, 40667.1866562673, 40719.796401017804, 41504.37743433911, 34859.30281394409, 36423.81788091043, 37188.81405593063, 37211.0, 37738.0, 28472.0, 28647.0, 28854.711452885203, 28974.565381519715, 28979.710202897702], "value": 20133.08426093345, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [385.22954091816365, 388.25842640556505, 398.6770715720267, 399.74416373520944, 420.5605142625956, 13724.313784310769, 18000.369987050457, 19266.51833704158, 19706.605867882652, 19734.70397944032, 18710.62578748424, 18928.62142757144, 19067.332643357484, 19687.5078123047, 19933.302334418262, 5521.723913804293, 5746.48281654651, 5776.335721392041, 5793.4206579341935, 5962.522998160159, 5800.941990580103, 5847.473727364536, 5854.912176317359, 5891.469767720904, 5895.764169433218, 5822.563307751914, 5862.472377486026, 5871.941280587203, 5879.32387775407, 5879.382664820197, 5801.883962320751, 5802.82591522255, 5820.796272130477, 5840.912386314209, 5865.530757539386, 5612.214289999403, 5632.183333416631, 5797.855053623651, 5873.2658417697785, 5879.823605291848, 14157.929210353985, 14441.35013924376, 14488.782668259984, 25711.48577028468, 26226.475470490674, 2522.659440975463, 2573.4724381501933, 2743.917682469529, 3023.516237402027, 3267.722243609296, 14921.0, 15552.688946221126, 16121.596960075974, 16594.50216493495, 16626.83373166265, 2018.2229841510978, 2064.421961850684, 2155.7628660847295, 2211.8562293450873, 2254.6730724044924, 89820.71255012152, 91433.08566914313, 91889.0, 94093.0, 94321.0, 17498.737518937225, 17694.29222831098, 17934.641307173784, 17989.460316190536, 18281.521027348386, 31291.843540782607, 31755.841220793747, 31897.681023189936, 31975.840120799247, 32169.0, 9877.40735555869, 10129.392236465836, 10129.797404051878, 10142.0, 10416.531256093494, 8288.254057134887, 8403.0, 8424.53665048416, 8654.740357789276, 8655.870161947576, 8582.313414926792, 9024.458532488072, 9059.773505662411, 9061.818763624822, 9112.8633070504, 3348.68187522185, 3412.914677133042, 3436.879709210166, 3534.6995505381815, 3660.743747937619, 874.4884242718081, 1001.6544292219173, 1040.2926010312908, 1084.9620263290747, 1106.181425744943, 19862.54567781404, 20158.496037599176, 20228.29200977988, 20298.391048268575, 20455.4886127848, 995.4624502768424, 995.6166875752888, 1012.3520946594039, 1020.6172685243034, 1025.3437799808128, 10646.520906559068, 11085.560937164919, 11200.943995280135, 11215.775684486265, 11247.268927519684, 492809.0, 493991.0, 494277.0, 501213.0, 506318.0, 88558.0, 88868.0, 90227.0, 91240.54379728192, 94213.5289323549, 1002.2633364477249, 1014.6144465103362, 1025.702546261576, 1032.6540608895955, 1043.6712435582767, 16503.0, 16778.0, 17541.298348065935, 17997.820021799613, 18208.81791182071, 28744.71255287504, 32891.67108328982, 36867.26265474729, 41705.58294417017, 43317.13365732731, 56379.0, 56717.14924276056, 59021.409785903306, 59209.40790592211, 59835.0, 7772.92227077722, 8021.077576078826, 8755.605997730245, 8902.065283145435, 8933.419327743675, 13352.799708004582, 13674.042817003112, 13721.794173087212, 13834.446622135001, 13843.307834608431, 11872.584459543874, 11938.820917686067, 12119.333436661069, 12264.0, 12297.0, 11822.40887955616, 11966.521339146684, 11987.820182697442, 12077.939610301892, 12181.634550963485, 11822.940885295518, 11928.1053920958, 11962.641120766391, 12352.197107188003, 12356.0, 8061.113277539584, 8253.215944485264, 8326.25063744266, 8339.749807505785, 8360.12218717026, 11627.244229125079, 11846.0, 11876.643700688994, 11975.64073077809, 12433.93783031079], "value": 10182.022180697913, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1462.1592584264044, 1463.341496326653, 1564.4759005733079, 1734.0636056529474, 1739.2521215877175, 7284.854302913938, 7661.770146895588, 7916.564588947613, 8497.490150590962, 8504.0, 7936.0, 7976.680932762697, 7995.800104997378, 8006.319462845665, 8012.519248845073, 2320.396696858816, 2322.7677232276806, 2328.1153161798493, 2337.6026075567192, 2341.695579574653, 2223.288547664748, 2263.581237471073, 2277.464795772992, 2282.6005449046434, 2285.885705714716, 2258.8080013198896, 2261.5589959957815, 2282.3951652811934, 2367.988160059197, 2370.3718514593647, 2243.5064285857084, 2271.5002699406023, 2276.146445083094, 2276.6243569811045, 2277.555876604063, 2187.671849222613, 2205.162038425388, 2209.591225623265, 2215.069670738294, 2223.021870377045, 8102.0, 8123.553204573746, 8164.1427650096475, 8166.142555031695, 8168.67325306987, 4912.5578697917, 5065.316182315414, 5124.026434977342, 5138.794448222066, 5143.357080364917, 3049.9390012199856, 3083.953740693891, 3206.601002936871, 3239.8866039688496, 3254.495553189259, 1048.7325731938306, 1093.1582681335408, 1093.2456604942565, 1105.7125147461638, 1110.3726394587113, 11597.130215233807, 11643.35961522116, 11704.18070735049, 11708.180427370002, 11716.297022178696, 4316.676249281317, 4385.7149285296355, 4561.908761824811, 4572.74849883253, 4588.564086411786, 9721.076497732704, 9783.119519243302, 9785.559649815776, 9791.069848364394, 9795.21638268951, 4872.098661747517, 4945.579625731853, 4955.058538877602, 4960.454350021495, 4967.4784147664695, 4132.5454200037975, 4567.657425693086, 4579.427571553556, 4684.4378674559275, 4709.246520556694, 3739.8691045813266, 3910.9608903911167, 3942.6648734857285, 3954.6440820326306, 4040.2929487340184, 1257.4718618180386, 1263.8420197475316, 1264.2667252993242, 1269.6508460173527, 1276.8850803427736, 938.6526985015452, 939.9436033837854, 945.9716208513755, 949.0437287848303, 981.9459929703792, 5590.385057643656, 5693.202951586781, 5693.743781529841, 5806.21616081832, 5907.940920590825, 432.47886297012025, 439.936209249657, 455.13978580482916, 460.0890237330105, 460.49115727121716, 3754.3805272129794, 3920.921581568353, 3961.6830653547645, 3968.5634580196156, 4018.2767101921936, 10030.598776049022, 10486.318389304823, 10490.475476226158, 10502.947485262677, 10527.052565269163, 10087.646932357333, 10161.441120738282, 10264.435456049989, 10326.690199294033, 10367.9481602593, 7820.335271501872, 7845.215478452109, 7914.208579142155, 7981.600919953979, 7993.72021979228, 5528.087865502308, 5537.086380747292, 5560.777568897361, 5583.497485226349, 5718.399568045462, 9622.422654640744, 9640.373375730554, 9666.661666841626, 9723.756906077122, 9754.951225244113, 9323.580438880132, 9589.328746987643, 9719.46542940145, 9731.367461115005, 9882.654107106217, 6727.966360168168, 7219.891701624585, 7330.340269375782, 7430.7027718892805, 7513.060867391576, 7938.841223175619, 8125.187481251827, 8133.308668763221, 8153.1846815317995, 8158.469699469515, 7513.1359893612935, 7626.8855967159425, 7662.885056724265, 7741.496802707806, 7747.883781743166, 7322.487425880137, 7326.230745771617, 7344.96327518359, 7463.216362282099, 7564.848703025798, 6549.181352330958, 6701.731930722912, 6702.731890724512, 6707.0, 6724.865502689821, 4919.754012299442, 4947.802087916443, 5000.0, 5099.490050994871, 5116.846494605168, 4814.855554333376, 4933.58064564516, 4983.775730092227, 5001.499850015115, 5071.695698257969], "value": 4374.425205378976, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [331.2199769542727, 338.8813915129705, 339.4229809324148, 343.8126221209441, 344.9655034496552, 5305.408377486749, 5437.728113594324, 5491.286132802735, 5568.192612071252, 5572.888542229153, 5456.672599644025, 5478.822053258548, 5488.106603221882, 5526.281583394163, 5537.224788529609, 4282.2656823986335, 4295.7852107394665, 4311.762853043081, 4317.978410107945, 4334.436523251973, 4176.4893914572185, 4259.318509038554, 4279.2083464559, 4315.525292217853, 4330.545292744264, 4228.386883901832, 4232.195882782277, 4236.322188449849, 4244.511881133678, 4253.893652658693, 4251.4685664291965, 4253.341196933198, 4257.46781652295, 4272.46594175728, 4277.887749185204, 3674.8713795017316, 3768.679662228714, 3776.490173826553, 3786.8863934082024, 3796.54441467023, 5268.973655131738, 5310.522053015247, 5319.521243088141, 5329.760160792774, 5353.411124776271, 4853.107288157621, 4880.463149053601, 4884.29177769225, 4889.899772551147, 4895.8776030599165, 5539.833804985857, 5703.207367100873, 5705.4579814917515, 5729.828105156852, 5742.569307301969, 4054.959450405517, 4069.47096877407, 4072.165206132736, 4101.425800387948, 4116.435754413334, 6007.279126504804, 6014.51883849291, 6028.306744724369, 6047.0, 6057.757689692451, 3985.4021896715726, 4147.087640719037, 4204.936925946114, 4215.515215750228, 4228.365745138254, 4200.600942910419, 4210.7473551587, 4216.156768646221, 4231.576842315744, 4234.809433575497, 4826.203676393426, 4845.515448455127, 4853.781579828917, 4865.537773911473, 4885.364902562644, 5703.800366987219, 5785.971070144707, 5791.82624521265, 5814.244148260699, 5817.807349493343, 1439.79842822005, 1466.3694611317023, 1466.4061055272632, 1468.9779653305209, 1469.632591852037, 923.4828496042238, 950.5199874063553, 966.4008314844841, 979.1383582447401, 983.1790454970037, 4840.201366774513, 4874.53691899269, 4885.949520853033, 4947.579455746302, 4968.310774336743, 5186.481351864859, 5187.714675692798, 5249.763760630781, 5263.184206448007, 5315.760790764425, 4653.278741795028, 4895.6083513318845, 4970.577500912391, 4975.303457515951, 5023.673461225008, 2734.9589756153673, 2746.807723459339, 2772.9029483967965, 2773.611694362791, 2775.613751223504, 5334.759935802898, 5344.706041167773, 5354.544863686552, 5355.892882142413, 5400.270963419966, 5201.323827902348, 5215.452377500308, 5582.748776305076, 6053.3946605339115, 6063.6664983426335, 6198.318184999646, 6198.6280823150755, 6203.7828675997025, 6207.006878899445, 6221.222347206599, 5676.318841738853, 5948.13752005948, 5970.880582388415, 5978.970105149447, 5995.340512543529, 5914.6877748461, 5927.762889484545, 5942.316633587193, 5952.8809423812145, 5961.701914904324, 6238.656873871981, 6239.812805615838, 6252.406021427957, 6272.8118156455375, 6317.684115794284, 4032.314506533955, 4149.37759336102, 4172.645325147397, 4194.2450358935685, 4195.811188496586, 5904.498117660047, 5915.201447804663, 5961.314448838266, 6001.969990150196, 6044.0, 5612.382637909745, 5785.942140578541, 5821.563382746226, 5828.708564571839, 5846.152307915413, 5696.686682232351, 5701.263393571192, 5724.370319264961, 5734.197212390185, 5755.079187330007, 5698.287714035746, 5700.515456186271, 5750.166225897138, 5770.480656740913, 5794.623349482439, 5578.0, 5792.420757924174, 5808.332041815245, 5861.1501332307425, 5865.736041878211, 5653.575981801299, 5659.292588426447, 5659.717014149359, 5683.8863222736145, 5724.885502289848], "value": 4312.9573055014025, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [751.9436042296829, 765.3876898481213, 806.1293802693092, 810.793247721831, 841.9115992820757, 15574.766378504317, 16509.0, 16527.256273467694, 16589.0, 16618.501444956655, 14955.0, 14981.625459363522, 14984.475543355984, 15011.699766004673, 15014.549563513085, 626.9592476489037, 757.8976838126865, 761.801931497809, 774.3224678406394, 787.4566549081144, 773.880048592469, 778.9182135875736, 783.420269000941, 783.4554984285895, 785.0814546980047, 837.736113124367, 840.9285210757093, 842.4481964313385, 843.784834867108, 844.1727107434717, 837.196291560106, 840.1052878684243, 840.2689659995842, 840.474703310431, 841.9621117049717, 616.3959319866556, 616.4852348289139, 616.5930485879343, 617.4998251416322, 617.9721912513947, 14892.62768430787, 15065.246737663074, 15066.246687665682, 15080.472183473526, 15092.24538773068, 14917.850821491755, 14943.0, 15061.849381506154, 15181.924090379587, 15340.769888451681, 11621.128415368798, 11627.767444651145, 11657.825132623017, 11691.941540292244, 12217.511299548007, 3835.9683007446847, 3959.9604003960167, 3974.225026119908, 4026.7583944963394, 4089.7955102245064, 78894.0, 81388.18611813807, 82004.0, 82032.58983705103, 82453.58773206155, 11520.711982200512, 11557.826632600518, 11574.0, 11845.111616628616, 11890.762184756257, 23474.0, 23492.530149396916, 23510.059597615902, 23516.29451116469, 23665.526689466114, 8786.384953053353, 8802.955985220033, 8916.242119419792, 8954.23888969432, 9204.171624553823, 4712.64655150865, 4712.81148754046, 4847.200211965057, 4917.754112294371, 4935.7532123393685, 3356.916077098092, 3464.6362131976284, 3486.337595856779, 3487.982560087183, 3494.7029502492574, 586.4165155670136, 595.1221947627301, 610.7984365159487, 612.5773216480703, 618.2951435363689, 567.4013915319296, 716.2658275267892, 726.3390314813599, 726.6657337624646, 734.2914087905198, 9403.29475289356, 9594.760130996781, 9652.372595781393, 9658.75853103664, 9747.512624368754, 711.164381851333, 740.6889106575252, 766.1227894061269, 785.2775446589152, 791.7466410748506, 4444.066830928557, 4595.9080818383445, 4806.399200099988, 4901.166801643729, 4939.703617782944, 123926.0, 126493.0, 126646.0, 130175.34912325378, 130207.0, 110884.89115108908, 114415.0, 114739.42630286796, 115543.0, 115751.42124289325, 55866.441335586125, 83007.58496207601, 93616.0, 94912.0, 95430.99999999862, 9139.720439138393, 9256.352055356061, 9404.670836520689, 9430.245580353418, 9439.622415103593, 55787.44212557822, 56262.0, 56369.0, 56627.0, 58329.70835145797, 76245.0, 81950.18049819426, 82564.0, 84339.5783021081, 85043.0, 12380.566680166512, 12481.126321157431, 12537.749245014866, 12607.49570017189, 13044.739105218032, 13099.148555344253, 13134.343282835629, 13343.466261349437, 13607.0, 14035.789463158266, 12787.424565894744, 12819.230846149261, 12887.548935787203, 12908.935455322664, 13618.86381136176, 12847.807282890577, 12867.356632168541, 12942.731408374679, 12988.870111299144, 13014.0, 12123.878761212627, 12318.322492263012, 12381.814272785736, 12707.428165732379, 12783.0, 9857.802843942938, 10287.948560257151, 10402.0, 10458.26792124544, 10871.130309575374, 8651.567421628768, 9541.188998935168, 10664.253502254767, 10830.620928267474, 10857.728556786144], "value": 7598.7788991321195, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1533.6999999999998, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [104.0, 113.0, 108.0, 114.0, 112.0, 114.0, 114.0, 112.0, 112.0, 115.0], "value": 111.8, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [148.0, 118.0, 146.0, 173.0, 118.0, 150.0, 147.0, 119.0, 190.0, 119.0], "value": 142.8, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [164.0, 162.0, 163.0, 163.0, 163.0, 167.0, 168.0, 165.0, 162.0, 161.0], "value": 163.8, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [74.0, 75.0, 76.0, 184.0, 85.0, 75.0, 76.0, 98.0, 176.0, 75.0], "value": 99.4, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 86.0, 143.0, 84.0, 84.0, 86.0, 134.0, 83.0, 85.0, 153.0], "value": 102.3, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 118.0, 117.0, 117.0, 117.0, 117.0, 118.0, 117.0, 118.0, 117.0], "value": 117.3, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 147.0, 148.0, 147.0, 147.0, 146.0, 146.0, 147.0, 146.0, 147.0], "value": 146.8, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [101.0, 97.0, 96.0, 95.0, 95.0, 96.0, 97.0, 97.0, 95.0, 95.0], "value": 96.4, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [53.0, 52.0, 52.0, 52.0, 54.0, 59.0, 53.0, 53.0, 55.0, 54.0], "value": 53.7, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [61.0, 60.0, 60.0, 61.0, 61.0, 61.0, 62.0, 62.0, 61.0, 61.0], "value": 61.0, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [79.0, 77.0, 76.0, 75.0, 87.0, 79.0, 76.0, 77.0, 80.0, 77.0], "value": 78.3, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [126.0, 125.0, 138.0, 127.0, 130.0, 123.0, 150.0, 133.0, 125.0, 148.0], "value": 132.5, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [165.0, 162.0, 162.0, 160.0, 166.0, 161.0, 160.0, 164.0, 161.0, 167.0], "value": 162.8, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [63.0, 67.0, 64.0, 64.0, 65.0, 66.0, 64.0, 65.0, 63.0, 67.0], "value": 64.8, "unit": "score"}]}]} 06:56:47 INFO - Return code: 0 06:56:47 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 06:56:48 ERROR - # TBPL SUCCESS # 06:56:48 INFO - Running post-action listener: _resource_record_post_action 06:56:48 INFO - [mozharness: 2016-09-20 13:56:48.000504Z] Finished run-tests step (success) 06:56:48 INFO - Running post-run listener: _resource_record_post_run 06:56:48 INFO - Total resource usage - Wall time: 1194s; CPU: 13.0%; Read bytes: 10473472; Write bytes: 408961024; Read time: 2416; Write time: 336448 06:56:48 INFO - TinderboxPrint: CPU usage
13.4% 06:56:48 INFO - TinderboxPrint: I/O read bytes / time
10,473,472 / 2,416 06:56:48 INFO - TinderboxPrint: I/O write bytes / time
408,961,024 / 336,448 06:56:48 INFO - TinderboxPrint: CPU idle
8,252.3 (86.6%) 06:56:48 INFO - TinderboxPrint: CPU user
1,213.3 (12.7%) 06:56:48 INFO - TinderboxPrint: Swap in / out
0 / 0 06:56:48 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 4096; Write bytes: 45232128; Read time: 168; Write time: 43748 06:56:48 INFO - run-tests - Wall time: 1178s; CPU: 13.0%; Read bytes: 7974912; Write bytes: 357449728; Read time: 1404; Write time: 292316 06:56:48 INFO - Running post-run listener: _upload_blobber_files 06:56:48 INFO - Blob upload gear active. 06:56:48 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 06:56:48 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 06:56:48 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Mozilla-Inbound', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 06:56:48 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Mozilla-Inbound -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 06:56:49 INFO - (blobuploader) - INFO - Open directory for files ... 06:56:49 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 06:56:49 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 06:56:49 INFO - (blobuploader) - INFO - Uploading, attempt #1. 06:56:49 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 06:56:49 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 06:56:49 INFO - (blobuploader) - INFO - Done attempting. 06:56:49 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 06:56:49 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 06:56:49 INFO - (blobuploader) - INFO - Uploading, attempt #1. 06:56:53 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 06:56:53 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 06:56:53 INFO - (blobuploader) - INFO - Done attempting. 06:56:53 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 06:56:53 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 06:56:53 INFO - (blobuploader) - INFO - Uploading, attempt #1. 06:56:53 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 06:56:53 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 06:56:53 INFO - (blobuploader) - INFO - Done attempting. 06:56:53 INFO - (blobuploader) - INFO - Iteration through files over. 06:56:53 INFO - Return code: 0 06:56:53 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 06:56:53 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 06:56:53 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/6b41e32313372b65d1cc25aa7ce6b0ddf3b83125db1632ad8741500a7da44942569a1c6e10acd4018aabe83fd025c8c9307a49f6cedfda55e55c1bb044f69054", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/1396a581dd5dadec32e93fa8442e31d911e7843fc060f7ef9f17fff0cf883b2b0935e95c4a59c32fac0a48a5f313df4395d6778473b7c1247dddf314fe9b6456", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/b56a0f2e0d2fc857ac85bd9a5cbf01bd516db55941d83d2896410d4c296b426fbf953db7c8209a6ace16ef5eb3918874857594eb414170d989f2ce05452aec8f"} 06:56:53 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 06:56:53 INFO - Writing to file /builds/slave/test/properties/blobber_files 06:56:53 INFO - Contents: 06:56:53 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/6b41e32313372b65d1cc25aa7ce6b0ddf3b83125db1632ad8741500a7da44942569a1c6e10acd4018aabe83fd025c8c9307a49f6cedfda55e55c1bb044f69054", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/1396a581dd5dadec32e93fa8442e31d911e7843fc060f7ef9f17fff0cf883b2b0935e95c4a59c32fac0a48a5f313df4395d6778473b7c1247dddf314fe9b6456", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/b56a0f2e0d2fc857ac85bd9a5cbf01bd516db55941d83d2896410d4c296b426fbf953db7c8209a6ace16ef5eb3918874857594eb414170d989f2ce05452aec8f"} 06:56:53 INFO - Running post-run listener: copy_logs_to_upload_dir 06:56:53 INFO - Copying logs to upload dir... 06:56:53 INFO - mkdir: /builds/slave/test/build/upload/logs 06:56:53 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1242.354023 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 42 secs) (at 2016-09-20 06:56:53.927156) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-09-20 06:56:53.931324) ========= 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=826874ccc97bd7bf541b4875000001d5-1474378568.845861-760121704 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/6b41e32313372b65d1cc25aa7ce6b0ddf3b83125db1632ad8741500a7da44942569a1c6e10acd4018aabe83fd025c8c9307a49f6cedfda55e55c1bb044f69054", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/1396a581dd5dadec32e93fa8442e31d911e7843fc060f7ef9f17fff0cf883b2b0935e95c4a59c32fac0a48a5f313df4395d6778473b7c1247dddf314fe9b6456", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/b56a0f2e0d2fc857ac85bd9a5cbf01bd516db55941d83d2896410d4c296b426fbf953db7c8209a6ace16ef5eb3918874857594eb414170d989f2ce05452aec8f"} build_url:https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1474362899/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011441 build_url: 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1474362899/firefox-51.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/6b41e32313372b65d1cc25aa7ce6b0ddf3b83125db1632ad8741500a7da44942569a1c6e10acd4018aabe83fd025c8c9307a49f6cedfda55e55c1bb044f69054", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/1396a581dd5dadec32e93fa8442e31d911e7843fc060f7ef9f17fff0cf883b2b0935e95c4a59c32fac0a48a5f313df4395d6778473b7c1247dddf314fe9b6456", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/b56a0f2e0d2fc857ac85bd9a5cbf01bd516db55941d83d2896410d4c296b426fbf953db7c8209a6ace16ef5eb3918874857594eb414170d989f2ce05452aec8f"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-09-20 06:56:53.957660) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-09-20 06:56:53.958010) ========= 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=826874ccc97bd7bf541b4875000001d5-1474378568.845861-760121704 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004386 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-09-20 06:56:54.043739) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-09-20 06:56:54.044058) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-09-20 06:56:54.044390) ========= ========= Total master_lag: 0.15 =========