builder: mozilla-inbound_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-035 starttime: 1476379908.94 results: success (0) buildid: 20161013102352 builduid: 7e442d3cd1fe4e0ca3cd8cba3812df90 revision: 9b7507984e869d7aa052cefb11cd05d0895ca15e ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-10-13 10:31:48.938810) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-10-13 10:31:48.939221) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-10-13 10:31:48.939489) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-10-13 10:31:48.955607) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-13 10:31:48.955957) ========= 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=ed14279e38b05397cf4aa391000001a4-1476379908.128739-48956615 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-10-13 10:31:49-- 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: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 223M=0s 2016-10-13 10:31:49 (223 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.087873 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-13 10:31:49.057294) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-10-13 10:31:49.063044) ========= 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=ed14279e38b05397cf4aa391000001a4-1476379908.128739-48956615 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.018368 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-10-13 10:31:49.113467) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-10-13 10:31:49.113825) ========= bash -c 'python archiver_client.py mozharness --repo integration/mozilla-inbound --rev 9b7507984e869d7aa052cefb11cd05d0895ca15e --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 9b7507984e869d7aa052cefb11cd05d0895ca15e --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=ed14279e38b05397cf4aa391000001a4-1476379908.128739-48956615 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-10-13 10:31:49,224 truncating revision to first 12 chars 2016-10-13 10:31:49,224 Setting DEBUG logging. 2016-10-13 10:31:49,224 attempt 1/10 2016-10-13 10:31:49,224 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/mozilla-inbound/9b7507984e86?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-10-13 10:31:50,610 unpacking tar archive at: mozilla-inbound-9b7507984e86/testing/mozharness/ program finished with exit code 0 elapsedTime=1.718690 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-10-13 10:31:50.856650) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-10-13 10:31:50.857005) ========= script_repo_revision: 9b7507984e869d7aa052cefb11cd05d0895ca15e ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-10-13 10:31:50.857442) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-10-13 10:31:50.857722) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-10-13 10:31:50.868201) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 36 secs) (at 2016-10-13 10:31:50.868550) ========= /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=ed14279e38b05397cf4aa391000001a4-1476379908.128739-48956615 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 10:31:51 INFO - MultiFileLogger online at 20161013 10:31:51 in /builds/slave/test 10:31:51 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 10:31:51 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 10:31:51 INFO - {'append_to_log': False, 10:31:51 INFO - 'base_work_dir': '/builds/slave/test', 10:31:51 INFO - 'blob_upload_branch': 'Mozilla-Inbound', 10:31:51 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 10:31:51 INFO - 'branch': 'Mozilla-Inbound', 10:31:51 INFO - 'buildbot_json_path': 'buildprops.json', 10:31:51 INFO - 'config_files': ('talos/linux_config.py',), 10:31:51 INFO - 'default_actions': ('clobber', 10:31:51 INFO - 'read-buildbot-config', 10:31:51 INFO - 'download-and-extract', 10:31:51 INFO - 'populate-webroot', 10:31:51 INFO - 'create-virtualenv', 10:31:51 INFO - 'install', 10:31:51 INFO - 'run-tests'), 10:31:51 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 10:31:51 INFO - 'download_minidump_stackwalk': True, 10:31:51 INFO - 'download_symbols': 'ondemand', 10:31:51 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 10:31:51 INFO - 'tooltool.py': '/tools/tooltool.py', 10:31:51 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 10:31:51 INFO - '/tools/misc-python/virtualenv.py')}, 10:31:51 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 10:31:51 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 10:31:51 INFO - 'installer_path': 'installer.exe', 10:31:51 INFO - 'log_level': 'info', 10:31:51 INFO - 'log_name': 'talos', 10:31:51 INFO - 'log_to_console': True, 10:31:51 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 10:31:51 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 10:31:51 INFO - 'opt_config_files': (), 10:31:51 INFO - 'pip_index': False, 10:31:51 INFO - 'sps_profile': False, 10:31:51 INFO - 'sps_profile_interval': 0, 10:31:51 INFO - 'suite': 'dromaeojs-e10s', 10:31:51 INFO - 'system_bits': '32', 10:31:51 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 10:31:51 INFO - 'title': 'talos-linux64-ix-035', 10:31:51 INFO - 'tooltool_cache': '/builds/tooltool_cache', 10:31:51 INFO - 'use_talos_json': True, 10:31:51 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 10:31:51 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 10:31:51 INFO - 'work_dir': 'build'} 10:31:51 INFO - [mozharness: 2016-10-13 17:31:51.058708Z] Running clobber step. 10:31:51 INFO - Running pre-action listener: _resource_record_pre_action 10:31:51 INFO - Running main action method: clobber 10:31:51 INFO - rmtree: /builds/slave/test/build 10:31:51 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 10:31:52 INFO - Running post-action listener: _resource_record_post_action 10:31:52 INFO - [mozharness: 2016-10-13 17:31:52.022119Z] Finished clobber step (success) 10:31:52 INFO - [mozharness: 2016-10-13 17:31:52.022220Z] Running read-buildbot-config step. 10:31:52 INFO - Running pre-action listener: _resource_record_pre_action 10:31:52 INFO - Running main action method: read_buildbot_config 10:31:52 INFO - Using buildbot properties: 10:31:52 INFO - { 10:31:52 INFO - "project": "", 10:31:52 INFO - "product": "firefox", 10:31:52 INFO - "script_repo_revision": "production", 10:31:52 INFO - "builddir": "mozilla-inbound_ubuntu64_hw_test-dromaeojs-e10s", 10:31:52 INFO - "repository": "", 10:31:52 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-inbound pgo talos dromaeojs-e10s", 10:31:52 INFO - "buildid": "20161013102352", 10:31:52 INFO - "stage_platform": "linux64-pgo", 10:31:52 INFO - "basedir": "/builds/slave/test", 10:31:52 INFO - "buildnumber": 1769, 10:31:52 INFO - "platform": "ubuntu64_hw", 10:31:52 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 10:31:52 INFO - "slavebuilddir": "test", 10:31:52 INFO - "branch": "mozilla-inbound", 10:31:52 INFO - "revision": "9b7507984e869d7aa052cefb11cd05d0895ca15e", 10:31:52 INFO - "slavename": "talos-linux64-ix-035", 10:31:52 INFO - "builduid": "7e442d3cd1fe4e0ca3cd8cba3812df90", 10:31:52 INFO - "repo_path": "integration/mozilla-inbound" 10:31:52 INFO - } 10:31:52 INFO - Found installer url https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476372626/firefox-52.0a1.en-US.linux-x86_64.tar.bz2. 10:31:52 INFO - Found a test packages url https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476372626/firefox-52.0a1.en-US.linux-x86_64.test_packages.json. 10:31:52 INFO - Running post-action listener: _resource_record_post_action 10:31:52 INFO - [mozharness: 2016-10-13 17:31:52.024559Z] Finished read-buildbot-config step (success) 10:31:52 INFO - [mozharness: 2016-10-13 17:31:52.024648Z] Running download-and-extract step. 10:31:52 INFO - Running pre-action listener: _resource_record_pre_action 10:31:52 INFO - Running main action method: download_and_extract 10:31:52 INFO - mkdir: /builds/slave/test/build/tests 10:31:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:31:52 INFO - trying https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476372626/firefox-52.0a1.en-US.linux-x86_64.test_packages.json 10:31:52 INFO - Downloading https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476372626/firefox-52.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json 10:31:52 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476372626/firefox-52.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 10:31:52 INFO - Downloaded 1361 bytes. 10:31:52 INFO - Reading from file /builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json 10:31:52 INFO - Using the following test package requirements: 10:31:52 INFO - {u'common': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'], 10:31:52 INFO - u'cppunittest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 10:31:52 INFO - u'firefox-52.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 10:31:52 INFO - u'gtest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 10:31:52 INFO - u'firefox-52.0a1.en-US.linux-x86_64.gtest.tests.zip'], 10:31:52 INFO - u'jittest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 10:31:52 INFO - u'jsshell-linux-x86_64.zip'], 10:31:52 INFO - u'mochitest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 10:31:52 INFO - u'firefox-52.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 10:31:52 INFO - u'mozbase': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'], 10:31:52 INFO - u'reftest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 10:31:52 INFO - u'firefox-52.0a1.en-US.linux-x86_64.reftest.tests.zip'], 10:31:52 INFO - u'talos': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 10:31:52 INFO - u'firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip'], 10:31:52 INFO - u'web-platform': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 10:31:52 INFO - u'firefox-52.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 10:31:52 INFO - u'xpcshell': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 10:31:52 INFO - u'firefox-52.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 10:31:52 INFO - Downloading packages: [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 10:31:52 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476372626/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip 10:31:52 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476372626/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 10:31:52 INFO - Fetch https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476372626/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip into memory 10:31:52 INFO - Http code: 200 10:31:52 INFO - via: 1.1 f1a40337a32137e1c23ceffead6a50d5.cloudfront.net (CloudFront) 10:31:52 INFO - x-amz-cf-id: Lwm4Fk_Xw6KViNKGdnCB9yMzzu9KYS-u4nCrfodNaCB12Zabm2ApTA== 10:31:52 INFO - x-amz-replication-status: COMPLETED 10:31:52 INFO - x-amz-version-id: YMk59jimCnFpBhxbQ0OXXx4GzlRugG1z 10:31:52 INFO - Expected file size: 22126591 10:31:52 INFO - Obtained file size: 22126591 10:31:56 INFO - Downloading packages: [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 10:31:56 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476372626/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip 10:31:56 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476372626/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 10:31:56 INFO - Fetch https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476372626/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip into memory 10:31:56 INFO - Http code: 200 10:31:56 INFO - via: 1.1 441811a054e8d055b893175754efd0c3.cloudfront.net (CloudFront) 10:31:56 INFO - x-amz-cf-id: obuaXe9vkNBPRJyzfOZoxqjxRkSlM_cevYjFwH6VvRhfCSZtwgCi3w== 10:31:56 INFO - x-amz-replication-status: COMPLETED 10:31:56 INFO - x-amz-version-id: YMk59jimCnFpBhxbQ0OXXx4GzlRugG1z 10:31:56 INFO - Expected file size: 22126591 10:31:56 INFO - Obtained file size: 22126591 10:32:01 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476372626/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip 10:32:01 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476372626/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 10:32:01 INFO - Fetch https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476372626/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip into memory 10:32:01 INFO - Http code: 200 10:32:01 INFO - via: 1.1 b9a8ce441329f20cea895e08f19f1ec8.cloudfront.net (CloudFront) 10:32:01 INFO - x-amz-cf-id: F5eZN-aJxOd82YZ-NdWX-Mzo3bsyoejKn0HxI-v8GFwhtEMYULw33A== 10:32:01 INFO - x-amz-replication-status: COMPLETED 10:32:01 INFO - x-amz-version-id: jzr2XvdSLb7wFUUSNTPqrnaJ18XtNgSU 10:32:01 INFO - Expected file size: 14409006 10:32:01 INFO - Obtained file size: 14409006 10:32:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:32:01 INFO - trying https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476372626/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 10:32:01 INFO - Downloading https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476372626/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 10:32:01 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476372626/firefox-52.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 10:32:02 INFO - Downloaded 59762051 bytes. 10:32:02 INFO - Setting buildbot property build_url to https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476372626/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 10:32:02 INFO - mkdir: /builds/slave/test/properties 10:32:02 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 10:32:02 INFO - Writing to file /builds/slave/test/properties/build_url 10:32:02 INFO - Contents: 10:32:02 INFO - build_url:https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476372626/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 10:32:02 INFO - Running post-action listener: _resource_record_post_action 10:32:02 INFO - Running post-action listener: set_extra_try_arguments 10:32:02 INFO - [mozharness: 2016-10-13 17:32:02.879244Z] Finished download-and-extract step (success) 10:32:02 INFO - [mozharness: 2016-10-13 17:32:02.879469Z] Running populate-webroot step. 10:32:02 INFO - Running pre-action listener: _resource_record_pre_action 10:32:02 INFO - Running main action method: populate_webroot 10:32:02 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 10:32:02 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 10:32:02 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 10:32:02 INFO - '--tppagecycles', 10:32:02 INFO - '7'], 10:32:02 INFO - 'tests': ['tsvgm']}}, 10:32:02 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 10:32:02 INFO - 'tests': ['tresize', 'tcanvasmark']}, 10:32:02 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 10:32:02 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 10:32:02 INFO - 'tests': ['dromaeo_css', 'kraken']}, 10:32:02 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 10:32:02 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:32:02 INFO - 'talos_options': ['--disable-e10s'], 10:32:02 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 10:32:02 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:32:02 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 10:32:02 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:32:02 INFO - 'talos_options': ['--disable-e10s'], 10:32:02 INFO - 'tests': ['damp', 'tps']}, 10:32:02 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:32:02 INFO - 'tests': ['damp', 'tps']}, 10:32:02 INFO - 'g3': {'talos_options': ['--disable-e10s'], 10:32:02 INFO - 'tests': ['dromaeo_dom']}, 10:32:02 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 10:32:02 INFO - 'g4': {'talos_options': ['--disable-e10s'], 10:32:02 INFO - 'tests': ['basic_compositor_video']}, 10:32:02 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 10:32:02 INFO - 'other': {'talos_options': ['--disable-e10s'], 10:32:02 INFO - 'tests': ['a11yr', 10:32:02 INFO - 'ts_paint', 10:32:02 INFO - 'tpaint', 10:32:02 INFO - 'sessionrestore', 10:32:02 INFO - 'sessionrestore_no_auto_restore', 10:32:02 INFO - 'tabpaint']}, 10:32:02 INFO - 'other-e10s': {'tests': ['a11yr', 10:32:02 INFO - 'ts_paint', 10:32:02 INFO - 'tpaint', 10:32:02 INFO - 'sessionrestore', 10:32:02 INFO - 'sessionrestore_no_auto_restore', 10:32:02 INFO - 'tabpaint']}, 10:32:02 INFO - 'other-e10s_l64': {'tests': ['a11yr', 10:32:02 INFO - 'ts_paint', 10:32:02 INFO - 'tpaint', 10:32:02 INFO - 'sessionrestore', 10:32:02 INFO - 'sessionrestore_no_auto_restore', 10:32:02 INFO - 'tabpaint']}, 10:32:02 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 10:32:02 INFO - 'ts_paint', 10:32:02 INFO - 'tpaint', 10:32:02 INFO - 'sessionrestore', 10:32:02 INFO - 'sessionrestore_no_auto_restore', 10:32:02 INFO - 'tabpaint']}, 10:32:02 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 10:32:02 INFO - 'tests': ['a11yr', 10:32:02 INFO - 'ts_paint', 10:32:02 INFO - 'tpaint', 10:32:02 INFO - 'sessionrestore', 10:32:02 INFO - 'sessionrestore_no_auto_restore', 10:32:02 INFO - 'tabpaint']}, 10:32:02 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 10:32:02 INFO - 'tests': ['a11yr', 10:32:02 INFO - 'ts_paint', 10:32:02 INFO - 'tpaint', 10:32:02 INFO - 'sessionrestore', 10:32:02 INFO - 'sessionrestore_no_auto_restore', 10:32:02 INFO - 'tabpaint']}, 10:32:02 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 10:32:02 INFO - 'tests': ['tsvgx', 10:32:02 INFO - 'tsvgr_opacity', 10:32:02 INFO - 'tart', 10:32:02 INFO - 'tscrollx', 10:32:02 INFO - 'cart']}, 10:32:02 INFO - 'svgr-e10s': {'tests': ['tsvgx', 10:32:02 INFO - 'tsvgr_opacity', 10:32:02 INFO - 'tart', 10:32:02 INFO - 'tscrollx', 10:32:02 INFO - 'cart']}, 10:32:02 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:32:02 INFO - 'talos_options': ['--disable-e10s'], 10:32:02 INFO - 'tests': ['tp5o']}, 10:32:02 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:32:02 INFO - 'tests': ['tp5o']}, 10:32:02 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:32:02 INFO - 'talos_options': ['--disable-e10s', 10:32:02 INFO - '--xperf_path', 10:32:02 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 10:32:02 INFO - 'tests': ['tp5n']}, 10:32:02 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:32:02 INFO - 'talos_options': ['--xperf_path', 10:32:02 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 10:32:02 INFO - 'tests': ['tp5n']}}, 10:32:02 INFO - 'talos.zip': {'path': '', 10:32:02 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 10:32:02 INFO - Running post-action listener: _resource_record_post_action 10:32:02 INFO - [mozharness: 2016-10-13 17:32:02.896984Z] Finished populate-webroot step (success) 10:32:02 INFO - [mozharness: 2016-10-13 17:32:02.897071Z] Running create-virtualenv step. 10:32:02 INFO - Running pre-action listener: _resource_record_pre_action 10:32:02 INFO - Running main action method: create_virtualenv 10:32:02 INFO - Creating virtualenv /builds/slave/test/build/venv 10:32:02 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 10:32:02 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 10:32:02 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 10:32:02 INFO - Using real prefix '/usr' 10:32:02 INFO - New python executable in /builds/slave/test/build/venv/bin/python 10:32:03 INFO - Installing distribute.............................................................................................................................................................................................done. 10:32:05 INFO - Installing pip.................done. 10:32:05 INFO - Return code: 0 10:32:05 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 10:32:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 10:32:05 INFO - Reading from file tmpfile_stdout 10:32:05 INFO - Output received: 10:32:05 INFO - pip 1.5.5 from /builds/slave/test/build/venv/local/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 10:32:05 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 10:32:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:32:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:32:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:32:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:32:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:32:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:32:05 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 0x7f282c0faf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x25fe8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26cbca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26c8f60>, '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 0x26c9d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26ca1d0>, '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': 'ed14279e38b05397cf4aa391000001a4-1476379908.128739-48956615', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 10:32:05 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 10:32:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 10:32:05 INFO - Using env: {'DISPLAY': ':0', 10:32:05 INFO - 'HOME': '/home/cltbld', 10:32:05 INFO - 'LANG': 'en_US.UTF-8', 10:32:05 INFO - 'LANGUAGE': 'en_US:en', 10:32:05 INFO - 'LOGNAME': 'cltbld', 10:32:05 INFO - 'MAIL': '/var/mail/cltbld', 10:32:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:32:05 INFO - 'MOZ_NO_REMOTE': '1', 10:32:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:32:05 INFO - 'NO_EM_RESTART': '1', 10:32:05 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:32:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:32:05 INFO - 'PWD': '/builds/slave/test', 10:32:05 INFO - 'SHELL': '/bin/bash', 10:32:05 INFO - 'SHLVL': '1', 10:32:05 INFO - 'TERM': 'linux', 10:32:05 INFO - 'TMOUT': '86400', 10:32:05 INFO - 'USER': 'cltbld', 10:32:05 INFO - 'XDG_SESSION_COOKIE': 'ed14279e38b05397cf4aa391000001a4-1476379908.128739-48956615', 10:32:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:32:05 INFO - '_': '/tools/buildbot/bin/python'} 10:32:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:32:05 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 10:32:05 INFO - Cleaning up... 10:32:05 INFO - Return code: 0 10:32:05 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 10:32:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:32:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:32:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:32:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:32:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:32:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:32:05 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 0x7f282c0faf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x25fe8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26cbca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26c8f60>, '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 0x26c9d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26ca1d0>, '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': 'ed14279e38b05397cf4aa391000001a4-1476379908.128739-48956615', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 10:32:05 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 10:32:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 10:32:05 INFO - Using env: {'DISPLAY': ':0', 10:32:05 INFO - 'HOME': '/home/cltbld', 10:32:05 INFO - 'LANG': 'en_US.UTF-8', 10:32:05 INFO - 'LANGUAGE': 'en_US:en', 10:32:05 INFO - 'LOGNAME': 'cltbld', 10:32:05 INFO - 'MAIL': '/var/mail/cltbld', 10:32:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:32:05 INFO - 'MOZ_NO_REMOTE': '1', 10:32:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:32:05 INFO - 'NO_EM_RESTART': '1', 10:32:05 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:32:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:32:05 INFO - 'PWD': '/builds/slave/test', 10:32:05 INFO - 'SHELL': '/bin/bash', 10:32:05 INFO - 'SHLVL': '1', 10:32:05 INFO - 'TERM': 'linux', 10:32:05 INFO - 'TMOUT': '86400', 10:32:05 INFO - 'USER': 'cltbld', 10:32:05 INFO - 'XDG_SESSION_COOKIE': 'ed14279e38b05397cf4aa391000001a4-1476379908.128739-48956615', 10:32:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:32:05 INFO - '_': '/tools/buildbot/bin/python'} 10:32:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:32:06 INFO - Downloading/unpacking psutil>=3.1.1 10:32:06 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:32:06 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:32:06 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:32:06 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:32:06 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:32:06 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:32:08 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 10:32:08 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 10:32:08 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 10:32:08 INFO - Installing collected packages: psutil 10:32:08 INFO - Running setup.py install for psutil 10:32:08 INFO - building 'psutil._psutil_linux' extension 10:32:08 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 10:32:08 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 10:32:08 INFO - building 'psutil._psutil_posix' extension 10:32:08 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 10:32:08 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 10:32:08 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 10:32:08 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 10:32:08 INFO - Successfully installed psutil 10:32:08 INFO - Cleaning up... 10:32:08 INFO - Return code: 0 10:32:08 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 10:32:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:32:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:32:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:32:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:32:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:32:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:32:08 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 0x7f282c0faf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x25fe8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26cbca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26c8f60>, '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 0x26c9d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26ca1d0>, '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': 'ed14279e38b05397cf4aa391000001a4-1476379908.128739-48956615', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 10:32:08 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 10:32:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 10:32:08 INFO - Using env: {'DISPLAY': ':0', 10:32:08 INFO - 'HOME': '/home/cltbld', 10:32:08 INFO - 'LANG': 'en_US.UTF-8', 10:32:08 INFO - 'LANGUAGE': 'en_US:en', 10:32:08 INFO - 'LOGNAME': 'cltbld', 10:32:08 INFO - 'MAIL': '/var/mail/cltbld', 10:32:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:32:08 INFO - 'MOZ_NO_REMOTE': '1', 10:32:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:32:08 INFO - 'NO_EM_RESTART': '1', 10:32:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:32:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:32:08 INFO - 'PWD': '/builds/slave/test', 10:32:08 INFO - 'SHELL': '/bin/bash', 10:32:08 INFO - 'SHLVL': '1', 10:32:08 INFO - 'TERM': 'linux', 10:32:08 INFO - 'TMOUT': '86400', 10:32:08 INFO - 'USER': 'cltbld', 10:32:08 INFO - 'XDG_SESSION_COOKIE': 'ed14279e38b05397cf4aa391000001a4-1476379908.128739-48956615', 10:32:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:32:08 INFO - '_': '/tools/buildbot/bin/python'} 10:32:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:32:08 INFO - Downloading/unpacking mozsystemmonitor==0.3 10:32:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:32:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:32:08 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:32:08 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:32:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:32:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:32:10 INFO - Downloading mozsystemmonitor-0.3.tar.gz 10:32:10 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 10:32:10 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 10:32:10 INFO - Installing collected packages: mozsystemmonitor 10:32:10 INFO - Running setup.py install for mozsystemmonitor 10:32:11 INFO - Successfully installed mozsystemmonitor 10:32:11 INFO - Cleaning up... 10:32:11 INFO - Return code: 0 10:32:11 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 10:32:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:32:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:32:11 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:32:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:32:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:32:11 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:32:11 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f282c0faf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x25fe8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26cbca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26c8f60>, '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 0x26c9d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26ca1d0>, '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': 'ed14279e38b05397cf4aa391000001a4-1476379908.128739-48956615', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 10:32:11 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 10:32:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 10:32:11 INFO - Using env: {'DISPLAY': ':0', 10:32:11 INFO - 'HOME': '/home/cltbld', 10:32:11 INFO - 'LANG': 'en_US.UTF-8', 10:32:11 INFO - 'LANGUAGE': 'en_US:en', 10:32:11 INFO - 'LOGNAME': 'cltbld', 10:32:11 INFO - 'MAIL': '/var/mail/cltbld', 10:32:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:32:11 INFO - 'MOZ_NO_REMOTE': '1', 10:32:11 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:32:11 INFO - 'NO_EM_RESTART': '1', 10:32:11 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:32:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:32:11 INFO - 'PWD': '/builds/slave/test', 10:32:11 INFO - 'SHELL': '/bin/bash', 10:32:11 INFO - 'SHLVL': '1', 10:32:11 INFO - 'TERM': 'linux', 10:32:11 INFO - 'TMOUT': '86400', 10:32:11 INFO - 'USER': 'cltbld', 10:32:11 INFO - 'XDG_SESSION_COOKIE': 'ed14279e38b05397cf4aa391000001a4-1476379908.128739-48956615', 10:32:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:32:11 INFO - '_': '/tools/buildbot/bin/python'} 10:32:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:32:11 INFO - Downloading/unpacking jsonschema==2.5.1 10:32:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:32:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:32:11 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:32:11 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:32:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:32:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:32:13 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 10:32:13 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 10:32:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:32:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:32:13 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:32:13 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:32:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:32:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:32:13 INFO - Downloading functools32-3.2.3-2.tar.gz 10:32:13 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 10:32:13 INFO - warning: no files found matching '*.txt' 10:32:13 INFO - no previously-included directories found matching 'build' 10:32:13 INFO - no previously-included directories found matching 'dist' 10:32:13 INFO - no previously-included directories found matching '.git*' 10:32:13 INFO - Installing collected packages: jsonschema, functools32 10:32:13 INFO - Running setup.py install for functools32 10:32:13 INFO - warning: no files found matching '*.txt' 10:32:13 INFO - no previously-included directories found matching 'build' 10:32:13 INFO - no previously-included directories found matching 'dist' 10:32:13 INFO - no previously-included directories found matching '.git*' 10:32:13 INFO - Successfully installed jsonschema functools32 10:32:13 INFO - Cleaning up... 10:32:13 INFO - Return code: 0 10:32:13 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 10:32:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:32:13 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:32:13 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:32:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:32:13 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:32:13 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:32:13 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 0x7f282c0faf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x25fe8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26cbca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26c8f60>, '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 0x26c9d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26ca1d0>, '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': 'ed14279e38b05397cf4aa391000001a4-1476379908.128739-48956615', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 10:32:13 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 10:32:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 10:32:13 INFO - Using env: {'DISPLAY': ':0', 10:32:13 INFO - 'HOME': '/home/cltbld', 10:32:13 INFO - 'LANG': 'en_US.UTF-8', 10:32:13 INFO - 'LANGUAGE': 'en_US:en', 10:32:13 INFO - 'LOGNAME': 'cltbld', 10:32:13 INFO - 'MAIL': '/var/mail/cltbld', 10:32:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:32:13 INFO - 'MOZ_NO_REMOTE': '1', 10:32:13 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:32:13 INFO - 'NO_EM_RESTART': '1', 10:32:13 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:32:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:32:13 INFO - 'PWD': '/builds/slave/test', 10:32:13 INFO - 'SHELL': '/bin/bash', 10:32:13 INFO - 'SHLVL': '1', 10:32:13 INFO - 'TERM': 'linux', 10:32:13 INFO - 'TMOUT': '86400', 10:32:13 INFO - 'USER': 'cltbld', 10:32:13 INFO - 'XDG_SESSION_COOKIE': 'ed14279e38b05397cf4aa391000001a4-1476379908.128739-48956615', 10:32:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:32:13 INFO - '_': '/tools/buildbot/bin/python'} 10:32:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:32:13 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 10:32:13 INFO - Cleaning up... 10:32:13 INFO - Return code: 0 10:32:13 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 10:32:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:32:13 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:32:13 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:32:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:32:13 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:32:13 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:32:13 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 0x7f282c0faf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x25fe8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26cbca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26c8f60>, '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 0x26c9d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26ca1d0>, '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': 'ed14279e38b05397cf4aa391000001a4-1476379908.128739-48956615', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 10:32:13 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 10:32:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 10:32:13 INFO - Using env: {'DISPLAY': ':0', 10:32:13 INFO - 'HOME': '/home/cltbld', 10:32:13 INFO - 'LANG': 'en_US.UTF-8', 10:32:13 INFO - 'LANGUAGE': 'en_US:en', 10:32:13 INFO - 'LOGNAME': 'cltbld', 10:32:13 INFO - 'MAIL': '/var/mail/cltbld', 10:32:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:32:13 INFO - 'MOZ_NO_REMOTE': '1', 10:32:13 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:32:13 INFO - 'NO_EM_RESTART': '1', 10:32:13 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:32:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:32:13 INFO - 'PWD': '/builds/slave/test', 10:32:13 INFO - 'SHELL': '/bin/bash', 10:32:13 INFO - 'SHLVL': '1', 10:32:13 INFO - 'TERM': 'linux', 10:32:13 INFO - 'TMOUT': '86400', 10:32:13 INFO - 'USER': 'cltbld', 10:32:13 INFO - 'XDG_SESSION_COOKIE': 'ed14279e38b05397cf4aa391000001a4-1476379908.128739-48956615', 10:32:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:32:13 INFO - '_': '/tools/buildbot/bin/python'} 10:32:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:32:14 INFO - Downloading/unpacking blobuploader==1.2.4 10:32:14 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:32:14 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:32:14 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:32:14 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:32:14 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:32:14 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:32:16 INFO - Downloading blobuploader-1.2.4.tar.gz 10:32:16 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 10:32:16 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 10:32:16 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:32:16 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:32:16 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:32:16 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:32:16 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:32:16 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:32:16 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 10:32:16 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 10:32:16 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:32:16 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:32:16 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:32:16 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:32:16 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:32:16 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:32:16 INFO - Downloading docopt-0.6.1.tar.gz 10:32:16 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 10:32:16 INFO - Installing collected packages: blobuploader, requests, docopt 10:32:16 INFO - Running setup.py install for blobuploader 10:32:16 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 10:32:16 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 10:32:16 INFO - Running setup.py install for requests 10:32:17 INFO - Running setup.py install for docopt 10:32:17 INFO - Successfully installed blobuploader requests docopt 10:32:17 INFO - Cleaning up... 10:32:17 INFO - Return code: 0 10:32:17 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:32:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:32:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:32:17 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:32:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:32:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:32:17 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:32:17 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 0x7f282c0faf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x25fe8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26cbca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26c8f60>, '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 0x26c9d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26ca1d0>, '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': 'ed14279e38b05397cf4aa391000001a4-1476379908.128739-48956615', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 10:32:17 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 10:32:17 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 10:32:17 INFO - Using env: {'DISPLAY': ':0', 10:32:17 INFO - 'HOME': '/home/cltbld', 10:32:17 INFO - 'LANG': 'en_US.UTF-8', 10:32:17 INFO - 'LANGUAGE': 'en_US:en', 10:32:17 INFO - 'LOGNAME': 'cltbld', 10:32:17 INFO - 'MAIL': '/var/mail/cltbld', 10:32:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:32:17 INFO - 'MOZ_NO_REMOTE': '1', 10:32:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:32:17 INFO - 'NO_EM_RESTART': '1', 10:32:17 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:32:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:32:17 INFO - 'PWD': '/builds/slave/test', 10:32:17 INFO - 'SHELL': '/bin/bash', 10:32:17 INFO - 'SHLVL': '1', 10:32:17 INFO - 'TERM': 'linux', 10:32:17 INFO - 'TMOUT': '86400', 10:32:17 INFO - 'USER': 'cltbld', 10:32:17 INFO - 'XDG_SESSION_COOKIE': 'ed14279e38b05397cf4aa391000001a4-1476379908.128739-48956615', 10:32:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:32:17 INFO - '_': '/tools/buildbot/bin/python'} 10:32:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:32:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 10:32:17 INFO - Running setup.py (path:/tmp/pip-JEHLZr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 10:32:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 10:32:17 INFO - Running setup.py (path:/tmp/pip-4HxFjf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 10:32:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 10:32:17 INFO - Running setup.py (path:/tmp/pip-VcLsE0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 10:32:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 10:32:17 INFO - Running setup.py (path:/tmp/pip-OPdbJI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 10:32:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 10:32:17 INFO - Running setup.py (path:/tmp/pip-AsJser-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 10:32:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 10:32:18 INFO - Running setup.py (path:/tmp/pip-9wZJBh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 10:32:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 10:32:18 INFO - Running setup.py (path:/tmp/pip-9JrMYq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 10:32:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 10:32:18 INFO - Running setup.py (path:/tmp/pip-ajRpiS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 10:32:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 10:32:18 INFO - Running setup.py (path:/tmp/pip-DMVn2s-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 10:32:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 10:32:18 INFO - Running setup.py (path:/tmp/pip-wfvOFD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 10:32:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 10:32:18 INFO - Running setup.py (path:/tmp/pip-4ZhTq1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 10:32:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 10:32:18 INFO - Running setup.py (path:/tmp/pip-sGHlcX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 10:32:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 10:32:18 INFO - Running setup.py (path:/tmp/pip-LqPWwo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 10:32:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 10:32:18 INFO - Running setup.py (path:/tmp/pip-psMHq7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 10:32:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 10:32:18 INFO - Running setup.py (path:/tmp/pip-xpEAjN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 10:32:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 10:32:18 INFO - Running setup.py (path:/tmp/pip-J5iJYO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 10:32:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 10:32:18 INFO - Running setup.py (path:/tmp/pip-TPv9tt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 10:32:18 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 10:32:18 INFO - Running setup.py install for manifestparser 10:32:18 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 10:32:18 INFO - Running setup.py install for mozcrash 10:32:19 INFO - Running setup.py install for mozdebug 10:32:19 INFO - Running setup.py install for mozdevice 10:32:19 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 10:32:19 INFO - Installing dm script to /builds/slave/test/build/venv/bin 10:32:19 INFO - Running setup.py install for mozfile 10:32:19 INFO - Running setup.py install for mozhttpd 10:32:19 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 10:32:19 INFO - Running setup.py install for mozinfo 10:32:19 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 10:32:19 INFO - Running setup.py install for mozInstall 10:32:19 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 10:32:19 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 10:32:19 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 10:32:19 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 10:32:19 INFO - Running setup.py install for mozleak 10:32:19 INFO - Running setup.py install for mozlog 10:32:19 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 10:32:19 INFO - Running setup.py install for moznetwork 10:32:20 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 10:32:20 INFO - Running setup.py install for mozprocess 10:32:20 INFO - Running setup.py install for mozprofile 10:32:20 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 10:32:20 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 10:32:20 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 10:32:20 INFO - Running setup.py install for mozrunner 10:32:20 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 10:32:20 INFO - Running setup.py install for mozscreenshot 10:32:20 INFO - Running setup.py install for moztest 10:32:20 INFO - Running setup.py install for mozversion 10:32:20 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 10:32:20 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 10:32:20 INFO - Cleaning up... 10:32:20 INFO - Return code: 0 10:32:20 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:32: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')]} 10:32:20 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:32:20 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:32: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')]} 10:32:20 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:32:20 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:32:20 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 0x7f282c0faf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x25fe8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26cbca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26c8f60>, '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 0x26c9d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26ca1d0>, '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': 'ed14279e38b05397cf4aa391000001a4-1476379908.128739-48956615', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 10:32:20 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 10:32:20 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 10:32:20 INFO - Using env: {'DISPLAY': ':0', 10:32:20 INFO - 'HOME': '/home/cltbld', 10:32:20 INFO - 'LANG': 'en_US.UTF-8', 10:32:20 INFO - 'LANGUAGE': 'en_US:en', 10:32:20 INFO - 'LOGNAME': 'cltbld', 10:32:20 INFO - 'MAIL': '/var/mail/cltbld', 10:32:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:32:20 INFO - 'MOZ_NO_REMOTE': '1', 10:32:20 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:32:20 INFO - 'NO_EM_RESTART': '1', 10:32:20 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:32:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:32:20 INFO - 'PWD': '/builds/slave/test', 10:32:20 INFO - 'SHELL': '/bin/bash', 10:32:20 INFO - 'SHLVL': '1', 10:32:20 INFO - 'TERM': 'linux', 10:32:20 INFO - 'TMOUT': '86400', 10:32:20 INFO - 'USER': 'cltbld', 10:32:20 INFO - 'XDG_SESSION_COOKIE': 'ed14279e38b05397cf4aa391000001a4-1476379908.128739-48956615', 10:32:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:32:20 INFO - '_': '/tools/buildbot/bin/python'} 10:32:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:32:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 10:32:20 INFO - Running setup.py (path:/tmp/pip-bZBRpC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 10:32:20 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 10:32:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 10:32:20 INFO - Running setup.py (path:/tmp/pip-y2FHmk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 10:32:21 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 10:32:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 10:32:21 INFO - Running setup.py (path:/tmp/pip-ueKES1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 10:32:21 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 10:32:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 10:32:21 INFO - Running setup.py (path:/tmp/pip-GjSAqy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 10:32:21 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 10:32:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 10:32:21 INFO - Running setup.py (path:/tmp/pip-Rt194W-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 10:32:21 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 10:32:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 10:32:21 INFO - Running setup.py (path:/tmp/pip-ezQOCQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 10:32:21 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 10:32:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 10:32:21 INFO - Running setup.py (path:/tmp/pip-XA0NAJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 10:32:21 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 10:32:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 10:32:21 INFO - Running setup.py (path:/tmp/pip-ep2SfZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 10:32:21 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 10:32:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 10:32:21 INFO - Running setup.py (path:/tmp/pip-ynIA5U-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 10:32:21 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 10:32:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 10:32:21 INFO - Running setup.py (path:/tmp/pip-hMrzGE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 10:32:21 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.4 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 10:32:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 10:32:21 INFO - Running setup.py (path:/tmp/pip-7i92dy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 10:32:21 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 10:32:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 10:32:21 INFO - Running setup.py (path:/tmp/pip-l2yxA0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 10:32:21 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.23 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 10:32:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 10:32:21 INFO - Running setup.py (path:/tmp/pip-zPPQtO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 10:32:21 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 10:32:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 10:32:21 INFO - Running setup.py (path:/tmp/pip-MBjPlG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 10:32:21 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.12 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 10:32:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 10:32:21 INFO - Running setup.py (path:/tmp/pip-8ImBIx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 10:32:21 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 10:32:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 10:32:21 INFO - Running setup.py (path:/tmp/pip-n18EAQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 10:32:22 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 10:32:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 10:32:22 INFO - Running setup.py (path:/tmp/pip-9r3F1K-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 10:32:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 10:32:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 10:32:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 10:32:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 10:32:22 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 10:32:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 10:32:22 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 10:32:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:32:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:32:22 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:32:22 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:32:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:32:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:32:24 INFO - Downloading blessings-1.6.tar.gz 10:32:24 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 10:32:24 INFO - Installing collected packages: blessings 10:32:24 INFO - Running setup.py install for blessings 10:32:24 INFO - Successfully installed blessings 10:32:24 INFO - Cleaning up... 10:32:24 INFO - Return code: 0 10:32:24 INFO - Done creating virtualenv /builds/slave/test/build/venv. 10:32:24 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 10:32:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 10:32:24 INFO - Reading from file tmpfile_stdout 10:32:24 INFO - Current package versions: 10:32:24 INFO - argparse == 1.2.1 10:32:24 INFO - blessings == 1.6 10:32:24 INFO - blobuploader == 1.2.4 10:32:24 INFO - docopt == 0.6.1 10:32:24 INFO - functools32 == 3.2.3-2 10:32:24 INFO - jsonschema == 2.5.1 10:32:24 INFO - manifestparser == 1.1 10:32:24 INFO - mozInstall == 1.12 10:32:24 INFO - mozcrash == 0.17 10:32:24 INFO - mozdebug == 0.1 10:32:24 INFO - mozdevice == 0.48 10:32:24 INFO - mozfile == 1.2 10:32:24 INFO - mozhttpd == 0.7 10:32:24 INFO - mozinfo == 0.9 10:32:24 INFO - mozleak == 0.1 10:32:24 INFO - mozlog == 3.4 10:32:24 INFO - moznetwork == 0.27 10:32:24 INFO - mozprocess == 0.23 10:32:24 INFO - mozprofile == 0.28 10:32:24 INFO - mozrunner == 6.12 10:32:24 INFO - mozscreenshot == 0.1 10:32:24 INFO - mozsystemmonitor == 0.3 10:32:24 INFO - moztest == 0.7 10:32:24 INFO - mozversion == 1.4 10:32:24 INFO - psutil == 3.1.1 10:32:24 INFO - requests == 1.2.3 10:32:24 INFO - wsgiref == 0.1.2 10:32:24 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:32:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:32:24 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:32:24 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:32:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:32:24 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:32:24 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:32:24 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 0x7f282c0faf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x25fe8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26cbca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26c8f60>, '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 0x26c9d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26ca1d0>, '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': 'ed14279e38b05397cf4aa391000001a4-1476379908.128739-48956615', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 10:32:24 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 10:32:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 10:32:24 INFO - Using env: {'DISPLAY': ':0', 10:32:24 INFO - 'HOME': '/home/cltbld', 10:32:24 INFO - 'LANG': 'en_US.UTF-8', 10:32:24 INFO - 'LANGUAGE': 'en_US:en', 10:32:24 INFO - 'LOGNAME': 'cltbld', 10:32:24 INFO - 'MAIL': '/var/mail/cltbld', 10:32:24 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:32:24 INFO - 'MOZ_NO_REMOTE': '1', 10:32:24 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:32:24 INFO - 'NO_EM_RESTART': '1', 10:32:24 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:32:24 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:32:24 INFO - 'PWD': '/builds/slave/test', 10:32:24 INFO - 'SHELL': '/bin/bash', 10:32:24 INFO - 'SHLVL': '1', 10:32:24 INFO - 'TERM': 'linux', 10:32:24 INFO - 'TMOUT': '86400', 10:32:24 INFO - 'USER': 'cltbld', 10:32:24 INFO - 'XDG_SESSION_COOKIE': 'ed14279e38b05397cf4aa391000001a4-1476379908.128739-48956615', 10:32:24 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:32:24 INFO - '_': '/tools/buildbot/bin/python'} 10:32:24 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:32:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 10:32:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 10:32:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 10:32:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 10:32:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 10:32:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 10:32:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 10:32:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 10:32:24 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 10:32:24 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 10:32:24 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 10:32:24 INFO - Cleaning up... 10:32:24 INFO - Return code: 0 10:32:24 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 10:32:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:32:24 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:32:24 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:32:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:32:24 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:32:24 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:32:24 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f282c0faf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x25fe8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x26cbca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26c8f60>, '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 0x26c9d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26ca1d0>, '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': 'ed14279e38b05397cf4aa391000001a4-1476379908.128739-48956615', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 10:32:24 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 10:32:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 10:32:24 INFO - Using env: {'DISPLAY': ':0', 10:32:24 INFO - 'HOME': '/home/cltbld', 10:32:24 INFO - 'LANG': 'en_US.UTF-8', 10:32:24 INFO - 'LANGUAGE': 'en_US:en', 10:32:24 INFO - 'LOGNAME': 'cltbld', 10:32:24 INFO - 'MAIL': '/var/mail/cltbld', 10:32:24 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:32:24 INFO - 'MOZ_NO_REMOTE': '1', 10:32:24 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:32:24 INFO - 'NO_EM_RESTART': '1', 10:32:24 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:32:24 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:32:24 INFO - 'PWD': '/builds/slave/test', 10:32:24 INFO - 'SHELL': '/bin/bash', 10:32:24 INFO - 'SHLVL': '1', 10:32:24 INFO - 'TERM': 'linux', 10:32:24 INFO - 'TMOUT': '86400', 10:32:24 INFO - 'USER': 'cltbld', 10:32:24 INFO - 'XDG_SESSION_COOKIE': 'ed14279e38b05397cf4aa391000001a4-1476379908.128739-48956615', 10:32:24 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:32:24 INFO - '_': '/tools/buildbot/bin/python'} 10:32:24 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:32:24 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 10:32:24 INFO - Cleaning up... 10:32:24 INFO - Return code: 0 10:32:24 INFO - Running post-action listener: _resource_record_post_action 10:32:24 INFO - Running post-action listener: _start_resource_monitoring 10:32:24 INFO - Starting resource monitoring. 10:32:24 INFO - [mozharness: 2016-10-13 17:32:24.993667Z] Finished create-virtualenv step (success) 10:32:24 INFO - [mozharness: 2016-10-13 17:32:24.994191Z] Running install step. 10:32:24 INFO - Running pre-action listener: _resource_record_pre_action 10:32:24 INFO - Running main action method: install 10:32:24 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 10:32:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 10:32:25 INFO - Reading from file tmpfile_stdout 10:32:25 INFO - Detecting whether we're running mozinstall >=1.0... 10:32:25 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 10:32:25 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 10:32:25 INFO - Reading from file tmpfile_stdout 10:32:25 INFO - Output received: 10:32:25 INFO - Usage: mozinstall [options] installer 10:32:25 INFO - Options: 10:32:25 INFO - -h, --help show this help message and exit 10:32:25 INFO - -d DEST, --destination=DEST 10:32:25 INFO - Directory to install application into. [default: 10:32:25 INFO - "/builds/slave/test"] 10:32:25 INFO - --app=APP Application being installed. [default: firefox] 10:32:25 INFO - mkdir: /builds/slave/test/build/application 10:32:25 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 10:32:25 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 10:32:42 INFO - Reading from file tmpfile_stdout 10:32:42 INFO - Output received: 10:32:42 INFO - /builds/slave/test/build/application/firefox/firefox 10:32:42 INFO - Running post-action listener: _resource_record_post_action 10:32:42 INFO - [mozharness: 2016-10-13 17:32:42.311911Z] Finished install step (success) 10:32:42 INFO - [mozharness: 2016-10-13 17:32:42.312180Z] Running run-tests step. 10:32:42 INFO - Running pre-action listener: _resource_record_pre_action 10:32:42 INFO - Running main action method: run_tests 10:32:42 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 10:32:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 10:32:42 INFO - Python 2.7.3 10:32:42 INFO - Return code: 0 10:32:42 INFO - grabbing minidump binary from tooltool 10:32:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:32:42 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 0x26c8f60>, '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 0x26c9d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x26ca1d0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 10:32:42 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 10:32:42 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 10:32:42 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 10:32:42 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 10:32:42 INFO - Return code: 0 10:32:42 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 10:32:42 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 10:32:42 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 10:32:42 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 10:32:42 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 10:32:42 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/1476372626/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-035', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 10:32:42 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/1476372626/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-035 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 10:32:42 INFO - Using env: {'DISPLAY': ':0', 10:32:42 INFO - 'HOME': '/home/cltbld', 10:32:42 INFO - 'LANG': 'en_US.UTF-8', 10:32:42 INFO - 'LANGUAGE': 'en_US:en', 10:32:42 INFO - 'LOGNAME': 'cltbld', 10:32:42 INFO - 'MAIL': '/var/mail/cltbld', 10:32:42 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 10:32:42 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 10:32:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:32:42 INFO - 'MOZ_NO_REMOTE': '1', 10:32:42 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 10:32:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:32:42 INFO - 'NO_EM_RESTART': '1', 10:32:42 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:32:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:32:42 INFO - 'PWD': '/builds/slave/test', 10:32:42 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 10:32:42 INFO - 'SHELL': '/bin/bash', 10:32:42 INFO - 'SHLVL': '1', 10:32:42 INFO - 'TERM': 'linux', 10:32:42 INFO - 'TMOUT': '86400', 10:32:42 INFO - 'USER': 'cltbld', 10:32:42 INFO - 'XDG_SESSION_COOKIE': 'ed14279e38b05397cf4aa391000001a4-1476379908.128739-48956615', 10:32:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:32:42 INFO - '_': '/tools/buildbot/bin/python'} 10:32:42 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/1476372626/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-035', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 10:32:42 INFO - mozversion application_buildid: 20161013083026 10:32:42 INFO - mozversion application_changeset: 9b7507984e869d7aa052cefb11cd05d0895ca15e 10:32:42 INFO - mozversion application_display_name: Nightly 10:32:42 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 10:32:42 INFO - mozversion application_name: Firefox 10:32:42 INFO - mozversion application_remotingname: firefox 10:32:42 INFO - mozversion application_repository: https://hg.mozilla.org/integration/mozilla-inbound 10:32:42 INFO - mozversion application_vendor: Mozilla 10:32:42 INFO - mozversion application_version: 52.0a1 10:32:42 INFO - mozversion platform_buildid: 20161013083026 10:32:42 INFO - mozversion platform_changeset: 9b7507984e869d7aa052cefb11cd05d0895ca15e 10:32:42 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/mozilla-inbound 10:32:42 INFO - mozversion platform_version: 52.0a1 10:32:42 INFO - using testdate: 1476379962 10:32:42 INFO - actual date: 1476379962 10:32:42 INFO - starting webserver on 'localhost:38127' 10:32:42 INFO - SUITE-START | Running 2 tests 10:32:42 INFO - TEST-START | dromaeo_css 10:32:42 INFO - operating with platform_type : linux_ 10:32:42 INFO - Initialising browser for dromaeo_css test... 10:32:42 INFO - TEST-INFO | started process 11276 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpoNf9Yd/profile http://localhost:38127/getInfo.html) 10:32:47 INFO - PROCESS | 11276 | __metrics Screen width/height:1600/1200 10:32:47 INFO - PROCESS | 11276 | colorDepth:24 10:32:47 INFO - PROCESS | 11276 | Browser inner width/height: 1024/697 10:32:47 INFO - PROCESS | 11276 | __metrics 10:32:47 ERROR - PROCESS | 11276 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3083: TypeError: this.tabs is undefined 10:32:48 INFO - TEST-INFO | 11276: exit 0 10:32:48 INFO - Browser initialized. 10:32:48 INFO - Running cycle 1/1 for dromaeo_css test... 10:32:48 INFO - TEST-INFO | started process 11400 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpoNf9Yd/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 10:33:00 INFO - PROCESS | 11400 | RSS: Main: 185929728 10:33:00 INFO - PROCESS | 11400 | 10:33:50 INFO - PROCESS | 11400 | 1476380030218 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 10:36:01 INFO - PROCESS | 11400 | Cycle 1(1): loaded http://localhost:38127/tests/dromaeo/cssquery-dojo.html (next: http://localhost:38127/tests/dromaeo/cssquery-ext.html) 10:36:02 INFO - PROCESS | 11400 | RSS: Main: 202592256 10:36:02 INFO - PROCESS | 11400 | 10:39:05 INFO - PROCESS | 11400 | Cycle 1(1): loaded http://localhost:38127/tests/dromaeo/cssquery-ext.html (next: http://localhost:38127/tests/dromaeo/cssquery-jquery.html) 10:39:05 INFO - PROCESS | 11400 | RSS: Main: 203673600 10:39:05 INFO - PROCESS | 11400 | 10:42:07 INFO - PROCESS | 11400 | Cycle 1(1): loaded http://localhost:38127/tests/dromaeo/cssquery-jquery.html (next: http://localhost:38127/tests/dromaeo/cssquery-mootools.html) 10:42:08 INFO - PROCESS | 11400 | RSS: Main: 201687040 10:42:08 INFO - PROCESS | 11400 | 10:45:10 INFO - PROCESS | 11400 | Cycle 1(1): loaded http://localhost:38127/tests/dromaeo/cssquery-mootools.html (next: http://localhost:38127/tests/dromaeo/cssquery-prototype.html) 10:45:10 INFO - PROCESS | 11400 | RSS: Main: 195887104 10:45:10 INFO - PROCESS | 11400 | 10:48:13 INFO - PROCESS | 11400 | Cycle 1(1): loaded http://localhost:38127/tests/dromaeo/cssquery-prototype.html (next: http://localhost:38127/tests/dromaeo/cssquery-yui.html) 10:48:14 INFO - PROCESS | 11400 | RSS: Main: 199266304 10:48:14 INFO - PROCESS | 11400 | 10:51:16 INFO - PROCESS | 11400 | Cycle 1(1): loaded http://localhost:38127/tests/dromaeo/cssquery-yui.html (next: http://localhost:38127/tests/dromaeo/cssquery-dojo.html) 10:51:17 INFO - PROCESS | 11400 | RSS: Main: 199716864 10:51:17 INFO - PROCESS | 11400 | 10:51:17 INFO - PROCESS | 11400 | __start_tp_report 10:51:17 INFO - PROCESS | 11400 | _x_x_mozilla_page_load 10:51:17 INFO - PROCESS | 11400 | _x_x_mozilla_page_load_details 10:51:17 INFO - PROCESS | 11400 | |i|pagename|runs| 10:51:17 INFO - PROCESS | 11400 | |0;dojo.html;3040.9543856842165;3055.5569442430847;3057.1134371032404;3063.433264846003;3087.2744904947335;5240.742221866753;5273.071551754132;5278.762455689493;5288.101022826119;5415.512603865661;5298.576113910887;5306.310179676637;5337.359516857982;5383.488568585988;5436.374816896058;4796.424429068508;4865.464798872121;4876.780544875489;4927.901441971158;4944.728039957801;4883;4889.779959901795;5016.046951079302;5016.874578135539;5067.493250674921;4748.07412554552;4964.05682920244;4979.178435558147;5023.045621331954;5024.045431368028;4765.21373973294;4822.373091498082;4837.419509658864;4885.218365061573;4974.328465657162;4821.035792841446;4844.806207751686;4862.1491239033385;4868.391451068616;4909.803607855682;5287;5330.413654498041;5331.733413329318;5342.545883599899;5348.705821179834;5460.290162278918;5504.724763761836;5670.177824215507;5694.316681998145;5723.771049158028;5731;5734.340550836624;5758.136279558058;5797.188393624896;5844.123381492767;5352.598555108343;5358.089124848785;5365.4098049214945;5377.865553361158;5399.487048730364;5716.714164291769;5760.308762948389;5763.94236057634;5831.591788574844;5856.912146317809;5642.943570564324;5645.887082258414;5647.350554686182;5708.914366284509;5714.79998200061;5676.971615141898;5686.772529098873;5714.314282286152;5722.828315150552;5739.053056245672;5577.832665020056;5605.383407825136;5606.831795046155;5684.8294551163535;5704.315482142087;5695.259616249861;5696.943030569724;5702.116171993348;5709.600327977002;5724.8282551523525;4388.2759344707765;4410.580994805488;4413.889652758707;4419.668524860648;4485.349624304457;3919.8236079376497;3936.193080418507;3940.4483372327895;3970.8808735737975;3971.3050216212046;5394.136938089887;5505.834824955257;5520.089185284463;5540.667559946416;5543.667379957215;5720.1991721159075;5720.77116915327;5789.739461724233;5818.7672493100645;5918.112283157561;5414.214938833847;5462.453754624586;5484.204790305464;5484.533814625722;5527.972360138174;5036.093503169392;5039.319691841628;5042.596592272609;5043.2435134730085;5069.112905241642;5844.181814545882;5848.2689663792025;5860.619059761102;5904.025835737055;5943.346231914399;5778.306603207642;5779.7110144493445;5779.7977070804;5780.421957804186;5787.39232380594;6092.299385570539;6123.84690382744;6133.969330153321;6136.20229370179;6136.355682653257;5581.469760372758;5591.748371323219;5619.578531610064;5697.3448053474385;5756.71216439168;5741.196232527533;5786.479216870502;5799.072148456226;5810.331811841524;5816.651000939957;5553.500184983371;5666.575006874418;5667.319921609268;5670.886582268414;5682.488576028012;5549.556035517068;5578.386377498391;5584.664920104807;5589.636673616202;5696.601237913306;5527.281453411031;5531.778728850801;5562.833115006556;5563.860903477445;5583.888322233452;5687.459691329317;5690.4878560928055;5697.316322041382;5708.029634962149;5715.31416230055;5457.208704737712;5507.981023510663;5521.089020311603;5542.806001789918;5569.0254205513065 10:51:17 INFO - PROCESS | 11400 | |1;ext.html;561.5647872898504;577.8902008618364;578.0866231354461;582.0977484898409;593.1517929361012;40782.18435631289;42278.57721422789;42357.78821105894;45500.0899982001;45682.54317456824;43919.56080439195;44354.33468497967;44377.334339984845;44411.55588444114;44449.11101777962;8736.912630873689;8803.955980220122;8889.822203555925;8900.42147260426;8905.95547022264;8808.339374546902;8903.77740556488;8916.063813299575;8926.062763409846;8927.33045021626;8772.736817895473;8898.37711360205;8929.46423214606;8949.776255593597;8970.10298970101;8877.422967507091;8892.510911899843;8933.59798809055;8943.195112439911;8951.910480895205;8728.389012769108;8731.519766412845;8777.253933415668;8800.779980500474;8851.424657397249;40355.19289614191;40551;40628.79685601553;40734.388984164965;40991.18017639661;3228.725558327545;3242.983785081083;3587.9282414351565;3897.7271590988644;3924.960750392488;31104.37791244185;31317;31550.36899262025;31805.681943180505;32056.679433205834;4147.564505726916;4246.915061698749;4265.466816647919;4276.187524370391;4330.783460826978;298901;298944;299537;299750.99999999785;299902;54568;54848.22428411435;55089.11386076741;55135.44864551303;55438.72280638652;56700;56943.430565693816;57295.42704572984;57366.42633573694;57441.425585744444;13772.24252666113;13953.372098255602;13975.37110830015;13989.65025874341;14075;10845.945770271099;10884.564617415374;10897.400642964554;10902.291351062315;10954.671359859218;15197.392104315924;15667.37330506767;15847.445339413296;15858.841411585736;16026.233835048753;5647;5689.573282003784;5778.682172480554;5836.503897168704;5866.530677545786;896.2426749396749;985.4727720669407;996.0736515041082;1036.76154484469;1044.4412239451856;30788.846055769576;31115.533267001014;31237;31673.20816979594;31738.523922141187;1044.7910417916296;1068.2842495528014;1076.0638244726981;1124.2523721725124;1126.583164229224;15653.738504598025;16265.593360165854;16279.51161465158;16416.67166656684;16624.750628740578;515764;518715;520957;521055;522413;55344.446555534734;55858.16212756812;56802;56854;56888;1264.8418947631546;1295.7602843473987;1309.508934149694;1317.3610798762784;1326.4495234477583;29123.51553440802;30313.696863031088;30614.84692576523;30961.225969350948;31020.68979310178;47973.760131199124;49036;49066.26400603922;49173.50826491689;49244.26133607927;336229;340236;341426;341470;452743;27157.86421067882;27575.448491029667;27623.447531048863;27761.167164985083;27774.583381248893;45279.77360113178;45395.54604453913;45442.48532309018;45900.77049614731;46294.76852615715;39031.5728732964;39091.41362879616;39586.80206598948;40448.1910361797;41101.972450687776;38233.23533529369;38784.418233725955;40677;40948.590514094474;41420.585794141676;39006.80496597499;39394;39458;39761.60238397579;39822.60177398189;34055.82972085124;36356.27287454289;36881.815590922946;36933.23000775006;37561.624383756905;26761;27440.588391173747;27693.58459623067;29279.414411712074;29321.560176597795 10:51:17 INFO - PROCESS | 11400 | |2;jquery.html;377.7053897959591;385.167714386252;388.35339160298105;389.6843556719058;405.1875988642771;17897.194626241817;18777.530561735963;19454.805451945474;19602.411927642195;19609.411717648476;17958.461246162635;18239.726404103916;18334.724979125323;18421;18592.163352649128;5373.220882971967;5515.917261241075;5641.802536911209;5794.565407594426;5796.014677504813;5654.773809047633;5674.546036317105;5702.686352250625;5704.11586204139;5717.113847353646;5532.5573954083575;5652.547796176316;5680.31836179657;5705.172749951275;5707.62900411474;5655.971720141393;5683.062294721366;5701.600887937846;5712.65724056558;5715.485396369965;5379.892402151935;5425.674459532441;5522.171674248854;5534.363548191969;5538.972305138489;11561.364124973123;11699.532018719241;11756.177067605271;12065.758684826254;12275.69310767238;2203.4821816873023;2211;2215.1139544182297;2231.7991380775807;2428.757124287557;8629.352798540134;8647.705184656268;8827.514486703229;9119.726408207764;9221.400608960395;1768.5667011582245;1769.6106856491551;1783.8399816939977;1863.9161237744333;1870.8596855235912;71097.28902710958;77768.22231777666;78313;78745.60627196827;83127;9229.723108306762;10030.498475076363;10518.579256829642;10758.892411075789;10841.295315804447;14567.198804065667;14749.041312314665;14789;14796.630084247765;14797.778033329509;7084.716611335592;7187.101612298463;7492.625368731542;7688.9615551923;7708.9229107709325;6871.6564171791215;6943.826404339831;6972.477064220204;7143.464240182007;7143.607101609461;4315.331123675835;4454.198244316054;4560.5895469407915;4602.447706275201;4706.3175839503765;1814.8911065335858;1830.057520377007;1899.211827091769;1978.5251539630385;1986.8211860932586;908.4458480326995;967.7628980899725;970.5050424283525;992.3252188511736;1001.979960400788;17965.820341796676;19090.33183838559;19308.32420865263;19323.227070917004;19456.221751129797;933.3373304953424;936.7330310861372;969.7575606098476;983.1348413396308;983.7393090830935;10255.487225638688;10789;10899.782004359868;10912.563497460013;10926.508307126198;474096;475125;478616;485422;485435;81343.59328203321;83045.58477207576;83820.58089709512;84036;87890.56054719814;970.7136394763562;978.2369751593768;988.4810474500945;992.7071513903416;993.9950300248453;15733.606659833138;16900.492985210465;17287.913560432116;17356.39252626152;17447.939918846772;38755.41866871943;40116.3982540268;40170.79914600408;40524.59475405208;41870.371944421466;52183;52282.21576676429;52582.73708631432;52895;54488;7563;7578.280063393969;7723;7946.841063178819;8048.557329346942;9453.385529940531;12664.620061398173;12872.549460768829;12902.354882255662;12915;11195.60815371458;11436.714082148013;11651.941740291244;11735.47190376418;11928;10930.125589952626;11270.605528806453;11304.321740695585;11315.20793544444;11400.315981041163;11488.54045838157;11570.247933884271;11615.477303521531;11789.587364442203;11841;7429.331360177393;7555.433342499225;7672.884906726292;7820.217978202134;8149.348052155695;9406.294527910572;11573.190006332143;11595.18833681668;11774.3524106175;11814.763704726029 10:51:17 INFO - PROCESS | 11400 | |3;mootools.html;1464.4435114656428;1465.9340329685162;1621.5459671292035;1760.0319824096744;1768.4164225805484;8072;8342.958285208566;8644.049154592998;9395.389299695524;9397.530123493814;8654.43746156501;8968.820623587524;8981.640734370618;9176;9207.171354578086;2327.8021368183727;2345.1323010486144;2354.799842013431;2360.433495960974;2360.445295355599;2326.162581470669;2360.775726305998;2362.444825466014;2380;2380.0360853854218;2352.3766201956496;2387.868667223302;2391.940201494959;2394.1141777542334;2398.1486572266854;2285.931422057341;2286.748457669655;2310.734265559457;2316.617758069925;2320.6170981787986;2293.8853057347064;2302;2309.815214782813;2312.7687231276905;2315.9189428369928;9170.86243706345;9236.538173091385;9274.211692006187;9314.347995640308;9327.393719408217;5159.406668233164;5189.662671926313;5331.44019877915;5356.464353564613;5370.919436208421;3358.9664103358896;3394.2023624448234;3476.200473891019;3514.8242587870504;3529.0118766745095;1114.504045699664;1154.203599516331;1167.3229526874393;1181.734109825291;1185.5257896841333;12725.363731813371;12729.554465593752;12775.169613975062;12797.1681840681;12836.743265134739;4415.381846541487;4421.093675796454;4645.976770116128;4653.7207767534055;4673.275642275453;10699;10766.138708903269;10842.457877106113;10850.403227822546;10872.45637718111;5215.55667768244;5220.295260139908;5230.424653288135;5247.763850626731;5261.736913154404;4701.2242979908615;4817.975910120427;4853.757312134379;4870.561649451495;4951.678140920829;3640.508531348287;3715.3126671565847;3730.720195985312;3801.657850793442;3868.303705333011;1076.1068313299943;1076.7308172956762;1080.9621663241749;1097.868255809308;1121.6747143328507;785.3834739729285;959.5729900194347;963.5471328475605;969.8351280282369;984.5471083301761;6070.392960703983;6128.540359473057;6135.0797380392405;6145.078238264206;6251.374862513712;436.1190395401272;439.25326944194995;443.4169067675996;446.76768080598555;447.2977425442025;3982.1040265939932;4002.9599704002585;4022.778747168934;4075.1849630074103;4095.795210239476;11059.668209953714;11411;11421.086313094933;11431.542738290374;11562.364069976233;11383.235598482248;11414.315141091562;11424.543018279343;11456.255343402652;11463.140264480196;8267.83464330722;8346.540940248344;8451.323894088458;8476.618552165168;8479.576021198915;5992.790252341147;6101;6115.510759139347;6119.388061193845;6124.265088189446;10208.081272685495;10472.790544189225;10505.15958723285;10591.682249532527;10640.255182137176;10622.256442048982;10661.360318380923;10672.733181670521;10684.732881678021;10703.94648026786;7644.617769111634;7707.88438173439;7715;7756.495827771177;7763.951866498176;8749.868751968854;8774.956125219333;8788.912110879066;8790.824183516423;8820.162084601952;7891.408144389308;7907.209279072277;7999.880001799861;8127.512349258827;8138.552379619177;7670.654820532978;7677.424193185645;7747.147813740597;7752.302292793675;7770.805729856799;6835.384815366442;6849.315068493111;6949.30506949301;6959.095317608881;6978.616176110363;5157.149070403341;5256.737163141904;5264.921026184534;5275.762590683506;5424.484673955968;5270.920936186037;5337.519623233928;5366.597505187048;5414.810481633124;5450.836474905759 10:51:17 INFO - PROCESS | 11400 | |4;prototype.html;302.3665420943125;310.8989578387024;316.09281362489656;317.8871500617281;322.18165858718856;5291.597726602454;5446;5474.850281440892;5570.554355651549;5574.804881829142;5193.558547523456;5311.601629877755;5350.796070884049;5387.868547605008;5406.486383793534;4210.831566737327;4212.852550160745;4214.178235244129;4250.91498170038;4265.189613973335;4158.97920510397;4206.810693518799;4222.366645003259;4230.217409779185;4262.893427664302;4196.769177695225;4202.306619407794;4219.409282700424;4230.223306211398;4238.87283381499;4181.414601955728;4209.789510524477;4210.052738133926;4211.115665710205;4215.650991682663;3705.5368078990127;3710.2208536207427;3726.273376691546;3733.5146430964073;3741.0920430580327;5099.209622508517;5345.251664766935;5364.275822763916;5366.524205843424;5374.5700343972385;4803.135435621587;4812.494688057738;4817.879553011203;4824.276358546211;4827.275908613701;5467.781288748445;5712.2574065371655;5715.342735585377;5739.196512488255;5802.941970580325;3959.960400395988;3960.861369852041;3963.870296965351;3973.781442020688;4014.2774300625874;5962.284525856881;5992.43071908168;6003.189569408118;6054.303755068179;6059.848503787396;3983.343106172781;4124.154548317588;4124.505059392832;4131.566185550534;4134.359174327984;4108.609682080198;4140.565240649748;4146.295129827937;4152.273352163359;4157.376393540932;4750.501197374295;4795.184818580849;4802.6638135330195;4820.590249828804;4831.879203019953;5719.57103217252;5731.197632331477;5759.366469688331;5759.798407055733;5777;1415.5257988573737;1422.9928850355889;1426.2440906319666;1427.3006226948721;1432.477145841781;876.7545087375545;894.6019021535484;896.3859756067114;897;898.7213963671282;4915.336429581961;4923.90152196954;4954.653174277766;4956.925646115311;4960.875978100504;5029.899402011939;5079.517445842639;5104.285400043997;5147.974260128675;5149.304843846107;4750.287456881426;4901.3383193269165;4935.481774413706;4951.70289782607;4956.553910148032;2749.748864266754;2750.510787737101;2752.8348299101717;2754.911809835144;2772.9324210179225;5297.231901374279;5427;5444.237806707064;5446.537044351275;5483.643563168382;4870.318155458239;5224.294720212799;5277.419483856773;5302.965921645319;5323.463597858184;5381.735292206328;5387.434319396485;5410.594205434608;5413.512783849473;5452.672839629635;5124.564412024871;5152.76812543444;5157.329547158845;5261.631685782112;5318.457647282399;5033.84898453047;5435.864103397288;5805.651660900359;5819.301683797971;5823;6212.409821066992;6215.06773983906;6288.1013771461985;6301.558890877594;6319.776913773916;3832.693384529175;3880.96119038806;3982;4031.9798401007806;4092.3043082676613;5781.5663825214115;5813.273340832396;5817.970910145422;5821.883562328645;5831.970840145772;5698.743556539883;5699.7435115419075;5722.427757224411;5737;5775.306963164448;5571.415001424792;5645.350784659652;5659.773609055756;5673.574481913791;5701.942980570308;5556.944430555643;5592.154588985706;5597.776088956396;5650.29371328584;5651.491365777099;5508.394076651645;5699.857503562444;5706.914396284142;5716.084796753768;5762.654240745569;5553.500554850087;5580.358258800127;5600;5634.6337488063145;5641.26663533738 10:51:17 INFO - PROCESS | 11400 | |5;yui.html;715.2882881532872;725.5610355734781;748.2517482517483;748.6331697468239;805.1505661527086;14720.190389528572;15082.472113476017;16232.51302460925;16278.593035174126;16329.673406531861;14477.710445791077;14481.855181448182;14515.927420362883;14573.34419951102;14787.92606036971;767.9462437629368;796.5937371940295;798.6366203377464;809.1544336168718;811.0915774332726;802.891609632698;806.9112397636255;807.1807115777461;807.2976510435929;808.0908977400425;836.5524444422235;839.0518713853337;839.2279103225017;839.7396806989852;840.260570697785;817.3257062923083;822.411975437565;831.6590198018783;833.0586437325844;833.2167762303445;604.6553464525223;604.8155312629647;605.1104875832519;605.772835186805;609.6860117039728;15071.321790519343;15135.924320378437;15148.772768408482;15167.165805880672;15219.543413697607;13956;14041.719165616732;14323.283835808272;14416.855831441657;14432.278386080654;11612.36132012739;11743.94128029363;11768.235064720766;12026.579069732517;12161.452734626875;3889.1638297765835;3919.8432062717457;3940.566537680853;3979.621935916083;4044.959550404488;59866;61781.38218617801;62768;68938.3106168937;76382;10797.892021079846;10934;11166.218364714554;11265.690533440626;11292.604758833402;19989.600207995758;20016.399508014783;20021.09905054276;20029.399118026482;20030.198792048155;7542.2834830691;7659.502132361378;7672.232776722283;7894.447388682737;8188.058373287029;4311.568843115726;4397.692161548661;4412.3160910059;4552;4597.678162528591;3121.204092956327;3233.6766323367474;3235.8705651773666;3243.2216268095485;3259.3970115528705;599.0714392691398;601.6119602856221;605.9091136329586;607.8389226854887;636.0491065856575;615.1480199923138;616.340515648261;670.1489108831756;685.3044160177424;692.7783109405043;9703.5148242589;9815.558299876522;9951.502424878872;9972.950135249277;10113.29206955506;592.6947621974687;665.787574950864;674.6188403551978;674.6592970549939;679.0527214535794;4572.131295053996;4632.559906808848;4678.6491013174145;4721.480637129913;4889.828855990023;96886;114670;116565.4171729136;119453.40273298578;122502;91256;92144.53927730318;106871;108020;108077;84693;94062;95620.9999999986;98031.50984245176;99395.50302248442;8649.481031138152;8856.202941735275;8909.242714369091;8981.461112333282;9002.099790020946;52885.7355713219;53165;53364;54066.18900716414;54722.726386367816;71312.28687713265;74915.62879670318;78687;81726;82306.58846705729;10918.78162436731;11161.832572511581;11216.102711783202;11226.66320010401;11396.373199474108;13180.275084870424;13400.463981441024;13688.45246190181;13774.793378099135;13880.444782208599;13346.466141354236;13671.38478768438;14007.719845603235;14407.639809004859;14447.060941038799;12705.55530556463;13599.52401665937;14052.086614370442;14411.78382324245;14613;13129.474821007434;13282.667933301746;13671.17972921628;13707.314634268447;14062.226577537924;10807.621733239299;11142.498587563417;11450;11697.707557310794;12087.879121208676;11097.445127743418;11552.480138393625;11626.476808543466;12045.63863084109;12060.819087713517 10:51:17 INFO - PROCESS | 11400 | __end_tp_report 10:51:17 INFO - PROCESS | 11400 | __start_cc_report 10:51:17 INFO - PROCESS | 11400 | _x_x_mozilla_cycle_collect,331 10:51:17 INFO - PROCESS | 11400 | __end_cc_report 10:51:17 INFO - PROCESS | 11400 | __startTimestamp1476381077224__endTimestamp 10:51:17 INFO - PROCESS | 11400 | 10:51:17 INFO - PROCESS | 11400 | ------- Summary: start ------- 10:51:17 INFO - PROCESS | 11400 | Number of tests: 6 10:51:17 INFO - PROCESS | 11400 | 10:51:17 INFO - PROCESS | 11400 | [#0] dojo.html Cycles:165 Average:5341.17 Median:5543.67 stddev:606.00 (10.9%) stddev-sans-first:580.37 10:51:17 INFO - PROCESS | 11400 | Values: 3041.0 3055.6 3057.1 3063.4 3087.3 5240.7 5273.1 5278.8 5288.1 5415.5 5298.6 5306.3 5337.4 5383.5 5436.4 4796.4 4865.5 4876.8 4927.9 4944.7 4883.0 4889.8 5016.0 5016.9 5067.5 4748.1 4964.1 4979.2 5023.0 5024.0 4765.2 4822.4 4837.4 4885.2 4974.3 4821.0 4844.8 4862.1 4868.4 4909.8 5287.0 5330.4 5331.7 5342.5 5348.7 5460.3 5504.7 5670.2 5694.3 5723.8 5731.0 5734.3 5758.1 5797.2 5844.1 5352.6 5358.1 5365.4 5377.9 5399.5 5716.7 5760.3 5763.9 5831.6 5856.9 5642.9 5645.9 5647.4 5708.9 5714.8 5677.0 5686.8 5714.3 5722.8 5739.1 5577.8 5605.4 5606.8 5684.8 5704.3 5695.3 5696.9 5702.1 5709.6 5724.8 4388.3 4410.6 4413.9 4419.7 4485.3 3919.8 3936.2 3940.4 3970.9 3971.3 5394.1 5505.8 5520.1 5540.7 5543.7 5720.2 5720.8 5789.7 5818.8 5918.1 5414.2 5462.5 5484.2 5484.5 5528.0 5036.1 5039.3 5042.6 5043.2 5069.1 5844.2 5848.3 5860.6 5904.0 5943.3 5778.3 5779.7 5779.8 5780.4 5787.4 6092.3 6123.8 6134.0 6136.2 6136.4 5581.5 5591.7 5619.6 5697.3 5756.7 5741.2 5786.5 5799.1 5810.3 5816.7 5553.5 5666.6 5667.3 5670.9 5682.5 5549.6 5578.4 5584.7 5589.6 5696.6 5527.3 5531.8 5562.8 5563.9 5583.9 5687.5 5690.5 5697.3 5708.0 5715.3 5457.2 5508.0 5521.1 5542.8 5569.0 10:51:17 INFO - PROCESS | 11400 | 10:51:17 INFO - PROCESS | 11400 | [#1] ext.html Cycles:180 Average:55454.17 Median:40705.69 stddev:107506.44 (264.1%) stddev-sans-first:107729.02 10:51:17 INFO - PROCESS | 11400 | Values: 561.6 577.9 578.1 582.1 593.2 40782.2 42278.6 42357.8 45500.1 45682.5 43919.6 44354.3 44377.3 44411.6 44449.1 8736.9 8804.0 8889.8 8900.4 8906.0 8808.3 8903.8 8916.1 8926.1 8927.3 8772.7 8898.4 8929.5 8949.8 8970.1 8877.4 8892.5 8933.6 8943.2 8951.9 8728.4 8731.5 8777.3 8800.8 8851.4 40355.2 40551.0 40628.8 40734.4 40991.2 3228.7 3243.0 3587.9 3897.7 3925.0 31104.4 31317.0 31550.4 31805.7 32056.7 4147.6 4246.9 4265.5 4276.2 4330.8 298901.0 298944.0 299537.0 299751.0 299902.0 54568.0 54848.2 55089.1 55135.4 55438.7 56700.0 56943.4 57295.4 57366.4 57441.4 13772.2 13953.4 13975.4 13989.7 14075.0 10845.9 10884.6 10897.4 10902.3 10954.7 15197.4 15667.4 15847.4 15858.8 16026.2 5647.0 5689.6 5778.7 5836.5 5866.5 896.2 985.5 996.1 1036.8 1044.4 30788.8 31115.5 31237.0 31673.2 31738.5 1044.8 1068.3 1076.1 1124.3 1126.6 15653.7 16265.6 16279.5 16416.7 16624.8 515764.0 518715.0 520957.0 521055.0 522413.0 55344.4 55858.2 56802.0 56854.0 56888.0 1264.8 1295.8 1309.5 1317.4 1326.4 29123.5 30313.7 30614.8 30961.2 31020.7 47973.8 49036.0 49066.3 49173.5 49244.3 336229.0 340236.0 341426.0 341470.0 452743.0 27157.9 27575.4 27623.4 27761.2 27774.6 45279.8 45395.5 45442.5 45900.8 46294.8 39031.6 39091.4 39586.8 40448.2 41102.0 38233.2 38784.4 40677.0 40948.6 41420.6 39006.8 39394.0 39458.0 39761.6 39822.6 34055.8 36356.3 36881.8 36933.2 37561.6 26761.0 27440.6 27693.6 29279.4 29321.6 10:51:17 INFO - PROCESS | 11400 | 10:51:17 INFO - PROCESS | 11400 | [#2] jquery.html Cycles:180 Average:27622.66 Median:4581.52 stddev:78988.30 (1724.1%) stddev-sans-first:79183.39 10:51:17 INFO - PROCESS | 11400 | Values: 377.7 385.2 388.4 389.7 405.2 17897.2 18777.5 19454.8 19602.4 19609.4 17958.5 18239.7 18334.7 18421.0 18592.2 5373.2 5515.9 5641.8 5794.6 5796.0 5654.8 5674.5 5702.7 5704.1 5717.1 5532.6 5652.5 5680.3 5705.2 5707.6 5656.0 5683.1 5701.6 5712.7 5715.5 5379.9 5425.7 5522.2 5534.4 5539.0 11561.4 11699.5 11756.2 12065.8 12275.7 2203.5 2211.0 2215.1 2231.8 2428.8 8629.4 8647.7 8827.5 9119.7 9221.4 1768.6 1769.6 1783.8 1863.9 1870.9 71097.3 77768.2 78313.0 78745.6 83127.0 9229.7 10030.5 10518.6 10758.9 10841.3 14567.2 14749.0 14789.0 14796.6 14797.8 7084.7 7187.1 7492.6 7689.0 7708.9 6871.7 6943.8 6972.5 7143.5 7143.6 4315.3 4454.2 4560.6 4602.4 4706.3 1814.9 1830.1 1899.2 1978.5 1986.8 908.4 967.8 970.5 992.3 1002.0 17965.8 19090.3 19308.3 19323.2 19456.2 933.3 936.7 969.8 983.1 983.7 10255.5 10789.0 10899.8 10912.6 10926.5 474096.0 475125.0 478616.0 485422.0 485435.0 81343.6 83045.6 83820.6 84036.0 87890.6 970.7 978.2 988.5 992.7 994.0 15733.6 16900.5 17287.9 17356.4 17447.9 38755.4 40116.4 40170.8 40524.6 41870.4 52183.0 52282.2 52582.7 52895.0 54488.0 7563.0 7578.3 7723.0 7946.8 8048.6 9453.4 12664.6 12872.5 12902.4 12915.0 11195.6 11436.7 11651.9 11735.5 11928.0 10930.1 11270.6 11304.3 11315.2 11400.3 11488.5 11570.2 11615.5 11789.6 11841.0 7429.3 7555.4 7672.9 7820.2 8149.3 9406.3 11573.2 11595.2 11774.4 11814.8 10:51:17 INFO - PROCESS | 11400 | 10:51:17 INFO - PROCESS | 11400 | [#3] mootools.html Cycles:180 Average:5919.93 Median:447.03 stddev:3474.91 (777.3%) stddev-sans-first:3468.53 10:51:17 INFO - PROCESS | 11400 | Values: 1464.4 1465.9 1621.5 1760.0 1768.4 8072.0 8343.0 8644.0 9395.4 9397.5 8654.4 8968.8 8981.6 9176.0 9207.2 2327.8 2345.1 2354.8 2360.4 2360.4 2326.2 2360.8 2362.4 2380.0 2380.0 2352.4 2387.9 2391.9 2394.1 2398.1 2285.9 2286.7 2310.7 2316.6 2320.6 2293.9 2302.0 2309.8 2312.8 2315.9 9170.9 9236.5 9274.2 9314.3 9327.4 5159.4 5189.7 5331.4 5356.5 5370.9 3359.0 3394.2 3476.2 3514.8 3529.0 1114.5 1154.2 1167.3 1181.7 1185.5 12725.4 12729.6 12775.2 12797.2 12836.7 4415.4 4421.1 4646.0 4653.7 4673.3 10699.0 10766.1 10842.5 10850.4 10872.5 5215.6 5220.3 5230.4 5247.8 5261.7 4701.2 4818.0 4853.8 4870.6 4951.7 3640.5 3715.3 3730.7 3801.7 3868.3 1076.1 1076.7 1081.0 1097.9 1121.7 785.4 959.6 963.5 969.8 984.5 6070.4 6128.5 6135.1 6145.1 6251.4 436.1 439.3 443.4 446.8 447.3 3982.1 4003.0 4022.8 4075.2 4095.8 11059.7 11411.0 11421.1 11431.5 11562.4 11383.2 11414.3 11424.5 11456.3 11463.1 8267.8 8346.5 8451.3 8476.6 8479.6 5992.8 6101.0 6115.5 6119.4 6124.3 10208.1 10472.8 10505.2 10591.7 10640.3 10622.3 10661.4 10672.7 10684.7 10703.9 7644.6 7707.9 7715.0 7756.5 7764.0 8749.9 8775.0 8788.9 8790.8 8820.2 7891.4 7907.2 7999.9 8127.5 8138.6 7670.7 7677.4 7747.1 7752.3 7770.8 6835.4 6849.3 6949.3 6959.1 6978.6 5157.1 5256.7 5264.9 5275.8 5424.5 5270.9 5337.5 5366.6 5414.8 5450.8 10:51:17 INFO - PROCESS | 11400 | 10:51:17 INFO - PROCESS | 11400 | [#4] prototype.html Cycles:180 Average:4651.31 Median:5175.44 stddev:1378.27 (26.6%) stddev-sans-first:1342.92 10:51:17 INFO - PROCESS | 11400 | Values: 302.4 310.9 316.1 317.9 322.2 5291.6 5446.0 5474.9 5570.6 5574.8 5193.6 5311.6 5350.8 5387.9 5406.5 4210.8 4212.9 4214.2 4250.9 4265.2 4159.0 4206.8 4222.4 4230.2 4262.9 4196.8 4202.3 4219.4 4230.2 4238.9 4181.4 4209.8 4210.1 4211.1 4215.7 3705.5 3710.2 3726.3 3733.5 3741.1 5099.2 5345.3 5364.3 5366.5 5374.6 4803.1 4812.5 4817.9 4824.3 4827.3 5467.8 5712.3 5715.3 5739.2 5802.9 3960.0 3960.9 3963.9 3973.8 4014.3 5962.3 5992.4 6003.2 6054.3 6059.8 3983.3 4124.2 4124.5 4131.6 4134.4 4108.6 4140.6 4146.3 4152.3 4157.4 4750.5 4795.2 4802.7 4820.6 4831.9 5719.6 5731.2 5759.4 5759.8 5777.0 1415.5 1423.0 1426.2 1427.3 1432.5 876.8 894.6 896.4 897.0 898.7 4915.3 4923.9 4954.7 4956.9 4960.9 5029.9 5079.5 5104.3 5148.0 5149.3 4750.3 4901.3 4935.5 4951.7 4956.6 2749.7 2750.5 2752.8 2754.9 2772.9 5297.2 5427.0 5444.2 5446.5 5483.6 4870.3 5224.3 5277.4 5303.0 5323.5 5381.7 5387.4 5410.6 5413.5 5452.7 5124.6 5152.8 5157.3 5261.6 5318.5 5033.8 5435.9 5805.7 5819.3 5823.0 6212.4 6215.1 6288.1 6301.6 6319.8 3832.7 3881.0 3982.0 4032.0 4092.3 5781.6 5813.3 5818.0 5821.9 5832.0 5698.7 5699.7 5722.4 5737.0 5775.3 5571.4 5645.4 5659.8 5673.6 5701.9 5556.9 5592.2 5597.8 5650.3 5651.5 5508.4 5699.9 5706.9 5716.1 5762.7 5553.5 5580.4 5600.0 5634.6 5641.3 10:51:17 INFO - PROCESS | 11400 | 10:51:17 INFO - PROCESS | 11400 | [#5] yui.html Cycles:180 Average:20789.97 Median:4482.16 stddev:30414.97 (678.6%) stddev-sans-first:30462.94 10:51:17 INFO - PROCESS | 11400 | Values: 715.3 725.6 748.3 748.6 805.2 14720.2 15082.5 16232.5 16278.6 16329.7 14477.7 14481.9 14515.9 14573.3 14787.9 767.9 796.6 798.6 809.2 811.1 802.9 806.9 807.2 807.3 808.1 836.6 839.1 839.2 839.7 840.3 817.3 822.4 831.7 833.1 833.2 604.7 604.8 605.1 605.8 609.7 15071.3 15135.9 15148.8 15167.2 15219.5 13956.0 14041.7 14323.3 14416.9 14432.3 11612.4 11743.9 11768.2 12026.6 12161.5 3889.2 3919.8 3940.6 3979.6 4045.0 59866.0 61781.4 62768.0 68938.3 76382.0 10797.9 10934.0 11166.2 11265.7 11292.6 19989.6 20016.4 20021.1 20029.4 20030.2 7542.3 7659.5 7672.2 7894.4 8188.1 4311.6 4397.7 4412.3 4552.0 4597.7 3121.2 3233.7 3235.9 3243.2 3259.4 599.1 601.6 605.9 607.8 636.0 615.1 616.3 670.1 685.3 692.8 9703.5 9815.6 9951.5 9973.0 10113.3 592.7 665.8 674.6 674.7 679.1 4572.1 4632.6 4678.6 4721.5 4889.8 96886.0 114670.0 116565.4 119453.4 122502.0 91256.0 92144.5 106871.0 108020.0 108077.0 84693.0 94062.0 95621.0 98031.5 99395.5 8649.5 8856.2 8909.2 8981.5 9002.1 52885.7 53165.0 53364.0 54066.2 54722.7 71312.3 74915.6 78687.0 81726.0 82306.6 10918.8 11161.8 11216.1 11226.7 11396.4 13180.3 13400.5 13688.5 13774.8 13880.4 13346.5 13671.4 14007.7 14407.6 14447.1 12705.6 13599.5 14052.1 14411.8 14613.0 13129.5 13282.7 13671.2 13707.3 14062.2 10807.6 11142.5 11450.0 11697.7 12087.9 11097.4 11552.5 11626.5 12045.6 12060.8 10:51:17 INFO - PROCESS | 11400 | -------- Summary: end -------- 10:51:17 INFO - PROCESS | 11400 | 10:51:18 INFO - TEST-INFO | 11400: exit 0 10:51:18 INFO - TEST-OK | dromaeo_css | took 1115643ms 10:51:18 INFO - TEST-START | kraken 10:51:18 INFO - operating with platform_type : linux_ 10:51:18 INFO - Initialising browser for kraken test... 10:51:18 INFO - TEST-INFO | started process 11758 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpi15fB9/profile http://localhost:38127/getInfo.html) 10:51:22 INFO - PROCESS | 11758 | __metrics Screen width/height:1600/1200 10:51:22 INFO - PROCESS | 11758 | colorDepth:24 10:51:22 INFO - PROCESS | 11758 | Browser inner width/height: 1024/697 10:51:22 INFO - PROCESS | 11758 | __metrics 10:51:23 ERROR - PROCESS | 11758 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3083: TypeError: this.tabs is undefined 10:51:24 INFO - TEST-INFO | 11758: exit 0 10:51:24 INFO - Browser initialized. 10:51:24 INFO - Running cycle 1/1 for kraken test... 10:51:24 INFO - TEST-INFO | started process 11883 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpi15fB9/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 10:51:36 INFO - PROCESS | 11883 | RSS: Main: 185511936 10:51:36 INFO - PROCESS | 11883 | 10:51:38 INFO - PROCESS | 11883 | Cycle 1(1): loaded http://localhost:38127/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:38127/tests/kraken/driver.html?testName=audio-beat-detection) 10:51:39 INFO - PROCESS | 11883 | RSS: Main: 199368704 10:51:39 INFO - PROCESS | 11883 | 10:51:42 INFO - PROCESS | 11883 | Cycle 1(1): loaded http://localhost:38127/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:38127/tests/kraken/driver.html?testName=audio-dft) 10:51:43 INFO - PROCESS | 11883 | RSS: Main: 197898240 10:51:43 INFO - PROCESS | 11883 | 10:51:46 INFO - PROCESS | 11883 | Cycle 1(1): loaded http://localhost:38127/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:38127/tests/kraken/driver.html?testName=audio-fft) 10:51:46 INFO - PROCESS | 11883 | RSS: Main: 192942080 10:51:46 INFO - PROCESS | 11883 | 10:51:48 INFO - PROCESS | 11883 | Cycle 1(1): loaded http://localhost:38127/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:38127/tests/kraken/driver.html?testName=audio-oscillator) 10:51:49 INFO - PROCESS | 11883 | RSS: Main: 193478656 10:51:49 INFO - PROCESS | 11883 | 10:51:51 INFO - PROCESS | 11883 | Cycle 1(1): loaded http://localhost:38127/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:38127/tests/kraken/driver.html?testName=imaging-gaussian-blur) 10:51:52 INFO - PROCESS | 11883 | RSS: Main: 193806336 10:51:52 INFO - PROCESS | 11883 | 10:51:55 INFO - PROCESS | 11883 | Cycle 1(1): loaded http://localhost:38127/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:38127/tests/kraken/driver.html?testName=imaging-darkroom) 10:51:55 INFO - PROCESS | 11883 | RSS: Main: 193953792 10:51:55 INFO - PROCESS | 11883 | 10:51:59 INFO - PROCESS | 11883 | Cycle 1(1): loaded http://localhost:38127/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:38127/tests/kraken/driver.html?testName=imaging-desaturate) 10:51:59 INFO - PROCESS | 11883 | RSS: Main: 192393216 10:51:59 INFO - PROCESS | 11883 | 10:52:02 INFO - PROCESS | 11883 | Cycle 1(1): loaded http://localhost:38127/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:38127/tests/kraken/driver.html?testName=json-parse-financial) 10:52:03 INFO - PROCESS | 11883 | RSS: Main: 193708032 10:52:03 INFO - PROCESS | 11883 | 10:52:04 INFO - PROCESS | 11883 | Cycle 1(1): loaded http://localhost:38127/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:38127/tests/kraken/driver.html?testName=json-stringify-tinderbox) 10:52:05 INFO - PROCESS | 11883 | RSS: Main: 194134016 10:52:05 INFO - PROCESS | 11883 | 10:52:07 INFO - PROCESS | 11883 | Cycle 1(1): loaded http://localhost:38127/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:38127/tests/kraken/driver.html?testName=stanford-crypto-aes) 10:52:07 INFO - PROCESS | 11883 | RSS: Main: 193908736 10:52:07 INFO - PROCESS | 11883 | 10:52:09 INFO - PROCESS | 11883 | Cycle 1(1): loaded http://localhost:38127/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:38127/tests/kraken/driver.html?testName=stanford-crypto-ccm) 10:52:10 INFO - PROCESS | 11883 | RSS: Main: 194023424 10:52:10 INFO - PROCESS | 11883 | 10:52:13 INFO - PROCESS | 11883 | Cycle 1(1): loaded http://localhost:38127/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:38127/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 10:52:14 INFO - PROCESS | 11883 | RSS: Main: 193769472 10:52:14 INFO - PROCESS | 11883 | 10:52:16 INFO - PROCESS | 11883 | Cycle 1(1): loaded http://localhost:38127/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:38127/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 10:52:17 INFO - PROCESS | 11883 | RSS: Main: 194097152 10:52:17 INFO - PROCESS | 11883 | 10:52:19 INFO - PROCESS | 11883 | Cycle 1(1): loaded http://localhost:38127/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:38127/tests/kraken/driver.html?testName=ai-astar) 10:52:19 INFO - PROCESS | 11883 | RSS: Main: 195563520 10:52:19 INFO - PROCESS | 11883 | 10:52:19 INFO - PROCESS | 11883 | __start_tp_report 10:52:19 INFO - PROCESS | 11883 | _x_x_mozilla_page_load 10:52:19 INFO - PROCESS | 11883 | _x_x_mozilla_page_load_details 10:52:19 INFO - PROCESS | 11883 | |i|pagename|runs| 10:52:19 INFO - PROCESS | 11883 | |0;ai-astar;105;113;112;112;113;111;112;113;113;111 10:52:19 INFO - PROCESS | 11883 | |1;audio-beat-detection;154;124;129;172;126;126;130;124;170;124 10:52:19 INFO - PROCESS | 11883 | |2;audio-dft;162;167;163;165;169;162;164;162;162;164 10:52:19 INFO - PROCESS | 11883 | |3;audio-fft;76;78;75;115;76;76;75;76;100;75 10:52:19 INFO - PROCESS | 11883 | |4;audio-oscillator;85;82;110;85;84;83;111;83;83;119 10:52:19 INFO - PROCESS | 11883 | |5;imaging-gaussian-blur;117;119;117;117;118;118;118;118;118;117 10:52:19 INFO - PROCESS | 11883 | |6;imaging-darkroom;149;148;148;150;148;148;148;147;148;146 10:52:19 INFO - PROCESS | 11883 | |7;imaging-desaturate;85;85;85;86;85;85;85;86;88;86 10:52:19 INFO - PROCESS | 11883 | |8;json-parse-financial;58;53;52;53;55;55;54;54;55;57 10:52:19 INFO - PROCESS | 11883 | |9;json-stringify-tinderbox;64;60;59;60;62;60;59;60;60;60 10:52:19 INFO - PROCESS | 11883 | |10;stanford-crypto-aes;81;86;82;82;80;80;86;80;86;80 10:52:19 INFO - PROCESS | 11883 | |11;stanford-crypto-ccm;137;137;141;133;132;131;138;144;179;135 10:52:19 INFO - PROCESS | 11883 | |12;stanford-crypto-pbkdf2;169;169;170;170;169;175;171;168;167;169 10:52:19 INFO - PROCESS | 11883 | |13;stanford-crypto-sha256-iterative;69;72;67;66;67;69;65;66;71;66 10:52:19 INFO - PROCESS | 11883 | __end_tp_report 10:52:19 INFO - PROCESS | 11883 | __start_cc_report 10:52:19 INFO - PROCESS | 11883 | _x_x_mozilla_cycle_collect,815 10:52:19 INFO - PROCESS | 11883 | __end_cc_report 10:52:19 INFO - PROCESS | 11883 | __startTimestamp1476381139547__endTimestamp 10:52:19 INFO - PROCESS | 11883 | 10:52:19 INFO - PROCESS | 11883 | ------- Summary: start ------- 10:52:19 INFO - PROCESS | 11883 | Number of tests: 14 10:52:19 INFO - PROCESS | 11883 | 10:52:19 INFO - PROCESS | 11883 | [#0] ai-astar Cycles:10 Average:111.50 Median:112.50 stddev:2.42 (2.1%) stddev-sans-first:0.83 10:52:19 INFO - PROCESS | 11883 | Values: 105.0 113.0 112.0 112.0 113.0 111.0 112.0 113.0 113.0 111.0 10:52:19 INFO - PROCESS | 11883 | 10:52:19 INFO - PROCESS | 11883 | [#1] audio-beat-detection Cycles:10 Average:137.90 Median:129.50 stddev:19.60 (15.1%) stddev-sans-first:19.90 10:52:19 INFO - PROCESS | 11883 | Values: 154.0 124.0 129.0 172.0 126.0 126.0 130.0 124.0 170.0 124.0 10:52:19 INFO - PROCESS | 11883 | 10:52:19 INFO - PROCESS | 11883 | [#2] audio-dft Cycles:10 Average:164.00 Median:164.00 stddev:2.40 (1.5%) stddev-sans-first:2.44 10:52:19 INFO - PROCESS | 11883 | Values: 162.0 167.0 163.0 165.0 169.0 162.0 164.0 162.0 162.0 164.0 10:52:19 INFO - PROCESS | 11883 | 10:52:19 INFO - PROCESS | 11883 | [#3] audio-fft Cycles:10 Average:82.20 Median:76.00 stddev:13.82 (18.2%) stddev-sans-first:14.48 10:52:19 INFO - PROCESS | 11883 | Values: 76.0 78.0 75.0 115.0 76.0 76.0 75.0 76.0 100.0 75.0 10:52:19 INFO - PROCESS | 11883 | 10:52:19 INFO - PROCESS | 11883 | [#4] audio-oscillator Cycles:10 Average:92.50 Median:83.00 stddev:14.59 (17.6%) stddev-sans-first:15.22 10:52:19 INFO - PROCESS | 11883 | Values: 85.0 82.0 110.0 85.0 84.0 83.0 111.0 83.0 83.0 119.0 10:52:19 INFO - PROCESS | 11883 | 10:52:19 INFO - PROCESS | 11883 | [#5] imaging-gaussian-blur Cycles:10 Average:117.70 Median:118.00 stddev:0.67 (0.6%) stddev-sans-first:0.67 10:52:19 INFO - PROCESS | 11883 | Values: 117.0 119.0 117.0 117.0 118.0 118.0 118.0 118.0 118.0 117.0 10:52:19 INFO - PROCESS | 11883 | 10:52:19 INFO - PROCESS | 11883 | [#6] imaging-darkroom Cycles:10 Average:148.00 Median:148.00 stddev:1.05 (0.7%) stddev-sans-first:1.05 10:52:19 INFO - PROCESS | 11883 | Values: 149.0 148.0 148.0 150.0 148.0 148.0 148.0 147.0 148.0 146.0 10:52:19 INFO - PROCESS | 11883 | 10:52:19 INFO - PROCESS | 11883 | [#7] imaging-desaturate Cycles:10 Average:85.60 Median:85.50 stddev:0.97 (1.1%) stddev-sans-first:1.00 10:52:19 INFO - PROCESS | 11883 | Values: 85.0 85.0 85.0 86.0 85.0 85.0 85.0 86.0 88.0 86.0 10:52:19 INFO - PROCESS | 11883 | 10:52:19 INFO - PROCESS | 11883 | [#8] json-parse-financial Cycles:10 Average:54.60 Median:55.00 stddev:1.84 (3.3%) stddev-sans-first:1.48 10:52:19 INFO - PROCESS | 11883 | Values: 58.0 53.0 52.0 53.0 55.0 55.0 54.0 54.0 55.0 57.0 10:52:19 INFO - PROCESS | 11883 | 10:52:19 INFO - PROCESS | 11883 | [#9] json-stringify-tinderbox Cycles:10 Average:60.40 Median:60.00 stddev:1.51 (2.5%) stddev-sans-first:0.87 10:52:19 INFO - PROCESS | 11883 | Values: 64.0 60.0 59.0 60.0 62.0 60.0 59.0 60.0 60.0 60.0 10:52:19 INFO - PROCESS | 11883 | 10:52:19 INFO - PROCESS | 11883 | [#10] stanford-crypto-aes Cycles:10 Average:82.30 Median:82.00 stddev:2.67 (3.3%) stddev-sans-first:2.79 10:52:19 INFO - PROCESS | 11883 | Values: 81.0 86.0 82.0 82.0 80.0 80.0 86.0 80.0 86.0 80.0 10:52:19 INFO - PROCESS | 11883 | 10:52:19 INFO - PROCESS | 11883 | [#11] stanford-crypto-ccm Cycles:10 Average:140.70 Median:137.50 stddev:14.04 (10.2%) stddev-sans-first:14.83 10:52:19 INFO - PROCESS | 11883 | Values: 137.0 137.0 141.0 133.0 132.0 131.0 138.0 144.0 179.0 135.0 10:52:19 INFO - PROCESS | 11883 | 10:52:19 INFO - PROCESS | 11883 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:169.70 Median:169.50 stddev:2.16 (1.3%) stddev-sans-first:2.28 10:52:19 INFO - PROCESS | 11883 | Values: 169.0 169.0 170.0 170.0 169.0 175.0 171.0 168.0 167.0 169.0 10:52:19 INFO - PROCESS | 11883 | 10:52:19 INFO - PROCESS | 11883 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:67.80 Median:68.00 stddev:2.35 (3.5%) stddev-sans-first:2.45 10:52:19 INFO - PROCESS | 11883 | Values: 69.0 72.0 67.0 66.0 67.0 69.0 65.0 66.0 71.0 66.0 10:52:19 INFO - PROCESS | 11883 | -------- Summary: end -------- 10:52:19 INFO - PROCESS | 11883 | 10:52:20 INFO - TEST-INFO | 11883: exit 0 10:52:20 INFO - TEST-OK | kraken | took 62481ms 10:52:20 INFO - SUITE-END | took 1178s 10:52:21 INFO - Completed test suite (00:19:38) 10:52:21 INFO - javascript benchmark 10:52:21 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7081.322572014756, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3040.9543856842165, 3055.5569442430847, 3057.1134371032404, 3063.433264846003, 3087.2744904947335, 5240.742221866753, 5273.071551754132, 5278.762455689493, 5288.101022826119, 5415.512603865661, 5298.576113910887, 5306.310179676637, 5337.359516857982, 5383.488568585988, 5436.374816896058, 4796.424429068508, 4865.464798872121, 4876.780544875489, 4927.901441971158, 4944.728039957801, 4883.0, 4889.779959901795, 5016.046951079302, 5016.874578135539, 5067.493250674921, 4748.07412554552, 4964.05682920244, 4979.178435558147, 5023.045621331954, 5024.045431368028, 4765.21373973294, 4822.373091498082, 4837.419509658864, 4885.218365061573, 4974.328465657162, 4821.035792841446, 4844.806207751686, 4862.1491239033385, 4868.391451068616, 4909.803607855682, 5287.0, 5330.413654498041, 5331.733413329318, 5342.545883599899, 5348.705821179834, 5460.290162278918, 5504.724763761836, 5670.177824215507, 5694.316681998145, 5723.771049158028, 5731.0, 5734.340550836624, 5758.136279558058, 5797.188393624896, 5844.123381492767, 5352.598555108343, 5358.089124848785, 5365.4098049214945, 5377.865553361158, 5399.487048730364, 5716.714164291769, 5760.308762948389, 5763.94236057634, 5831.591788574844, 5856.912146317809, 5642.943570564324, 5645.887082258414, 5647.350554686182, 5708.914366284509, 5714.79998200061, 5676.971615141898, 5686.772529098873, 5714.314282286152, 5722.828315150552, 5739.053056245672, 5577.832665020056, 5605.383407825136, 5606.831795046155, 5684.8294551163535, 5704.315482142087, 5695.259616249861, 5696.943030569724, 5702.116171993348, 5709.600327977002, 5724.8282551523525, 4388.2759344707765, 4410.580994805488, 4413.889652758707, 4419.668524860648, 4485.349624304457, 3919.8236079376497, 3936.193080418507, 3940.4483372327895, 3970.8808735737975, 3971.3050216212046, 5394.136938089887, 5505.834824955257, 5520.089185284463, 5540.667559946416, 5543.667379957215, 5720.1991721159075, 5720.77116915327, 5789.739461724233, 5818.7672493100645, 5918.112283157561, 5414.214938833847, 5462.453754624586, 5484.204790305464, 5484.533814625722, 5527.972360138174, 5036.093503169392, 5039.319691841628, 5042.596592272609, 5043.2435134730085, 5069.112905241642, 5844.181814545882, 5848.2689663792025, 5860.619059761102, 5904.025835737055, 5943.346231914399, 5778.306603207642, 5779.7110144493445, 5779.7977070804, 5780.421957804186, 5787.39232380594, 6092.299385570539, 6123.84690382744, 6133.969330153321, 6136.20229370179, 6136.355682653257, 5581.469760372758, 5591.748371323219, 5619.578531610064, 5697.3448053474385, 5756.71216439168, 5741.196232527533, 5786.479216870502, 5799.072148456226, 5810.331811841524, 5816.651000939957, 5553.500184983371, 5666.575006874418, 5667.319921609268, 5670.886582268414, 5682.488576028012, 5549.556035517068, 5578.386377498391, 5584.664920104807, 5589.636673616202, 5696.601237913306, 5527.281453411031, 5531.778728850801, 5562.833115006556, 5563.860903477445, 5583.888322233452, 5687.459691329317, 5690.4878560928055, 5697.316322041382, 5708.029634962149, 5715.31416230055, 5457.208704737712, 5507.981023510663, 5521.089020311603, 5542.806001789918, 5569.0254205513065], "value": 5299.904940921427, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [561.5647872898504, 577.8902008618364, 578.0866231354461, 582.0977484898409, 593.1517929361012, 40782.18435631289, 42278.57721422789, 42357.78821105894, 45500.0899982001, 45682.54317456824, 43919.56080439195, 44354.33468497967, 44377.334339984845, 44411.55588444114, 44449.11101777962, 8736.912630873689, 8803.955980220122, 8889.822203555925, 8900.42147260426, 8905.95547022264, 8808.339374546902, 8903.77740556488, 8916.063813299575, 8926.062763409846, 8927.33045021626, 8772.736817895473, 8898.37711360205, 8929.46423214606, 8949.776255593597, 8970.10298970101, 8877.422967507091, 8892.510911899843, 8933.59798809055, 8943.195112439911, 8951.910480895205, 8728.389012769108, 8731.519766412845, 8777.253933415668, 8800.779980500474, 8851.424657397249, 40355.19289614191, 40551.0, 40628.79685601553, 40734.388984164965, 40991.18017639661, 3228.725558327545, 3242.983785081083, 3587.9282414351565, 3897.7271590988644, 3924.960750392488, 31104.37791244185, 31317.0, 31550.36899262025, 31805.681943180505, 32056.679433205834, 4147.564505726916, 4246.915061698749, 4265.466816647919, 4276.187524370391, 4330.783460826978, 298901.0, 298944.0, 299537.0, 299750.99999999785, 299902.0, 54568.0, 54848.22428411435, 55089.11386076741, 55135.44864551303, 55438.72280638652, 56700.0, 56943.430565693816, 57295.42704572984, 57366.42633573694, 57441.425585744444, 13772.24252666113, 13953.372098255602, 13975.37110830015, 13989.65025874341, 14075.0, 10845.945770271099, 10884.564617415374, 10897.400642964554, 10902.291351062315, 10954.671359859218, 15197.392104315924, 15667.37330506767, 15847.445339413296, 15858.841411585736, 16026.233835048753, 5647.0, 5689.573282003784, 5778.682172480554, 5836.503897168704, 5866.530677545786, 896.2426749396749, 985.4727720669407, 996.0736515041082, 1036.76154484469, 1044.4412239451856, 30788.846055769576, 31115.533267001014, 31237.0, 31673.20816979594, 31738.523922141187, 1044.7910417916296, 1068.2842495528014, 1076.0638244726981, 1124.2523721725124, 1126.583164229224, 15653.738504598025, 16265.593360165854, 16279.51161465158, 16416.67166656684, 16624.750628740578, 515764.0, 518715.0, 520957.0, 521055.0, 522413.0, 55344.446555534734, 55858.16212756812, 56802.0, 56854.0, 56888.0, 1264.8418947631546, 1295.7602843473987, 1309.508934149694, 1317.3610798762784, 1326.4495234477583, 29123.51553440802, 30313.696863031088, 30614.84692576523, 30961.225969350948, 31020.68979310178, 47973.760131199124, 49036.0, 49066.26400603922, 49173.50826491689, 49244.26133607927, 336229.0, 340236.0, 341426.0, 341470.0, 452743.0, 27157.86421067882, 27575.448491029667, 27623.447531048863, 27761.167164985083, 27774.583381248893, 45279.77360113178, 45395.54604453913, 45442.48532309018, 45900.77049614731, 46294.76852615715, 39031.5728732964, 39091.41362879616, 39586.80206598948, 40448.1910361797, 41101.972450687776, 38233.23533529369, 38784.418233725955, 40677.0, 40948.590514094474, 41420.585794141676, 39006.80496597499, 39394.0, 39458.0, 39761.60238397579, 39822.60177398189, 34055.82972085124, 36356.27287454289, 36881.815590922946, 36933.23000775006, 37561.624383756905, 26761.0, 27440.588391173747, 27693.58459623067, 29279.414411712074, 29321.560176597795], "value": 19141.720275737523, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [377.7053897959591, 385.167714386252, 388.35339160298105, 389.6843556719058, 405.1875988642771, 17897.194626241817, 18777.530561735963, 19454.805451945474, 19602.411927642195, 19609.411717648476, 17958.461246162635, 18239.726404103916, 18334.724979125323, 18421.0, 18592.163352649128, 5373.220882971967, 5515.917261241075, 5641.802536911209, 5794.565407594426, 5796.014677504813, 5654.773809047633, 5674.546036317105, 5702.686352250625, 5704.11586204139, 5717.113847353646, 5532.5573954083575, 5652.547796176316, 5680.31836179657, 5705.172749951275, 5707.62900411474, 5655.971720141393, 5683.062294721366, 5701.600887937846, 5712.65724056558, 5715.485396369965, 5379.892402151935, 5425.674459532441, 5522.171674248854, 5534.363548191969, 5538.972305138489, 11561.364124973123, 11699.532018719241, 11756.177067605271, 12065.758684826254, 12275.69310767238, 2203.4821816873023, 2211.0, 2215.1139544182297, 2231.7991380775807, 2428.757124287557, 8629.352798540134, 8647.705184656268, 8827.514486703229, 9119.726408207764, 9221.400608960395, 1768.5667011582245, 1769.6106856491551, 1783.8399816939977, 1863.9161237744333, 1870.8596855235912, 71097.28902710958, 77768.22231777666, 78313.0, 78745.60627196827, 83127.0, 9229.723108306762, 10030.498475076363, 10518.579256829642, 10758.892411075789, 10841.295315804447, 14567.198804065667, 14749.041312314665, 14789.0, 14796.630084247765, 14797.778033329509, 7084.716611335592, 7187.101612298463, 7492.625368731542, 7688.9615551923, 7708.9229107709325, 6871.6564171791215, 6943.826404339831, 6972.477064220204, 7143.464240182007, 7143.607101609461, 4315.331123675835, 4454.198244316054, 4560.5895469407915, 4602.447706275201, 4706.3175839503765, 1814.8911065335858, 1830.057520377007, 1899.211827091769, 1978.5251539630385, 1986.8211860932586, 908.4458480326995, 967.7628980899725, 970.5050424283525, 992.3252188511736, 1001.979960400788, 17965.820341796676, 19090.33183838559, 19308.32420865263, 19323.227070917004, 19456.221751129797, 933.3373304953424, 936.7330310861372, 969.7575606098476, 983.1348413396308, 983.7393090830935, 10255.487225638688, 10789.0, 10899.782004359868, 10912.563497460013, 10926.508307126198, 474096.0, 475125.0, 478616.0, 485422.0, 485435.0, 81343.59328203321, 83045.58477207576, 83820.58089709512, 84036.0, 87890.56054719814, 970.7136394763562, 978.2369751593768, 988.4810474500945, 992.7071513903416, 993.9950300248453, 15733.606659833138, 16900.492985210465, 17287.913560432116, 17356.39252626152, 17447.939918846772, 38755.41866871943, 40116.3982540268, 40170.79914600408, 40524.59475405208, 41870.371944421466, 52183.0, 52282.21576676429, 52582.73708631432, 52895.0, 54488.0, 7563.0, 7578.280063393969, 7723.0, 7946.841063178819, 8048.557329346942, 9453.385529940531, 12664.620061398173, 12872.549460768829, 12902.354882255662, 12915.0, 11195.60815371458, 11436.714082148013, 11651.941740291244, 11735.47190376418, 11928.0, 10930.125589952626, 11270.605528806453, 11304.321740695585, 11315.20793544444, 11400.315981041163, 11488.54045838157, 11570.247933884271, 11615.477303521531, 11789.587364442203, 11841.0, 7429.331360177393, 7555.433342499225, 7672.884906726292, 7820.217978202134, 8149.348052155695, 9406.294527910572, 11573.190006332143, 11595.18833681668, 11774.3524106175, 11814.763704726029], "value": 8675.302274874444, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1464.4435114656428, 1465.9340329685162, 1621.5459671292035, 1760.0319824096744, 1768.4164225805484, 8072.0, 8342.958285208566, 8644.049154592998, 9395.389299695524, 9397.530123493814, 8654.43746156501, 8968.820623587524, 8981.640734370618, 9176.0, 9207.171354578086, 2327.8021368183727, 2345.1323010486144, 2354.799842013431, 2360.433495960974, 2360.445295355599, 2326.162581470669, 2360.775726305998, 2362.444825466014, 2380.0, 2380.0360853854218, 2352.3766201956496, 2387.868667223302, 2391.940201494959, 2394.1141777542334, 2398.1486572266854, 2285.931422057341, 2286.748457669655, 2310.734265559457, 2316.617758069925, 2320.6170981787986, 2293.8853057347064, 2302.0, 2309.815214782813, 2312.7687231276905, 2315.9189428369928, 9170.86243706345, 9236.538173091385, 9274.211692006187, 9314.347995640308, 9327.393719408217, 5159.406668233164, 5189.662671926313, 5331.44019877915, 5356.464353564613, 5370.919436208421, 3358.9664103358896, 3394.2023624448234, 3476.200473891019, 3514.8242587870504, 3529.0118766745095, 1114.504045699664, 1154.203599516331, 1167.3229526874393, 1181.734109825291, 1185.5257896841333, 12725.363731813371, 12729.554465593752, 12775.169613975062, 12797.1681840681, 12836.743265134739, 4415.381846541487, 4421.093675796454, 4645.976770116128, 4653.7207767534055, 4673.275642275453, 10699.0, 10766.138708903269, 10842.457877106113, 10850.403227822546, 10872.45637718111, 5215.55667768244, 5220.295260139908, 5230.424653288135, 5247.763850626731, 5261.736913154404, 4701.2242979908615, 4817.975910120427, 4853.757312134379, 4870.561649451495, 4951.678140920829, 3640.508531348287, 3715.3126671565847, 3730.720195985312, 3801.657850793442, 3868.303705333011, 1076.1068313299943, 1076.7308172956762, 1080.9621663241749, 1097.868255809308, 1121.6747143328507, 785.3834739729285, 959.5729900194347, 963.5471328475605, 969.8351280282369, 984.5471083301761, 6070.392960703983, 6128.540359473057, 6135.0797380392405, 6145.078238264206, 6251.374862513712, 436.1190395401272, 439.25326944194995, 443.4169067675996, 446.76768080598555, 447.2977425442025, 3982.1040265939932, 4002.9599704002585, 4022.778747168934, 4075.1849630074103, 4095.795210239476, 11059.668209953714, 11411.0, 11421.086313094933, 11431.542738290374, 11562.364069976233, 11383.235598482248, 11414.315141091562, 11424.543018279343, 11456.255343402652, 11463.140264480196, 8267.83464330722, 8346.540940248344, 8451.323894088458, 8476.618552165168, 8479.576021198915, 5992.790252341147, 6101.0, 6115.510759139347, 6119.388061193845, 6124.265088189446, 10208.081272685495, 10472.790544189225, 10505.15958723285, 10591.682249532527, 10640.255182137176, 10622.256442048982, 10661.360318380923, 10672.733181670521, 10684.732881678021, 10703.94648026786, 7644.617769111634, 7707.88438173439, 7715.0, 7756.495827771177, 7763.951866498176, 8749.868751968854, 8774.956125219333, 8788.912110879066, 8790.824183516423, 8820.162084601952, 7891.408144389308, 7907.209279072277, 7999.880001799861, 8127.512349258827, 8138.552379619177, 7670.654820532978, 7677.424193185645, 7747.147813740597, 7752.302292793675, 7770.805729856799, 6835.384815366442, 6849.315068493111, 6949.30506949301, 6959.095317608881, 6978.616176110363, 5157.149070403341, 5256.737163141904, 5264.921026184534, 5275.762590683506, 5424.484673955968, 5270.920936186037, 5337.519623233928, 5366.597505187048, 5414.810481633124, 5450.836474905759], "value": 4599.822293882784, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [302.3665420943125, 310.8989578387024, 316.09281362489656, 317.8871500617281, 322.18165858718856, 5291.597726602454, 5446.0, 5474.850281440892, 5570.554355651549, 5574.804881829142, 5193.558547523456, 5311.601629877755, 5350.796070884049, 5387.868547605008, 5406.486383793534, 4210.831566737327, 4212.852550160745, 4214.178235244129, 4250.91498170038, 4265.189613973335, 4158.97920510397, 4206.810693518799, 4222.366645003259, 4230.217409779185, 4262.893427664302, 4196.769177695225, 4202.306619407794, 4219.409282700424, 4230.223306211398, 4238.87283381499, 4181.414601955728, 4209.789510524477, 4210.052738133926, 4211.115665710205, 4215.650991682663, 3705.5368078990127, 3710.2208536207427, 3726.273376691546, 3733.5146430964073, 3741.0920430580327, 5099.209622508517, 5345.251664766935, 5364.275822763916, 5366.524205843424, 5374.5700343972385, 4803.135435621587, 4812.494688057738, 4817.879553011203, 4824.276358546211, 4827.275908613701, 5467.781288748445, 5712.2574065371655, 5715.342735585377, 5739.196512488255, 5802.941970580325, 3959.960400395988, 3960.861369852041, 3963.870296965351, 3973.781442020688, 4014.2774300625874, 5962.284525856881, 5992.43071908168, 6003.189569408118, 6054.303755068179, 6059.848503787396, 3983.343106172781, 4124.154548317588, 4124.505059392832, 4131.566185550534, 4134.359174327984, 4108.609682080198, 4140.565240649748, 4146.295129827937, 4152.273352163359, 4157.376393540932, 4750.501197374295, 4795.184818580849, 4802.6638135330195, 4820.590249828804, 4831.879203019953, 5719.57103217252, 5731.197632331477, 5759.366469688331, 5759.798407055733, 5777.0, 1415.5257988573737, 1422.9928850355889, 1426.2440906319666, 1427.3006226948721, 1432.477145841781, 876.7545087375545, 894.6019021535484, 896.3859756067114, 897.0, 898.7213963671282, 4915.336429581961, 4923.90152196954, 4954.653174277766, 4956.925646115311, 4960.875978100504, 5029.899402011939, 5079.517445842639, 5104.285400043997, 5147.974260128675, 5149.304843846107, 4750.287456881426, 4901.3383193269165, 4935.481774413706, 4951.70289782607, 4956.553910148032, 2749.748864266754, 2750.510787737101, 2752.8348299101717, 2754.911809835144, 2772.9324210179225, 5297.231901374279, 5427.0, 5444.237806707064, 5446.537044351275, 5483.643563168382, 4870.318155458239, 5224.294720212799, 5277.419483856773, 5302.965921645319, 5323.463597858184, 5381.735292206328, 5387.434319396485, 5410.594205434608, 5413.512783849473, 5452.672839629635, 5124.564412024871, 5152.76812543444, 5157.329547158845, 5261.631685782112, 5318.457647282399, 5033.84898453047, 5435.864103397288, 5805.651660900359, 5819.301683797971, 5823.0, 6212.409821066992, 6215.06773983906, 6288.1013771461985, 6301.558890877594, 6319.776913773916, 3832.693384529175, 3880.96119038806, 3982.0, 4031.9798401007806, 4092.3043082676613, 5781.5663825214115, 5813.273340832396, 5817.970910145422, 5821.883562328645, 5831.970840145772, 5698.743556539883, 5699.7435115419075, 5722.427757224411, 5737.0, 5775.306963164448, 5571.415001424792, 5645.350784659652, 5659.773609055756, 5673.574481913791, 5701.942980570308, 5556.944430555643, 5592.154588985706, 5597.776088956396, 5650.29371328584, 5651.491365777099, 5508.394076651645, 5699.857503562444, 5706.914396284142, 5716.084796753768, 5762.654240745569, 5553.500554850087, 5580.358258800127, 5600.0, 5634.6337488063145, 5641.26663533738], "value": 4203.553446696238, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [715.2882881532872, 725.5610355734781, 748.2517482517483, 748.6331697468239, 805.1505661527086, 14720.190389528572, 15082.472113476017, 16232.51302460925, 16278.593035174126, 16329.673406531861, 14477.710445791077, 14481.855181448182, 14515.927420362883, 14573.34419951102, 14787.92606036971, 767.9462437629368, 796.5937371940295, 798.6366203377464, 809.1544336168718, 811.0915774332726, 802.891609632698, 806.9112397636255, 807.1807115777461, 807.2976510435929, 808.0908977400425, 836.5524444422235, 839.0518713853337, 839.2279103225017, 839.7396806989852, 840.260570697785, 817.3257062923083, 822.411975437565, 831.6590198018783, 833.0586437325844, 833.2167762303445, 604.6553464525223, 604.8155312629647, 605.1104875832519, 605.772835186805, 609.6860117039728, 15071.321790519343, 15135.924320378437, 15148.772768408482, 15167.165805880672, 15219.543413697607, 13956.0, 14041.719165616732, 14323.283835808272, 14416.855831441657, 14432.278386080654, 11612.36132012739, 11743.94128029363, 11768.235064720766, 12026.579069732517, 12161.452734626875, 3889.1638297765835, 3919.8432062717457, 3940.566537680853, 3979.621935916083, 4044.959550404488, 59866.0, 61781.38218617801, 62768.0, 68938.3106168937, 76382.0, 10797.892021079846, 10934.0, 11166.218364714554, 11265.690533440626, 11292.604758833402, 19989.600207995758, 20016.399508014783, 20021.09905054276, 20029.399118026482, 20030.198792048155, 7542.2834830691, 7659.502132361378, 7672.232776722283, 7894.447388682737, 8188.058373287029, 4311.568843115726, 4397.692161548661, 4412.3160910059, 4552.0, 4597.678162528591, 3121.204092956327, 3233.6766323367474, 3235.8705651773666, 3243.2216268095485, 3259.3970115528705, 599.0714392691398, 601.6119602856221, 605.9091136329586, 607.8389226854887, 636.0491065856575, 615.1480199923138, 616.340515648261, 670.1489108831756, 685.3044160177424, 692.7783109405043, 9703.5148242589, 9815.558299876522, 9951.502424878872, 9972.950135249277, 10113.29206955506, 592.6947621974687, 665.787574950864, 674.6188403551978, 674.6592970549939, 679.0527214535794, 4572.131295053996, 4632.559906808848, 4678.6491013174145, 4721.480637129913, 4889.828855990023, 96886.0, 114670.0, 116565.4171729136, 119453.40273298578, 122502.0, 91256.0, 92144.53927730318, 106871.0, 108020.0, 108077.0, 84693.0, 94062.0, 95620.9999999986, 98031.50984245176, 99395.50302248442, 8649.481031138152, 8856.202941735275, 8909.242714369091, 8981.461112333282, 9002.099790020946, 52885.7355713219, 53165.0, 53364.0, 54066.18900716414, 54722.726386367816, 71312.28687713265, 74915.62879670318, 78687.0, 81726.0, 82306.58846705729, 10918.78162436731, 11161.832572511581, 11216.102711783202, 11226.66320010401, 11396.373199474108, 13180.275084870424, 13400.463981441024, 13688.45246190181, 13774.793378099135, 13880.444782208599, 13346.466141354236, 13671.38478768438, 14007.719845603235, 14407.639809004859, 14447.060941038799, 12705.55530556463, 13599.52401665937, 14052.086614370442, 14411.78382324245, 14613.0, 13129.474821007434, 13282.667933301746, 13671.17972921628, 13707.314634268447, 14062.226577537924, 10807.621733239299, 11142.498587563417, 11450.0, 11697.707557310794, 12087.879121208676, 11097.445127743418, 11552.480138393625, 11626.476808543466, 12045.63863084109, 12060.819087713517], "value": 7408.869163610939, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1514.9, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [105.0, 113.0, 112.0, 112.0, 113.0, 111.0, 112.0, 113.0, 113.0, 111.0], "value": 111.5, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [154.0, 124.0, 129.0, 172.0, 126.0, 126.0, 130.0, 124.0, 170.0, 124.0], "value": 137.9, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [162.0, 167.0, 163.0, 165.0, 169.0, 162.0, 164.0, 162.0, 162.0, 164.0], "value": 164.0, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 78.0, 75.0, 115.0, 76.0, 76.0, 75.0, 76.0, 100.0, 75.0], "value": 82.2, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 82.0, 110.0, 85.0, 84.0, 83.0, 111.0, 83.0, 83.0, 119.0], "value": 92.5, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 119.0, 117.0, 117.0, 118.0, 118.0, 118.0, 118.0, 118.0, 117.0], "value": 117.7, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [149.0, 148.0, 148.0, 150.0, 148.0, 148.0, 148.0, 147.0, 148.0, 146.0], "value": 148.0, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 85.0, 85.0, 86.0, 85.0, 85.0, 85.0, 86.0, 88.0, 86.0], "value": 85.6, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [58.0, 53.0, 52.0, 53.0, 55.0, 55.0, 54.0, 54.0, 55.0, 57.0], "value": 54.6, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [64.0, 60.0, 59.0, 60.0, 62.0, 60.0, 59.0, 60.0, 60.0, 60.0], "value": 60.4, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [81.0, 86.0, 82.0, 82.0, 80.0, 80.0, 86.0, 80.0, 86.0, 80.0], "value": 82.3, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [137.0, 137.0, 141.0, 133.0, 132.0, 131.0, 138.0, 144.0, 179.0, 135.0], "value": 140.7, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [169.0, 169.0, 170.0, 170.0, 169.0, 175.0, 171.0, 168.0, 167.0, 169.0], "value": 169.7, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [69.0, 72.0, 67.0, 66.0, 67.0, 69.0, 65.0, 66.0, 71.0, 66.0], "value": 67.8, "unit": "score"}]}]} 10:52:21 INFO - Return code: 0 10:52:21 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 10:52:21 ERROR - # TBPL SUCCESS # 10:52:21 INFO - Running post-action listener: _resource_record_post_action 10:52:21 INFO - [mozharness: 2016-10-13 17:52:21.350163Z] Finished run-tests step (success) 10:52:21 INFO - Running post-run listener: _resource_record_post_run 10:52:21 INFO - Total resource usage - Wall time: 1196s; CPU: 13.0%; Read bytes: 12288; Write bytes: 395141120; Read time: 24; Write time: 306912 10:52:21 INFO - TinderboxPrint: CPU usage
13.4% 10:52:21 INFO - TinderboxPrint: I/O read bytes / time
12,288 / 24 10:52:21 INFO - TinderboxPrint: I/O write bytes / time
395,141,120 / 306,912 10:52:21 INFO - TinderboxPrint: CPU idle
8,253.8 (86.5%) 10:52:21 INFO - TinderboxPrint: CPU user
1,222.3 (12.8%) 10:52:21 INFO - TinderboxPrint: Swap in / out
0 / 0 10:52:21 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 103358464; Read time: 0; Write time: 71288 10:52:21 INFO - run-tests - Wall time: 1179s; CPU: 13.0%; Read bytes: 8192; Write bytes: 289349632; Read time: 16; Write time: 235316 10:52:21 INFO - Running post-run listener: _upload_blobber_files 10:52:21 INFO - Blob upload gear active. 10:52:21 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 10:52:21 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 10:52:21 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'] 10:52:21 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 10:52:22 INFO - (blobuploader) - INFO - Open directory for files ... 10:52:22 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 10:52:22 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 10:52:22 INFO - (blobuploader) - INFO - Uploading, attempt #1. 10:52:23 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 10:52:23 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 10:52:23 INFO - (blobuploader) - INFO - Done attempting. 10:52:23 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 10:52:23 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 10:52:23 INFO - (blobuploader) - INFO - Uploading, attempt #1. 10:52:26 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 10:52:26 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 10:52:26 INFO - (blobuploader) - INFO - Done attempting. 10:52:26 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 10:52:26 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 10:52:26 INFO - (blobuploader) - INFO - Uploading, attempt #1. 10:52:27 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 10:52:27 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 10:52:27 INFO - (blobuploader) - INFO - Done attempting. 10:52:27 INFO - (blobuploader) - INFO - Iteration through files over. 10:52:27 INFO - Return code: 0 10:52:27 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 10:52:27 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 10:52:27 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/8a5da099a720f0cd0db7be9649dfddbf38c30e03508c2a7c7f2345ad8db4c173ca4726ecead56f29c46dbe4ce279917351ce5e9a33b053b9ee125713ed1159e6", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/b96130fa154117dab41aab3286dbc11d680ad79ba86520d9bbec9c15c200ff8da89cb708abbcb8a1a480cfbd025110a554440f038bdf59a5b5aa92a1d2948c0a", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/68fd1fbec2c43ab4b0ccedaefd37f21021c65fb6a098c730ea12115f4809aa197935175b1b1dce15980fcc36b12abdfce921af88d26bd60c8a4be435cfa93d3b"} 10:52:27 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 10:52:27 INFO - Writing to file /builds/slave/test/properties/blobber_files 10:52:27 INFO - Contents: 10:52:27 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/8a5da099a720f0cd0db7be9649dfddbf38c30e03508c2a7c7f2345ad8db4c173ca4726ecead56f29c46dbe4ce279917351ce5e9a33b053b9ee125713ed1159e6", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/b96130fa154117dab41aab3286dbc11d680ad79ba86520d9bbec9c15c200ff8da89cb708abbcb8a1a480cfbd025110a554440f038bdf59a5b5aa92a1d2948c0a", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/68fd1fbec2c43ab4b0ccedaefd37f21021c65fb6a098c730ea12115f4809aa197935175b1b1dce15980fcc36b12abdfce921af88d26bd60c8a4be435cfa93d3b"} 10:52:27 INFO - Running post-run listener: copy_logs_to_upload_dir 10:52:27 INFO - Copying logs to upload dir... 10:52:27 INFO - mkdir: /builds/slave/test/build/upload/logs 10:52:27 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1236.421626 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 36 secs) (at 2016-10-13 10:52:27.297363) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-10-13 10:52:27.301124) ========= 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=ed14279e38b05397cf4aa391000001a4-1476379908.128739-48956615 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/8a5da099a720f0cd0db7be9649dfddbf38c30e03508c2a7c7f2345ad8db4c173ca4726ecead56f29c46dbe4ce279917351ce5e9a33b053b9ee125713ed1159e6", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/b96130fa154117dab41aab3286dbc11d680ad79ba86520d9bbec9c15c200ff8da89cb708abbcb8a1a480cfbd025110a554440f038bdf59a5b5aa92a1d2948c0a", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/68fd1fbec2c43ab4b0ccedaefd37f21021c65fb6a098c730ea12115f4809aa197935175b1b1dce15980fcc36b12abdfce921af88d26bd60c8a4be435cfa93d3b"} build_url:https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476372626/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011440 build_url: 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1476372626/firefox-52.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/8a5da099a720f0cd0db7be9649dfddbf38c30e03508c2a7c7f2345ad8db4c173ca4726ecead56f29c46dbe4ce279917351ce5e9a33b053b9ee125713ed1159e6", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/b96130fa154117dab41aab3286dbc11d680ad79ba86520d9bbec9c15c200ff8da89cb708abbcb8a1a480cfbd025110a554440f038bdf59a5b5aa92a1d2948c0a", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/68fd1fbec2c43ab4b0ccedaefd37f21021c65fb6a098c730ea12115f4809aa197935175b1b1dce15980fcc36b12abdfce921af88d26bd60c8a4be435cfa93d3b"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-10-13 10:52:27.326576) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-10-13 10:52:27.326913) ========= 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=ed14279e38b05397cf4aa391000001a4-1476379908.128739-48956615 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004533 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-10-13 10:52:27.411574) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-10-13 10:52:27.411883) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-10-13 10:52:27.412169) ========= ========= Total master_lag: 0.17 =========