builder: mozilla-inbound_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-027 starttime: 1477772722.51 results: success (0) buildid: 20161029131547 builduid: 90db50334a504caca0f5729c89d7f65a revision: c136ac92dcdc37dfd09f4868887f1ccf86522989 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-10-29 13:25:22.507669) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-10-29 13:25:22.508139) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-10-29 13:25:22.508409) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-10-29 13:25:22.541420) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-29 13:25:22.541772) ========= 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=1f5564757af27664ca02d71f000001b0-1477772720.177993-371408972 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-10-29 13:25:22-- 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% 207M=0s 2016-10-29 13:25:22 (207 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.140797 ========= master_lag: 0.04 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-29 13:25:22.717867) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-10-29 13:25:22.718189) ========= 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=1f5564757af27664ca02d71f000001b0-1477772720.177993-371408972 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.014824 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-10-29 13:25:22.767320) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-29 13:25:22.767680) ========= bash -c 'python archiver_client.py mozharness --repo integration/mozilla-inbound --rev c136ac92dcdc37dfd09f4868887f1ccf86522989 --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 c136ac92dcdc37dfd09f4868887f1ccf86522989 --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=1f5564757af27664ca02d71f000001b0-1477772720.177993-371408972 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-10-29 13:25:23,030 truncating revision to first 12 chars 2016-10-29 13:25:23,030 Setting DEBUG logging. 2016-10-29 13:25:23,030 attempt 1/10 2016-10-29 13:25:23,030 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/mozilla-inbound/c136ac92dcdc?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-10-29 13:25:23,354 unpacking tar archive at: mozilla-inbound-c136ac92dcdc/testing/mozharness/ program finished with exit code 0 elapsedTime=0.672458 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-29 13:25:23.453256) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-10-29 13:25:23.453572) ========= script_repo_revision: c136ac92dcdc37dfd09f4868887f1ccf86522989 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-10-29 13:25:23.453953) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-10-29 13:25:23.454211) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-10-29 13:25:23.462442) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 45 secs) (at 2016-10-29 13:25:23.462785) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --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', '--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=1f5564757af27664ca02d71f000001b0-1477772720.177993-371408972 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 13:25:23 INFO - MultiFileLogger online at 20161029 13:25:23 in /builds/slave/test 13:25:23 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Inbound --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Inbound 13:25:23 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 13:25:23 INFO - {'append_to_log': False, 13:25:23 INFO - 'base_work_dir': '/builds/slave/test', 13:25:23 INFO - 'blob_upload_branch': 'Mozilla-Inbound', 13:25:23 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 13:25:23 INFO - 'branch': 'Mozilla-Inbound', 13:25:23 INFO - 'buildbot_json_path': 'buildprops.json', 13:25:23 INFO - 'config_files': ('talos/linux_config.py',), 13:25:23 INFO - 'default_actions': ('clobber', 13:25:23 INFO - 'read-buildbot-config', 13:25:23 INFO - 'download-and-extract', 13:25:23 INFO - 'populate-webroot', 13:25:23 INFO - 'create-virtualenv', 13:25:23 INFO - 'install', 13:25:23 INFO - 'run-tests'), 13:25:23 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 13:25:23 INFO - 'download_minidump_stackwalk': True, 13:25:23 INFO - 'download_symbols': 'ondemand', 13:25:23 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 13:25:23 INFO - 'tooltool.py': '/tools/tooltool.py', 13:25:23 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 13:25:23 INFO - '/tools/misc-python/virtualenv.py')}, 13:25:23 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 13:25:23 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 13:25:23 INFO - 'installer_path': 'installer.exe', 13:25:23 INFO - 'log_level': 'info', 13:25:23 INFO - 'log_name': 'talos', 13:25:23 INFO - 'log_to_console': True, 13:25:23 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 13:25:23 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 13:25:23 INFO - 'opt_config_files': (), 13:25:23 INFO - 'pip_index': False, 13:25:23 INFO - 'sps_profile': False, 13:25:23 INFO - 'sps_profile_interval': 0, 13:25:23 INFO - 'suite': 'dromaeojs', 13:25:23 INFO - 'system_bits': '32', 13:25:23 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 13:25:23 INFO - 'title': 'talos-linux64-ix-027', 13:25:23 INFO - 'tooltool_cache': '/builds/tooltool_cache', 13:25:23 INFO - 'use_talos_json': True, 13:25:23 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 13:25:23 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 13:25:23 INFO - 'work_dir': 'build'} 13:25:23 INFO - [mozharness: 2016-10-29 20:25:23.901825Z] Running clobber step. 13:25:23 INFO - Running pre-action listener: _resource_record_pre_action 13:25:23 INFO - Running main action method: clobber 13:25:23 INFO - rmtree: /builds/slave/test/build 13:25:23 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 13:25:24 INFO - Running post-action listener: _resource_record_post_action 13:25:24 INFO - [mozharness: 2016-10-29 20:25:24.832279Z] Finished clobber step (success) 13:25:24 INFO - [mozharness: 2016-10-29 20:25:24.832376Z] Running read-buildbot-config step. 13:25:24 INFO - Running pre-action listener: _resource_record_pre_action 13:25:24 INFO - Running main action method: read_buildbot_config 13:25:24 INFO - Using buildbot properties: 13:25:24 INFO - { 13:25:24 INFO - "project": "", 13:25:24 INFO - "product": "firefox", 13:25:24 INFO - "script_repo_revision": "production", 13:25:24 INFO - "builddir": "mozilla-inbound_ubuntu64_hw_test-dromaeojs", 13:25:24 INFO - "repository": "", 13:25:24 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-inbound pgo talos dromaeojs", 13:25:24 INFO - "buildid": "20161029131547", 13:25:24 INFO - "stage_platform": "linux64-pgo", 13:25:24 INFO - "basedir": "/builds/slave/test", 13:25:24 INFO - "buildnumber": 1938, 13:25:24 INFO - "platform": "ubuntu64_hw", 13:25:24 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 13:25:24 INFO - "slavebuilddir": "test", 13:25:24 INFO - "branch": "mozilla-inbound", 13:25:24 INFO - "revision": "c136ac92dcdc37dfd09f4868887f1ccf86522989", 13:25:24 INFO - "slavename": "talos-linux64-ix-027", 13:25:24 INFO - "builduid": "90db50334a504caca0f5729c89d7f65a", 13:25:24 INFO - "repo_path": "integration/mozilla-inbound" 13:25:24 INFO - } 13:25:24 INFO - Found installer url https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1477698451/firefox-52.0a1.en-US.linux-x86_64.tar.bz2. 13:25:24 INFO - Found a test packages url https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1477698451/firefox-52.0a1.en-US.linux-x86_64.test_packages.json. 13:25:24 INFO - Running post-action listener: _resource_record_post_action 13:25:24 INFO - [mozharness: 2016-10-29 20:25:24.834728Z] Finished read-buildbot-config step (success) 13:25:24 INFO - [mozharness: 2016-10-29 20:25:24.834815Z] Running download-and-extract step. 13:25:24 INFO - Running pre-action listener: _resource_record_pre_action 13:25:24 INFO - Running main action method: download_and_extract 13:25:24 INFO - mkdir: /builds/slave/test/build/tests 13:25: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')]} 13:25:24 INFO - trying https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1477698451/firefox-52.0a1.en-US.linux-x86_64.test_packages.json 13:25:24 INFO - Downloading https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1477698451/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 13:25:24 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1477698451/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 13:25:24 INFO - Downloaded 1361 bytes. 13:25:24 INFO - Reading from file /builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json 13:25:24 INFO - Using the following test package requirements: 13:25:24 INFO - {u'common': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'], 13:25:24 INFO - u'cppunittest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 13:25:24 INFO - u'firefox-52.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 13:25:24 INFO - u'gtest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 13:25:24 INFO - u'firefox-52.0a1.en-US.linux-x86_64.gtest.tests.zip'], 13:25:24 INFO - u'jittest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 13:25:24 INFO - u'jsshell-linux-x86_64.zip'], 13:25:24 INFO - u'mochitest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 13:25:24 INFO - u'firefox-52.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 13:25:24 INFO - u'mozbase': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'], 13:25:24 INFO - u'reftest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 13:25:24 INFO - u'firefox-52.0a1.en-US.linux-x86_64.reftest.tests.zip'], 13:25:24 INFO - u'talos': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 13:25:24 INFO - u'firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip'], 13:25:24 INFO - u'web-platform': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 13:25:24 INFO - u'firefox-52.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 13:25:24 INFO - u'xpcshell': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 13:25:24 INFO - u'firefox-52.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 13:25:24 INFO - Downloading packages: [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 13:25:24 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/1477698451/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip 13:25:24 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1477698451/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 13:25:24 INFO - Fetch https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1477698451/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip into memory 13:25:24 INFO - Http code: 200 13:25:24 INFO - via: 1.1 c0740de9f16cf32ffedfd2f9806b8483.cloudfront.net (CloudFront) 13:25:24 INFO - x-amz-cf-id: 6O3IDFbXMi4m_dve4PDW1nUY1wjRfuA3lZHg7gOv4fyRFJhofAl4QQ== 13:25:24 INFO - x-amz-replication-status: PENDING 13:25:24 INFO - x-amz-version-id: eHezoz9gEXDFZj47siXxq8OzJRKdi811 13:25:25 INFO - Expected file size: 22005783 13:25:25 INFO - Obtained file size: 22005783 13:25:29 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 13:25:29 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/1477698451/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip 13:25:29 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1477698451/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 13:25:29 INFO - Fetch https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1477698451/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip into memory 13:25:29 INFO - Http code: 200 13:25:29 INFO - via: 1.1 5c2ff4ca1e447265402af29264e83497.cloudfront.net (CloudFront) 13:25:29 INFO - x-amz-cf-id: SQwEW0jzhs9qU3HMYihKem0nw8b4idbnlxzuO1pCh5lc5sO7UOeWZw== 13:25:29 INFO - x-amz-replication-status: PENDING 13:25:29 INFO - x-amz-version-id: eHezoz9gEXDFZj47siXxq8OzJRKdi811 13:25:29 INFO - Expected file size: 22005783 13:25:29 INFO - Obtained file size: 22005783 13:25:34 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/1477698451/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip 13:25:34 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1477698451/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 13:25:34 INFO - Fetch https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1477698451/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip into memory 13:25:34 INFO - Http code: 200 13:25:34 INFO - via: 1.1 11dd60d1f68e8258294f92935b53a91f.cloudfront.net (CloudFront) 13:25:34 INFO - x-amz-cf-id: j_pYWiRDBexv_GiIpcSecr5kutJPaKxLqRenzNQ-O1VSxYDgOvQaCg== 13:25:34 INFO - x-amz-replication-status: PENDING 13:25:34 INFO - x-amz-version-id: Y15D.u_CQQRjQH355FdZaaY99uk8JmKU 13:25:34 INFO - Expected file size: 14409030 13:25:34 INFO - Obtained file size: 14409030 13:25:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:25:34 INFO - trying https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1477698451/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 13:25:34 INFO - Downloading https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1477698451/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 13:25:34 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1477698451/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 13:25:35 INFO - Downloaded 59406539 bytes. 13:25:35 INFO - Setting buildbot property build_url to https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1477698451/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 13:25:35 INFO - mkdir: /builds/slave/test/properties 13:25:35 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 13:25:35 INFO - Writing to file /builds/slave/test/properties/build_url 13:25:35 INFO - Contents: 13:25:35 INFO - build_url:https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1477698451/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 13:25:35 INFO - Running post-action listener: _resource_record_post_action 13:25:35 INFO - Running post-action listener: set_extra_try_arguments 13:25:35 INFO - [mozharness: 2016-10-29 20:25:35.670230Z] Finished download-and-extract step (success) 13:25:35 INFO - [mozharness: 2016-10-29 20:25:35.670455Z] Running populate-webroot step. 13:25:35 INFO - Running pre-action listener: _resource_record_pre_action 13:25:35 INFO - Running main action method: populate_webroot 13:25:35 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 13:25:35 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 13:25:35 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 13:25:35 INFO - '--tppagecycles', 13:25:35 INFO - '7'], 13:25:35 INFO - 'tests': ['tsvgm']}}, 13:25:35 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 13:25:35 INFO - 'tests': ['tresize', 'tcanvasmark']}, 13:25:35 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 13:25:35 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 13:25:35 INFO - 'tests': ['dromaeo_css', 'kraken']}, 13:25:35 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 13:25:35 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:25:35 INFO - 'talos_options': ['--disable-e10s'], 13:25:35 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 13:25:35 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:25:35 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 13:25:35 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:25:35 INFO - 'talos_options': ['--disable-e10s'], 13:25:35 INFO - 'tests': ['damp', 'tps']}, 13:25:35 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:25:35 INFO - 'tests': ['damp', 'tps']}, 13:25:35 INFO - 'g3': {'talos_options': ['--disable-e10s'], 13:25:35 INFO - 'tests': ['dromaeo_dom']}, 13:25:35 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 13:25:35 INFO - 'g4': {'talos_options': ['--disable-e10s'], 13:25:35 INFO - 'tests': ['basic_compositor_video']}, 13:25:35 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 13:25:35 INFO - 'other': {'talos_options': ['--disable-e10s'], 13:25:35 INFO - 'tests': ['a11yr', 13:25:35 INFO - 'ts_paint', 13:25:35 INFO - 'tpaint', 13:25:35 INFO - 'sessionrestore', 13:25:35 INFO - 'sessionrestore_no_auto_restore', 13:25:35 INFO - 'tabpaint']}, 13:25:35 INFO - 'other-e10s': {'tests': ['a11yr', 13:25:35 INFO - 'ts_paint', 13:25:35 INFO - 'tpaint', 13:25:35 INFO - 'sessionrestore', 13:25:35 INFO - 'sessionrestore_no_auto_restore', 13:25:35 INFO - 'tabpaint']}, 13:25:35 INFO - 'other-e10s_l64': {'tests': ['a11yr', 13:25:35 INFO - 'ts_paint', 13:25:35 INFO - 'tpaint', 13:25:35 INFO - 'sessionrestore', 13:25:35 INFO - 'sessionrestore_no_auto_restore', 13:25:35 INFO - 'tabpaint']}, 13:25:35 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 13:25:35 INFO - 'ts_paint', 13:25:35 INFO - 'tpaint', 13:25:35 INFO - 'sessionrestore', 13:25:35 INFO - 'sessionrestore_no_auto_restore', 13:25:35 INFO - 'tabpaint']}, 13:25:35 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 13:25:35 INFO - 'tests': ['a11yr', 13:25:35 INFO - 'ts_paint', 13:25:35 INFO - 'tpaint', 13:25:35 INFO - 'sessionrestore', 13:25:35 INFO - 'sessionrestore_no_auto_restore', 13:25:35 INFO - 'tabpaint']}, 13:25:35 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 13:25:35 INFO - 'tests': ['a11yr', 13:25:35 INFO - 'ts_paint', 13:25:35 INFO - 'tpaint', 13:25:35 INFO - 'sessionrestore', 13:25:35 INFO - 'sessionrestore_no_auto_restore', 13:25:35 INFO - 'tabpaint']}, 13:25:35 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 13:25:35 INFO - 'tests': ['tsvgx', 13:25:35 INFO - 'tsvgr_opacity', 13:25:35 INFO - 'tart', 13:25:35 INFO - 'tscrollx', 13:25:35 INFO - 'cart']}, 13:25:35 INFO - 'svgr-e10s': {'tests': ['tsvgx', 13:25:35 INFO - 'tsvgr_opacity', 13:25:35 INFO - 'tart', 13:25:35 INFO - 'tscrollx', 13:25:35 INFO - 'cart']}, 13:25:35 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:25:35 INFO - 'talos_options': ['--disable-e10s'], 13:25:35 INFO - 'tests': ['tp5o']}, 13:25:35 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:25:35 INFO - 'tests': ['tp5o']}, 13:25:35 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:25:35 INFO - 'talos_options': ['--disable-e10s', 13:25:35 INFO - '--xperf_path', 13:25:35 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 13:25:35 INFO - 'tests': ['tp5n']}, 13:25:35 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:25:35 INFO - 'talos_options': ['--xperf_path', 13:25:35 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 13:25:35 INFO - 'tests': ['tp5n']}}, 13:25:35 INFO - 'talos.zip': {'path': '', 13:25:35 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 13:25:35 INFO - Running post-action listener: _resource_record_post_action 13:25:35 INFO - [mozharness: 2016-10-29 20:25:35.690552Z] Finished populate-webroot step (success) 13:25:35 INFO - [mozharness: 2016-10-29 20:25:35.690639Z] Running create-virtualenv step. 13:25:35 INFO - Running pre-action listener: _resource_record_pre_action 13:25:35 INFO - Running main action method: create_virtualenv 13:25:35 INFO - Creating virtualenv /builds/slave/test/build/venv 13:25:35 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 13:25:35 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 13:25:35 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 13:25:35 INFO - Using real prefix '/usr' 13:25:35 INFO - New python executable in /builds/slave/test/build/venv/bin/python 13:25:36 INFO - Installing distribute.............................................................................................................................................................................................done. 13:25:38 INFO - Installing pip.................done. 13:25:38 INFO - Return code: 0 13:25:38 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 13:25:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 13:25:39 INFO - Reading from file tmpfile_stdout 13:25:39 INFO - Output received: 13:25:39 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) 13:25:39 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 13:25:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:25:39 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:25:39 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:25:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:25:39 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:25:39 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:25:39 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f416a1dff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f398a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2006ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2003f60>, '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 0x2004d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20051d0>, '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': '1f5564757af27664ca02d71f000001b0-1477772720.177993-371408972', '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 13:25:39 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 13:25:39 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 13:25:39 INFO - Using env: {'DISPLAY': ':0', 13:25:39 INFO - 'HOME': '/home/cltbld', 13:25:39 INFO - 'LANG': 'en_US.UTF-8', 13:25:39 INFO - 'LANGUAGE': 'en_US:en', 13:25:39 INFO - 'LOGNAME': 'cltbld', 13:25:39 INFO - 'MAIL': '/var/mail/cltbld', 13:25:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:25:39 INFO - 'MOZ_NO_REMOTE': '1', 13:25:39 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:25:39 INFO - 'NO_EM_RESTART': '1', 13:25:39 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:25:39 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:25:39 INFO - 'PWD': '/builds/slave/test', 13:25:39 INFO - 'SHELL': '/bin/bash', 13:25:39 INFO - 'SHLVL': '1', 13:25:39 INFO - 'TERM': 'linux', 13:25:39 INFO - 'TMOUT': '86400', 13:25:39 INFO - 'USER': 'cltbld', 13:25:39 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1477772720.177993-371408972', 13:25:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:25:39 INFO - '_': '/tools/buildbot/bin/python'} 13:25:39 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:25:39 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 13:25:39 INFO - Cleaning up... 13:25:39 INFO - Return code: 0 13:25:39 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 13:25:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:25:39 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:25:39 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:25:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:25:39 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:25:39 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:25:39 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7f416a1dff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f398a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2006ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2003f60>, '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 0x2004d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20051d0>, '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': '1f5564757af27664ca02d71f000001b0-1477772720.177993-371408972', '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 13:25:39 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 13:25:39 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 13:25:39 INFO - Using env: {'DISPLAY': ':0', 13:25:39 INFO - 'HOME': '/home/cltbld', 13:25:39 INFO - 'LANG': 'en_US.UTF-8', 13:25:39 INFO - 'LANGUAGE': 'en_US:en', 13:25:39 INFO - 'LOGNAME': 'cltbld', 13:25:39 INFO - 'MAIL': '/var/mail/cltbld', 13:25:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:25:39 INFO - 'MOZ_NO_REMOTE': '1', 13:25:39 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:25:39 INFO - 'NO_EM_RESTART': '1', 13:25:39 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:25:39 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:25:39 INFO - 'PWD': '/builds/slave/test', 13:25:39 INFO - 'SHELL': '/bin/bash', 13:25:39 INFO - 'SHLVL': '1', 13:25:39 INFO - 'TERM': 'linux', 13:25:39 INFO - 'TMOUT': '86400', 13:25:39 INFO - 'USER': 'cltbld', 13:25:39 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1477772720.177993-371408972', 13:25:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:25:39 INFO - '_': '/tools/buildbot/bin/python'} 13:25:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:25:40 INFO - Downloading/unpacking psutil>=3.1.1 13:25:40 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 13:25:40 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 13:25:40 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 13:25:40 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 13:25:40 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 13:25:40 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 13:25:42 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 13:25:42 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 13:25:42 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 13:25:42 INFO - Installing collected packages: psutil 13:25:42 INFO - Running setup.py install for psutil 13:25:42 INFO - building 'psutil._psutil_linux' extension 13:25:42 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 13:25:43 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 13:25:43 INFO - building 'psutil._psutil_posix' extension 13:25:43 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 13:25:43 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 13:25:43 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 13:25:43 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 13:25:43 INFO - Successfully installed psutil 13:25:43 INFO - Cleaning up... 13:25:43 INFO - Return code: 0 13:25:43 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 13:25:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:25:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:25:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:25:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:25:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:25:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:25:43 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 0x7f416a1dff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f398a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2006ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2003f60>, '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 0x2004d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20051d0>, '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': '1f5564757af27664ca02d71f000001b0-1477772720.177993-371408972', '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 13:25:43 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 13:25:43 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 13:25:43 INFO - Using env: {'DISPLAY': ':0', 13:25:43 INFO - 'HOME': '/home/cltbld', 13:25:43 INFO - 'LANG': 'en_US.UTF-8', 13:25:43 INFO - 'LANGUAGE': 'en_US:en', 13:25:43 INFO - 'LOGNAME': 'cltbld', 13:25:43 INFO - 'MAIL': '/var/mail/cltbld', 13:25:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:25:43 INFO - 'MOZ_NO_REMOTE': '1', 13:25:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:25:43 INFO - 'NO_EM_RESTART': '1', 13:25:43 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:25:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:25:43 INFO - 'PWD': '/builds/slave/test', 13:25:43 INFO - 'SHELL': '/bin/bash', 13:25:43 INFO - 'SHLVL': '1', 13:25:43 INFO - 'TERM': 'linux', 13:25:43 INFO - 'TMOUT': '86400', 13:25:43 INFO - 'USER': 'cltbld', 13:25:43 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1477772720.177993-371408972', 13:25:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:25:43 INFO - '_': '/tools/buildbot/bin/python'} 13:25:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:25:44 INFO - Downloading/unpacking mozsystemmonitor==0.3 13:25:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:25:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:25:44 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:25:44 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:25:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:25:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:25:45 INFO - Downloading mozsystemmonitor-0.3.tar.gz 13:25:45 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 13:25:46 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 13:25:46 INFO - Installing collected packages: mozsystemmonitor 13:25:46 INFO - Running setup.py install for mozsystemmonitor 13:25:46 INFO - Successfully installed mozsystemmonitor 13:25:46 INFO - Cleaning up... 13:25:46 INFO - Return code: 0 13:25:46 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 13:25:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:25:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:25:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:25:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:25:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:25:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:25:46 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 0x7f416a1dff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f398a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2006ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2003f60>, '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 0x2004d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20051d0>, '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': '1f5564757af27664ca02d71f000001b0-1477772720.177993-371408972', '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 13:25:46 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 13:25:46 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 13:25:46 INFO - Using env: {'DISPLAY': ':0', 13:25:46 INFO - 'HOME': '/home/cltbld', 13:25:46 INFO - 'LANG': 'en_US.UTF-8', 13:25:46 INFO - 'LANGUAGE': 'en_US:en', 13:25:46 INFO - 'LOGNAME': 'cltbld', 13:25:46 INFO - 'MAIL': '/var/mail/cltbld', 13:25:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:25:46 INFO - 'MOZ_NO_REMOTE': '1', 13:25:46 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:25:46 INFO - 'NO_EM_RESTART': '1', 13:25:46 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:25:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:25:46 INFO - 'PWD': '/builds/slave/test', 13:25:46 INFO - 'SHELL': '/bin/bash', 13:25:46 INFO - 'SHLVL': '1', 13:25:46 INFO - 'TERM': 'linux', 13:25:46 INFO - 'TMOUT': '86400', 13:25:46 INFO - 'USER': 'cltbld', 13:25:46 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1477772720.177993-371408972', 13:25:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:25:46 INFO - '_': '/tools/buildbot/bin/python'} 13:25:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:25:46 INFO - Downloading/unpacking jsonschema==2.5.1 13:25:46 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 13:25:46 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 13:25:46 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 13:25:46 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 13:25:46 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 13:25:46 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 13:25:48 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 13:25:48 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 13:25:48 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 13:25:48 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 13:25:48 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 13:25:48 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 13:25:48 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 13:25:48 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 13:25:48 INFO - Downloading functools32-3.2.3-2.tar.gz 13:25:48 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 13:25:48 INFO - warning: no files found matching '*.txt' 13:25:48 INFO - no previously-included directories found matching 'build' 13:25:48 INFO - no previously-included directories found matching 'dist' 13:25:48 INFO - no previously-included directories found matching '.git*' 13:25:48 INFO - Installing collected packages: jsonschema, functools32 13:25:48 INFO - Running setup.py install for functools32 13:25:48 INFO - warning: no files found matching '*.txt' 13:25:48 INFO - no previously-included directories found matching 'build' 13:25:48 INFO - no previously-included directories found matching 'dist' 13:25:48 INFO - no previously-included directories found matching '.git*' 13:25:48 INFO - Successfully installed jsonschema functools32 13:25:48 INFO - Cleaning up... 13:25:48 INFO - Return code: 0 13:25:48 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 13:25:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:25:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:25:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:25:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:25:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:25:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:25:48 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 0x7f416a1dff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f398a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2006ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2003f60>, '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 0x2004d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20051d0>, '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': '1f5564757af27664ca02d71f000001b0-1477772720.177993-371408972', '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 13:25:48 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 13:25:48 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 13:25:48 INFO - Using env: {'DISPLAY': ':0', 13:25:48 INFO - 'HOME': '/home/cltbld', 13:25:48 INFO - 'LANG': 'en_US.UTF-8', 13:25:48 INFO - 'LANGUAGE': 'en_US:en', 13:25:48 INFO - 'LOGNAME': 'cltbld', 13:25:48 INFO - 'MAIL': '/var/mail/cltbld', 13:25:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:25:48 INFO - 'MOZ_NO_REMOTE': '1', 13:25:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:25:48 INFO - 'NO_EM_RESTART': '1', 13:25:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:25:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:25:48 INFO - 'PWD': '/builds/slave/test', 13:25:48 INFO - 'SHELL': '/bin/bash', 13:25:48 INFO - 'SHLVL': '1', 13:25:48 INFO - 'TERM': 'linux', 13:25:48 INFO - 'TMOUT': '86400', 13:25:48 INFO - 'USER': 'cltbld', 13:25:48 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1477772720.177993-371408972', 13:25:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:25:48 INFO - '_': '/tools/buildbot/bin/python'} 13:25:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:25:49 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 13:25:49 INFO - Cleaning up... 13:25:49 INFO - Return code: 0 13:25:49 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 13:25:49 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')]} 13:25:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:25:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:25:49 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')]} 13:25:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:25:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:25:49 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 0x7f416a1dff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f398a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2006ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2003f60>, '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 0x2004d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20051d0>, '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': '1f5564757af27664ca02d71f000001b0-1477772720.177993-371408972', '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 13:25:49 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 13:25:49 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 13:25:49 INFO - Using env: {'DISPLAY': ':0', 13:25:49 INFO - 'HOME': '/home/cltbld', 13:25:49 INFO - 'LANG': 'en_US.UTF-8', 13:25:49 INFO - 'LANGUAGE': 'en_US:en', 13:25:49 INFO - 'LOGNAME': 'cltbld', 13:25:49 INFO - 'MAIL': '/var/mail/cltbld', 13:25:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:25:49 INFO - 'MOZ_NO_REMOTE': '1', 13:25:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:25:49 INFO - 'NO_EM_RESTART': '1', 13:25:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:25:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:25:49 INFO - 'PWD': '/builds/slave/test', 13:25:49 INFO - 'SHELL': '/bin/bash', 13:25:49 INFO - 'SHLVL': '1', 13:25:49 INFO - 'TERM': 'linux', 13:25:49 INFO - 'TMOUT': '86400', 13:25:49 INFO - 'USER': 'cltbld', 13:25:49 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1477772720.177993-371408972', 13:25:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:25:49 INFO - '_': '/tools/buildbot/bin/python'} 13:25:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:25:49 INFO - Downloading/unpacking blobuploader==1.2.4 13:25:49 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 13:25:49 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 13:25:49 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 13:25:49 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 13:25:49 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 13:25:49 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 13:25:51 INFO - Downloading blobuploader-1.2.4.tar.gz 13:25:51 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 13:25:51 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 13:25:51 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 13:25:51 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 13:25:51 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 13:25:51 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 13:25:51 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 13:25:51 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 13:25:51 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 13:25:51 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 13:25:51 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 13:25:51 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 13:25:51 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 13:25:51 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 13:25:51 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 13:25:51 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 13:25:51 INFO - Downloading docopt-0.6.1.tar.gz 13:25:51 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 13:25:52 INFO - Installing collected packages: blobuploader, requests, docopt 13:25:52 INFO - Running setup.py install for blobuploader 13:25:52 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 13:25:52 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 13:25:52 INFO - Running setup.py install for requests 13:25:52 INFO - Running setup.py install for docopt 13:25:52 INFO - Successfully installed blobuploader requests docopt 13:25:52 INFO - Cleaning up... 13:25:52 INFO - Return code: 0 13:25:52 INFO - Installing None into virtualenv /builds/slave/test/build/venv 13:25: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')]} 13:25:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:25:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:25: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')]} 13:25:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:25:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:25:52 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 0x7f416a1dff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f398a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2006ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2003f60>, '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 0x2004d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20051d0>, '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': '1f5564757af27664ca02d71f000001b0-1477772720.177993-371408972', '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 13:25:52 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 13:25:52 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 13:25:52 INFO - Using env: {'DISPLAY': ':0', 13:25:52 INFO - 'HOME': '/home/cltbld', 13:25:52 INFO - 'LANG': 'en_US.UTF-8', 13:25:52 INFO - 'LANGUAGE': 'en_US:en', 13:25:52 INFO - 'LOGNAME': 'cltbld', 13:25:52 INFO - 'MAIL': '/var/mail/cltbld', 13:25:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:25:52 INFO - 'MOZ_NO_REMOTE': '1', 13:25:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:25:52 INFO - 'NO_EM_RESTART': '1', 13:25:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:25:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:25:52 INFO - 'PWD': '/builds/slave/test', 13:25:52 INFO - 'SHELL': '/bin/bash', 13:25:52 INFO - 'SHLVL': '1', 13:25:52 INFO - 'TERM': 'linux', 13:25:52 INFO - 'TMOUT': '86400', 13:25:52 INFO - 'USER': 'cltbld', 13:25:52 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1477772720.177993-371408972', 13:25:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:25:52 INFO - '_': '/tools/buildbot/bin/python'} 13:25:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:25:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 13:25:52 INFO - Running setup.py (path:/tmp/pip-duKMn0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 13:25:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 13:25:52 INFO - Running setup.py (path:/tmp/pip-fvu_W5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 13:25:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 13:25:52 INFO - Running setup.py (path:/tmp/pip-ibuA5i-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 13:25:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 13:25:53 INFO - Running setup.py (path:/tmp/pip-qMhLgp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 13:25:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 13:25:53 INFO - Running setup.py (path:/tmp/pip-p8sWDL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 13:25:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 13:25:53 INFO - Running setup.py (path:/tmp/pip-xJANaE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 13:25:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 13:25:53 INFO - Running setup.py (path:/tmp/pip-It4_VH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 13:25:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 13:25:53 INFO - Running setup.py (path:/tmp/pip-qqc_0R-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 13:25:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 13:25:53 INFO - Running setup.py (path:/tmp/pip-iCalaZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 13:25:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 13:25:53 INFO - Running setup.py (path:/tmp/pip-GeXBGF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 13:25:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 13:25:53 INFO - Running setup.py (path:/tmp/pip-BJk3rM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 13:25:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 13:25:53 INFO - Running setup.py (path:/tmp/pip-Y50HAG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 13:25:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 13:25:53 INFO - Running setup.py (path:/tmp/pip-ffcatP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 13:25:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 13:25:53 INFO - Running setup.py (path:/tmp/pip-ZYnRfd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 13:25:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 13:25:53 INFO - Running setup.py (path:/tmp/pip-P1HIXC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 13:25:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 13:25:53 INFO - Running setup.py (path:/tmp/pip-B9wATj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 13:25:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 13:25:53 INFO - Running setup.py (path:/tmp/pip-JZPXi0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 13:25:54 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 13:25:54 INFO - Running setup.py install for manifestparser 13:25:54 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 13:25:54 INFO - Running setup.py install for mozcrash 13:25:54 INFO - Running setup.py install for mozdebug 13:25:54 INFO - Running setup.py install for mozdevice 13:25:54 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 13:25:54 INFO - Installing dm script to /builds/slave/test/build/venv/bin 13:25:54 INFO - Running setup.py install for mozfile 13:25:54 INFO - Running setup.py install for mozhttpd 13:25:54 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 13:25:54 INFO - Running setup.py install for mozinfo 13:25:54 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 13:25:54 INFO - Running setup.py install for mozInstall 13:25:54 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 13:25:54 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 13:25:54 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 13:25:54 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 13:25:54 INFO - Running setup.py install for mozleak 13:25:54 INFO - Running setup.py install for mozlog 13:25:55 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 13:25:55 INFO - Running setup.py install for moznetwork 13:25:55 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 13:25:55 INFO - Running setup.py install for mozprocess 13:25:55 INFO - Running setup.py install for mozprofile 13:25:55 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 13:25:55 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 13:25:55 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 13:25:55 INFO - Running setup.py install for mozrunner 13:25:55 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 13:25:55 INFO - Running setup.py install for mozscreenshot 13:25:55 INFO - Running setup.py install for moztest 13:25:55 INFO - Running setup.py install for mozversion 13:25:55 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 13:25:55 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 13:25:55 INFO - Cleaning up... 13:25:55 INFO - Return code: 0 13:25:55 INFO - Installing None into virtualenv /builds/slave/test/build/venv 13:25:55 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:25:55 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:25:55 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:25:55 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:25:55 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:25:55 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:25:55 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 0x7f416a1dff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f398a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2006ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2003f60>, '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 0x2004d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20051d0>, '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': '1f5564757af27664ca02d71f000001b0-1477772720.177993-371408972', '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 13:25:55 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 13:25:55 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 13:25:55 INFO - Using env: {'DISPLAY': ':0', 13:25:55 INFO - 'HOME': '/home/cltbld', 13:25:55 INFO - 'LANG': 'en_US.UTF-8', 13:25:55 INFO - 'LANGUAGE': 'en_US:en', 13:25:55 INFO - 'LOGNAME': 'cltbld', 13:25:55 INFO - 'MAIL': '/var/mail/cltbld', 13:25:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:25:55 INFO - 'MOZ_NO_REMOTE': '1', 13:25:55 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:25:55 INFO - 'NO_EM_RESTART': '1', 13:25:55 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:25:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:25:55 INFO - 'PWD': '/builds/slave/test', 13:25:55 INFO - 'SHELL': '/bin/bash', 13:25:55 INFO - 'SHLVL': '1', 13:25:55 INFO - 'TERM': 'linux', 13:25:55 INFO - 'TMOUT': '86400', 13:25:55 INFO - 'USER': 'cltbld', 13:25:55 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1477772720.177993-371408972', 13:25:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:25:55 INFO - '_': '/tools/buildbot/bin/python'} 13:25:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:25:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 13:25:56 INFO - Running setup.py (path:/tmp/pip-fOhxHE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 13:25:56 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)) 13:25:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 13:25:56 INFO - Running setup.py (path:/tmp/pip-zkgWZS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 13:25:56 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)) 13:25:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 13:25:56 INFO - Running setup.py (path:/tmp/pip-flOk3b-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 13:25:56 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)) 13:25:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 13:25:56 INFO - Running setup.py (path:/tmp/pip-F1P_Gv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 13:25:56 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)) 13:25:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 13:25:56 INFO - Running setup.py (path:/tmp/pip-QoWXRQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 13:25:56 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)) 13:25:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 13:25:56 INFO - Running setup.py (path:/tmp/pip-77Zbvk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 13:25:56 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)) 13:25:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 13:25:56 INFO - Running setup.py (path:/tmp/pip-X76c5F-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 13:25:56 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)) 13:25:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 13:25:56 INFO - Running setup.py (path:/tmp/pip-OI6Mos-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 13:25:56 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)) 13:25:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 13:25:56 INFO - Running setup.py (path:/tmp/pip-Mv7wye-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 13:25:56 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)) 13:25:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 13:25:56 INFO - Running setup.py (path:/tmp/pip-johKb3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 13:25:56 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)) 13:25:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 13:25:56 INFO - Running setup.py (path:/tmp/pip-HKR3Yr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 13:25:56 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)) 13:25:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 13:25:56 INFO - Running setup.py (path:/tmp/pip-k53v5U-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 13:25:56 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)) 13:25:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 13:25:56 INFO - Running setup.py (path:/tmp/pip-CuXOnN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 13:25:57 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)) 13:25:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 13:25:57 INFO - Running setup.py (path:/tmp/pip-Bx9uxb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 13:25:57 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)) 13:25:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 13:25:57 INFO - Running setup.py (path:/tmp/pip-Jgrr2u-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 13:25:57 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)) 13:25:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 13:25:57 INFO - Running setup.py (path:/tmp/pip-ww8eto-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 13:25:57 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)) 13:25:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 13:25:57 INFO - Running setup.py (path:/tmp/pip-3aT3YB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 13:25:57 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)) 13:25:57 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)) 13:25:57 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)) 13:25:57 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)) 13:25:57 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)) 13:25:57 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)) 13:25:57 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 13:25:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:25:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:25:57 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:25:57 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:25:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:25:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:25:59 INFO - Downloading blessings-1.6.tar.gz 13:25:59 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 13:25:59 INFO - Installing collected packages: blessings 13:25:59 INFO - Running setup.py install for blessings 13:25:59 INFO - Successfully installed blessings 13:25:59 INFO - Cleaning up... 13:25:59 INFO - Return code: 0 13:25:59 INFO - Done creating virtualenv /builds/slave/test/build/venv. 13:25:59 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 13:25:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 13:25:59 INFO - Reading from file tmpfile_stdout 13:25:59 INFO - Current package versions: 13:25:59 INFO - argparse == 1.2.1 13:25:59 INFO - blessings == 1.6 13:25:59 INFO - blobuploader == 1.2.4 13:25:59 INFO - docopt == 0.6.1 13:25:59 INFO - functools32 == 3.2.3-2 13:25:59 INFO - jsonschema == 2.5.1 13:25:59 INFO - manifestparser == 1.1 13:25:59 INFO - mozInstall == 1.12 13:25:59 INFO - mozcrash == 0.17 13:25:59 INFO - mozdebug == 0.1 13:25:59 INFO - mozdevice == 0.48 13:25:59 INFO - mozfile == 1.2 13:25:59 INFO - mozhttpd == 0.7 13:25:59 INFO - mozinfo == 0.9 13:25:59 INFO - mozleak == 0.1 13:25:59 INFO - mozlog == 3.4 13:25:59 INFO - moznetwork == 0.27 13:25:59 INFO - mozprocess == 0.23 13:25:59 INFO - mozprofile == 0.28 13:25:59 INFO - mozrunner == 6.12 13:25:59 INFO - mozscreenshot == 0.1 13:25:59 INFO - mozsystemmonitor == 0.3 13:25:59 INFO - moztest == 0.7 13:25:59 INFO - mozversion == 1.4 13:25:59 INFO - psutil == 3.1.1 13:25:59 INFO - requests == 1.2.3 13:25:59 INFO - wsgiref == 0.1.2 13:25:59 INFO - Installing None into virtualenv /builds/slave/test/build/venv 13:25:59 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')]} 13:25:59 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:25:59 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:25:59 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')]} 13:25:59 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:25:59 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:25:59 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 0x7f416a1dff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f398a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2006ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2003f60>, '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 0x2004d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20051d0>, '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': '1f5564757af27664ca02d71f000001b0-1477772720.177993-371408972', '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 13:25:59 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 13:25:59 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 13:25:59 INFO - Using env: {'DISPLAY': ':0', 13:25:59 INFO - 'HOME': '/home/cltbld', 13:25:59 INFO - 'LANG': 'en_US.UTF-8', 13:25:59 INFO - 'LANGUAGE': 'en_US:en', 13:25:59 INFO - 'LOGNAME': 'cltbld', 13:25:59 INFO - 'MAIL': '/var/mail/cltbld', 13:25:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:25:59 INFO - 'MOZ_NO_REMOTE': '1', 13:25:59 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:25:59 INFO - 'NO_EM_RESTART': '1', 13:25:59 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:25:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:25:59 INFO - 'PWD': '/builds/slave/test', 13:25:59 INFO - 'SHELL': '/bin/bash', 13:25:59 INFO - 'SHLVL': '1', 13:25:59 INFO - 'TERM': 'linux', 13:25:59 INFO - 'TMOUT': '86400', 13:25:59 INFO - 'USER': 'cltbld', 13:25:59 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1477772720.177993-371408972', 13:25:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:25:59 INFO - '_': '/tools/buildbot/bin/python'} 13:25:59 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:25:59 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)) 13:25:59 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)) 13:25:59 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)) 13:25:59 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)) 13:25:59 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)) 13:25:59 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)) 13:25:59 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)) 13:25:59 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)) 13:25:59 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)) 13:25:59 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)) 13:25:59 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)) 13:25:59 INFO - Cleaning up... 13:25:59 INFO - Return code: 0 13:25:59 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 13:25:59 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')]} 13:25:59 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:25:59 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:25:59 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')]} 13:25:59 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:25:59 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:25:59 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 0x7f416a1dff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f398a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2006ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2003f60>, '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 0x2004d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20051d0>, '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': '1f5564757af27664ca02d71f000001b0-1477772720.177993-371408972', '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 13:25:59 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 13:25:59 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 13:25:59 INFO - Using env: {'DISPLAY': ':0', 13:25:59 INFO - 'HOME': '/home/cltbld', 13:25:59 INFO - 'LANG': 'en_US.UTF-8', 13:25:59 INFO - 'LANGUAGE': 'en_US:en', 13:25:59 INFO - 'LOGNAME': 'cltbld', 13:25:59 INFO - 'MAIL': '/var/mail/cltbld', 13:25:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:25:59 INFO - 'MOZ_NO_REMOTE': '1', 13:25:59 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:25:59 INFO - 'NO_EM_RESTART': '1', 13:25:59 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:25:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:25:59 INFO - 'PWD': '/builds/slave/test', 13:25:59 INFO - 'SHELL': '/bin/bash', 13:25:59 INFO - 'SHLVL': '1', 13:25:59 INFO - 'TERM': 'linux', 13:25:59 INFO - 'TMOUT': '86400', 13:25:59 INFO - 'USER': 'cltbld', 13:25:59 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1477772720.177993-371408972', 13:25:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:25:59 INFO - '_': '/tools/buildbot/bin/python'} 13:26:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:26:00 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 13:26:00 INFO - Cleaning up... 13:26:00 INFO - Return code: 0 13:26:00 INFO - Running post-action listener: _resource_record_post_action 13:26:00 INFO - Running post-action listener: _start_resource_monitoring 13:26:00 INFO - Starting resource monitoring. 13:26:00 INFO - [mozharness: 2016-10-29 20:26:00.227714Z] Finished create-virtualenv step (success) 13:26:00 INFO - [mozharness: 2016-10-29 20:26:00.228646Z] Running install step. 13:26:00 INFO - Running pre-action listener: _resource_record_pre_action 13:26:00 INFO - Running main action method: install 13:26:00 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 13:26:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 13:26:00 INFO - Reading from file tmpfile_stdout 13:26:00 INFO - Detecting whether we're running mozinstall >=1.0... 13:26:00 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 13:26:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 13:26:00 INFO - Reading from file tmpfile_stdout 13:26:00 INFO - Output received: 13:26:00 INFO - Usage: mozinstall [options] installer 13:26:00 INFO - Options: 13:26:00 INFO - -h, --help show this help message and exit 13:26:00 INFO - -d DEST, --destination=DEST 13:26:00 INFO - Directory to install application into. [default: 13:26:00 INFO - "/builds/slave/test"] 13:26:00 INFO - --app=APP Application being installed. [default: firefox] 13:26:00 INFO - mkdir: /builds/slave/test/build/application 13:26:00 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'] 13:26:00 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 13:26:17 INFO - Reading from file tmpfile_stdout 13:26:17 INFO - Output received: 13:26:17 INFO - /builds/slave/test/build/application/firefox/firefox 13:26:17 INFO - Running post-action listener: _resource_record_post_action 13:26:17 INFO - [mozharness: 2016-10-29 20:26:17.396316Z] Finished install step (success) 13:26:17 INFO - [mozharness: 2016-10-29 20:26:17.396589Z] Running run-tests step. 13:26:17 INFO - Running pre-action listener: _resource_record_pre_action 13:26:17 INFO - Running main action method: run_tests 13:26:17 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 13:26:17 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 13:26:17 INFO - Python 2.7.3 13:26:17 INFO - Return code: 0 13:26:17 INFO - grabbing minidump binary from tooltool 13:26: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')]} 13:26:17 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 0x2003f60>, '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 0x2004d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20051d0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 13:26:17 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 13:26:17 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 13:26:17 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 13:26:17 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 13:26:17 INFO - Return code: 0 13:26:17 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 13:26:17 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 13:26:17 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 13:26:17 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 13:26:17 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 13:26:17 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', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1477698451/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-027', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 13:26:17 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 --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1477698451/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-027 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 13:26:17 INFO - Using env: {'DISPLAY': ':0', 13:26:17 INFO - 'HOME': '/home/cltbld', 13:26:17 INFO - 'LANG': 'en_US.UTF-8', 13:26:17 INFO - 'LANGUAGE': 'en_US:en', 13:26:17 INFO - 'LOGNAME': 'cltbld', 13:26:17 INFO - 'MAIL': '/var/mail/cltbld', 13:26:17 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 13:26:17 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 13:26:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:26:17 INFO - 'MOZ_NO_REMOTE': '1', 13:26:17 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 13:26:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:26:17 INFO - 'NO_EM_RESTART': '1', 13:26:17 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:26:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:26:17 INFO - 'PWD': '/builds/slave/test', 13:26:17 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 13:26:17 INFO - 'SHELL': '/bin/bash', 13:26:17 INFO - 'SHLVL': '1', 13:26:17 INFO - 'TERM': 'linux', 13:26:17 INFO - 'TMOUT': '86400', 13:26:17 INFO - 'USER': 'cltbld', 13:26:17 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1477772720.177993-371408972', 13:26:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:26:17 INFO - '_': '/tools/buildbot/bin/python'} 13:26:17 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Inbound', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1477698451/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-027', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 13:26:17 INFO - mozversion application_buildid: 20161028164731 13:26:17 INFO - mozversion application_changeset: c136ac92dcdc37dfd09f4868887f1ccf86522989 13:26:17 INFO - mozversion application_display_name: Nightly 13:26:17 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 13:26:17 INFO - mozversion application_name: Firefox 13:26:17 INFO - mozversion application_remotingname: firefox 13:26:17 INFO - mozversion application_repository: https://hg.mozilla.org/integration/mozilla-inbound 13:26:17 INFO - mozversion application_vendor: Mozilla 13:26:17 INFO - mozversion application_version: 52.0a1 13:26:17 INFO - mozversion platform_buildid: 20161028164731 13:26:17 INFO - mozversion platform_changeset: c136ac92dcdc37dfd09f4868887f1ccf86522989 13:26:17 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/mozilla-inbound 13:26:17 INFO - mozversion platform_version: 52.0a1 13:26:17 INFO - using testdate: 1477772777 13:26:17 INFO - actual date: 1477772777 13:26:17 INFO - starting webserver on 'localhost:54200' 13:26:17 INFO - SUITE-START | Running 2 tests 13:26:17 INFO - TEST-START | dromaeo_css 13:26:17 INFO - operating with platform_type : linux_ 13:26:17 INFO - Initialising browser for dromaeo_css test... 13:26:17 INFO - TEST-INFO | started process 3296 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpRy3MwE/profile http://localhost:54200/getInfo.html) 13:26:24 INFO - PROCESS | 3296 | __metrics Screen width/height:1600/1200 13:26:24 INFO - PROCESS | 3296 | colorDepth:24 13:26:24 INFO - PROCESS | 3296 | Browser inner width/height: 1024/697 13:26:24 INFO - PROCESS | 3296 | __metrics 13:26:24 INFO - PROCESS | 3296 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 13:26:24 INFO - PROCESS | 3296 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 205: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 13:26:26 INFO - TEST-INFO | 3296: exit 0 13:26:26 INFO - Browser initialized. 13:26:26 INFO - Running cycle 1/1 for dromaeo_css test... 13:26:26 INFO - TEST-INFO | started process 3381 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpRy3MwE/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 13:26:38 INFO - PROCESS | 3381 | RSS: Main: 172322816 13:26:38 INFO - PROCESS | 3381 | 13:27:30 INFO - PROCESS | 3381 | 1477772850144 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] 13:29:40 INFO - PROCESS | 3381 | Cycle 1(1): loaded http://localhost:54200/tests/dromaeo/cssquery-dojo.html (next: http://localhost:54200/tests/dromaeo/cssquery-ext.html) 13:29:42 INFO - PROCESS | 3381 | RSS: Main: 395190272 13:29:42 INFO - PROCESS | 3381 | 13:32:45 INFO - PROCESS | 3381 | Cycle 1(1): loaded http://localhost:54200/tests/dromaeo/cssquery-ext.html (next: http://localhost:54200/tests/dromaeo/cssquery-jquery.html) 13:32:45 INFO - PROCESS | 3381 | RSS: Main: 284491776 13:32:45 INFO - PROCESS | 3381 | 13:35:47 INFO - PROCESS | 3381 | Cycle 1(1): loaded http://localhost:54200/tests/dromaeo/cssquery-jquery.html (next: http://localhost:54200/tests/dromaeo/cssquery-mootools.html) 13:35:48 INFO - PROCESS | 3381 | RSS: Main: 220897280 13:35:48 INFO - PROCESS | 3381 | 13:38:50 INFO - PROCESS | 3381 | Cycle 1(1): loaded http://localhost:54200/tests/dromaeo/cssquery-mootools.html (next: http://localhost:54200/tests/dromaeo/cssquery-prototype.html) 13:38:51 INFO - PROCESS | 3381 | RSS: Main: 219529216 13:38:51 INFO - PROCESS | 3381 | 13:41:53 INFO - PROCESS | 3381 | Cycle 1(1): loaded http://localhost:54200/tests/dromaeo/cssquery-prototype.html (next: http://localhost:54200/tests/dromaeo/cssquery-yui.html) 13:41:54 INFO - PROCESS | 3381 | RSS: Main: 220012544 13:41:54 INFO - PROCESS | 3381 | 13:44:57 INFO - PROCESS | 3381 | Cycle 1(1): loaded http://localhost:54200/tests/dromaeo/cssquery-yui.html (next: http://localhost:54200/tests/dromaeo/cssquery-dojo.html) 13:44:57 INFO - PROCESS | 3381 | RSS: Main: 311758848 13:44:57 INFO - PROCESS | 3381 | 13:44:57 INFO - PROCESS | 3381 | __start_tp_report 13:44:57 INFO - PROCESS | 3381 | _x_x_mozilla_page_load 13:44:57 INFO - PROCESS | 3381 | _x_x_mozilla_page_load_details 13:44:57 INFO - PROCESS | 3381 | |i|pagename|runs| 13:44:57 INFO - PROCESS | 3381 | |0;dojo.html;3043.07186308176;3087.0430166648352;3095.257138286811;3130.0140455756436;3130.420872138653;5129.563987061104;5208.322918020652;5290.576753859692;5335.1197052486295;5370.838874833757;5241.659292146008;5354.5716342692585;5476.644018138818;5513.393526712069;5538.833834984936;4864.951350486503;4877.34155888954;4924.950750492485;4934.728589927553;4952.57903078237;4927.088488629597;4989.326440930464;4999.825006124786;5027.421846487646;5069.681882710485;4855.320255164244;4910.656254062217;4920.384951881015;4965.801367945278;5013.949860501403;4836.879078023042;4869.82955596556;4880.755962201875;4893.510648935078;4937.160682683916;4835.782389792468;4836.395450568679;4837.467878533358;4837.9516204837855;4892.192788189945;5382.6770393776105;5387.4612538746205;5390.164524498709;5390.299261096033;5405.5135037846385;5557.888842223173;5586.972065139689;5589.189567512729;5637.887242255132;5742.196092547047;5665.830025099253;5682.687452190128;5725.971370143123;5739.942600573982;5839.270091238595;5374.973125134427;5378.623496355218;5380.542653874386;5438.83683489492;5441.401445840955;5736.139579063174;5846.561507886926;5855.970720146457;5863.442972917566;5864.266966629171;5524.972375138179;5567.24842146305;5574.916376254359;5628.183913332544;5628.831135065954;5686.2607860977805;5721.542276617861;5766.740496677659;5772.711364431846;5773.942260577341;5654.123610840326;5663.575231857627;5670.5747068969995;5678.943210567842;5683.403242659544;5529.944700553024;5708.71456427177;5712.80005199816;5714.114312281603;5717.313922329347;4358.760268185217;4402.3836662867225;4403.691741578059;4404.339349097661;4404.55954404557;3963.0686788604653;3963.722539422213;3969.285528604879;3980.661643760313;3981.641652251253;5325.813596524103;5344.866378340573;5409.83770486886;5412.025835349675;5432.91850622241;5671.971640141773;5738.569607279471;5739.053056245672;5742.856428589319;5785.450382213767;5436.401995780461;5444.237806707064;5446.727663616883;5448.83653490396;5453.018456677757;4770.117528257283;4797.664163508521;4971.776270067856;5017.7491125443585;5022.84931452057;6096.496448835484;6098.522998456991;6104.368208815833;6106.15732346443;6123.8162855114415;5781.739821707949;5833.533317334518;5836.358000619844;5856.736446859816;5888.882222355443;5862.530997520274;5903.144044113666;5909.438603332676;5968.313643931004;6093.360197179232;5600.327960644749;5602.383737788921;5604.607677462538;5605.411431799603;5613.943860561342;5713.514351280188;5720.227769251098;5726.284214473191;5727.5417966561745;5733.741981610921;5572.136318870582;5609.467100625434;5612.466815652507;5622.887542249214;5623.718814059199;5572.693501857275;5578.219049333178;5580.888382232251;5584.525315348078;5591.27313449249;5491.121420572849;5639.210510528447;5645.520130788929;5648.971755141198;5649.4350564944825;5640.32316122068;5652.519535839335;5685.232493613475;5691.77232910679;5746.712664366849;5578.832635020955;5579.637323573955;5583.69289689071;5584.3857175711455;5585.357683866408 13:44:57 INFO - PROCESS | 3381 | |1;ext.html;588.3819496384941;613.5705006495452;628.8302158417231;643.7714611312983;649.5972497051825;32105.35789284213;34984.12539686509;35087.298254034904;35110.12224694381;35115.64884351156;42286.78856605721;43235;43284.350734739004;47251.29123063157;47424;8793.604287807064;8919.28645708345;8932.972708138583;8938.553072346389;8946.731598052069;8799.384043116985;8879.245264152554;8882.289416846668;8889.42218755782;8891.110888911122;8151.429399942006;8325.084240733515;8336.374771892102;8538.615762290712;8548.145185481433;10428.165746740242;10645.095166910784;10661.466926653713;11082.778344433147;11100.222984391095;10618.628348007782;10663.573457061708;10686.679399618024;10689.893101068967;10692.465376731132;40524.79737601322;40826.38760418596;40838;40838.183236335404;40911.38632920509;3574.8927532174075;3662.6703596676425;3730.1607138393915;4061.045654271244;4068.0846809467635;30591.54112688289;30855.84572077148;30966.38067238665;31005.379892402252;32670.509942350884;4193.350030745209;4200.789960501963;4392.428984232061;4397;4484.506704262529;314804;315629;317498;317771;318072;57589.424105759244;57806.13290800642;57947;58051.129233060696;58149.41850581524;60565;60602.696986514784;60687;60757.392426075174;60757.392426076054;15303.92348038275;15309.46416875404;15428.15145167004;15529.45646902353;15551.377944882079;11893.524259029715;11921.70195745096;11965.40172991347;12042.759144817055;12106.636800895987;14705.26473676312;16588.25352859124;16679.91660041692;16784.223549701463;16886.915565422096;4908.60679691674;5670.489655930986;5746.281714785652;5752.884942301214;5880.882382352329;961.20700422152;967.811276801017;1028.4138041316528;1066.5200659703164;1105.5688281570194;29432.26419339534;31147.377052459276;31455.52816707751;31509.8424507876;32023.839880800446;1093.3767752381066;1137.4597066393396;1153.2273376837538;1187.8455800746021;1219.1100496637505;16563.337466501205;16627.168641567874;16701.916490417712;16717.749233761504;16950.57623559421;476429;479100.4404801792;479835;480702;480956;56311.71844140753;56337;56346;56493.152602710994;56541;1239.8450193725785;1287.9742405151844;1321.9603411897658;1338.4579245405625;1350.4058214385639;30643.54034689437;31306;31959;32075;32720.836395817867;46874.76562617165;47417;47460.52539474561;47508.28737569008;47557.28664069973;377723.8910443552;380277;381216;381745;428819;25915.87042064853;27592.448151037268;28014.43971120607;28021.159365219075;28045.158645240674;46122.308165376875;46477.6056718299;47923.281150782066;48047.75976120237;48549.51450485591;39266.2146757069;39926.401103982884;39928.401073984496;41077.79461102675;41995.37006944959;39356.60643393644;39833.2033359337;40064.1987160261;41216;41310.79344603258;39750.60249397469;40366.1926761469;40725.796371017954;40840.591594084864;40857.79571102125;33259;36293.63706362902;36598.8170059148;36600.26799463943;36922.63077369192;27539.173824785288;28032.71967280301;28115.43769124647;28145.43709125847;28189.859050704614 13:44:57 INFO - PROCESS | 3381 | |2;jquery.html;370.4776265465694;389.27206124547104;391;404.88056023473075;421.6963786074028;13794.931025344871;16117.516474505768;18396.17217225225;18963.810361896376;19002.239910403583;18963.71554426681;18984.430467085975;19025.2389904404;19112.617747645072;19308.131134098963;4104.363823607331;5385.569154467643;5601.971990140044;5613.270274864262;5623.297087864017;4088.713790034699;4096.3855421686685;4185.330347144458;6151;6253.124562561223;6215.787921355338;6218.502519798405;6259.0298503731765;6265.216847894013;6270.968645156768;6056;6243.219597550306;6271.310155882849;6271.592346497486;6293.213348331458;5402.405735369106;5577.330720313547;5587.245721827582;5589.329280486368;5604.915926261109;22883.771162288496;23008.734519601414;23062.884685576464;23199.88400058006;23298.65052024221;2403.9278821635203;2490.9128180513594;2626.1727555819857;2682.3160094176055;2893.4068515954177;10743.51654175564;13211.273379964097;13683.452661893512;13783.379747911367;14078.507252246225;1890.4801179675562;1951.6194342103295;1960.7058941158798;1960.7647082350068;1978.8120128587761;78473.60763196205;79792.60103699502;79931.60034199792;82409.58795205985;83170.99999999939;10623.575056997788;10906.945465272624;11142.49858756358;11148.498317575728;11233.719157020976;15456.690866182613;15456.92271538635;15477.845221547866;15483.612909677347;15490.30293636789;7505.324520793155;7819.491733037335;7843.450958432855;8044.747470708211;8179.386546008954;7308.561486310732;7348.77953661391;7542.094948606203;7593.962030189814;7634.847303054019;4564.178447879347;4612.677112602153;4775.832845850378;4818.542238487338;4862;1815.4372144635206;1934.4970307720093;1946.639871623754;1983.4446355020618;2019.7475315585552;942.2038377570941;948.7248697877676;983.2036050798876;1003.3578509753763;1012;19103.522411939535;19133.8086619132;19141.712874306897;19351;19877.223327568005;950.6387572722459;980.4362491567377;993.0665174735725;998.3211416237028;1021.8722659667542;10546.945305469546;10784.676459706221;10974.506147223394;10985.780284394426;11047.226694131494;408222;413108;421852;423647;424406;57028;60494;76790;81977.18022819696;92947;982.9262805289632;1001.2990906365574;1014.8934361891895;1030.9432981185957;1034.110664828247;16904.746428803825;17043.914780426017;17637;17916.283348665907;18343.449696509128;40451.19097617972;41343.37984930168;41690.374644380965;42038;42348;55508;55576.164502726635;56123.71938140283;56703.14945275742;56946;8442.831143377221;8449.23956843887;8519.829603407774;8540.786480338042;8861.73414797557;12541.184822986477;12801.29592872401;12878.613641590768;13005.869941300465;13128.540501082416;11275.887241127484;11492.195546312012;11495.655130345769;11628.825567616661;11833.585824496102;11004.339739615649;11126.944365278121;11231.71920701989;11380.430978450879;11667.6499705009;11399.829002565135;11597.13021523406;11654.941725291319;11851.229670071418;11965.700857478632;8347.540885251126;8370.623321950405;8509.829803403773;8566.229039386486;8768.60541275657;10311.793764124526;11224.158188136085;11292.830607541058;11698.649040528799;11833.822492662444 13:44:57 INFO - PROCESS | 3381 | |3;mootools.html;1336.9933150334248;1467.8825693944486;1499.947501837436;1621.9594510137244;1769.5929936114685;7209.3872020878225;7888.802779930505;8102.878456823152;8120.106788253287;8307.75076747697;8124.553149576771;8175.7138500152505;8202.507849529033;8206.261436470717;8215.630296636651;2204.7574766775683;2231.0964059555904;2234.2515257388795;2238.541099074694;2244.1920908472935;2164.166795783619;2210.06072419222;2225.8219342452567;2236.7204099487562;2241.3724157236;2207.7681843406453;2228.231260215231;2241.9551608967813;2242.2040175737625;2262.4230821140586;2150.3656421355736;2160.114353115223;2179.9128034878586;2181.7490988536283;2183.792539708733;2191.6274233380364;2208.4810069633622;2209.3813732154863;2211.40292121128;2216.357256395643;8216.753497395088;8270.669173233124;8505.574721263913;8610.483370997697;8610.612522436442;4945.23348880924;5088.211327244283;5134.2812006319145;5141.845744627667;5147.0992576298995;3182.713555779991;3328.916777080568;3358.630550639428;3386.4750963600436;3389.4068538005995;1092.8524649172339;1115.857553497279;1122.2256642916443;1124.9212555121144;1130.6381957773515;11083.72290692731;11141.72145696356;11174;11201.943990280079;11266.718332041683;4020.0954785173103;4139.834406623701;4190.224808410454;4228.746275223496;4263.531011588722;8987.101289870961;9019.954900225457;9021.684241051531;9026.86459703105;9032.187103160748;5002.049610573979;5008.398992120969;5017.122003649347;5017.598592112695;5020.849374518771;3898.1813819098306;4137.420761093449;4191.413202151702;4673.415823022122;4741.881452963635;3410.8294585271133;3418.8290585470627;3525.894223173309;3534.2754735279204;3545.13144279648;1062.1768129699544;1068.834330678746;1074.425182527344;1075.725689949058;1084.8372744088292;873.9475631462133;890.9420887642412;893.4907102951386;908.2824568590739;934.780326623243;5311.256424100629;5460.126379779216;5462.126059830488;5525.640833345819;5614.410486898817;879.2394578689515;888.2583043159035;897.6095398501542;917.2799352508249;922.5110691333604;3630.09247688078;3693;3745.5505339358906;3748.6626203641804;3796.6901419010396;9778.462184579916;10140.239482038876;10401.479926003669;10421.270511064304;10528.947355263175;10431.791364172674;10440.791184176274;10442.738931526772;10445.84331235032;10469;7827.452078354574;8067.39494537912;8079.959600201962;8089.433739638169;8095.311898488694;5371.409144994126;5455.1271796512365;5466.835994920159;5529.170624406372;5529.385430397596;9341.439513629204;9375.10936461035;9381.765455863659;9394.107559781809;9400.529973501434;9495.192908602847;9544.570494327632;9655.275854310814;9696.369735967139;9796.559154838193;7089;7236.565806051653;7236.782896513113;7236.927630723625;7241.565506069653;8101.351891848756;8212.17878212174;8262.17378262169;8272.875906861282;8291.08798032228;7386.261373862786;7502.249775022454;7536.7362142324755;7577.772666820004;7641.541507509567;7132.179799323144;7287.562746235243;7292.489525733148;7331.486795924234;7394.593297368697;6769.356911093439;6831;6863.210730766026;6884.173899132136;6887.173539175331;4795.880102997314;4920.630952678492;4936.802527898843;4938.506149385176;4994.5754610858485;4632.080597803579;4665.906681866276;4690.882727931829;4841.636877234151;4852.975735121302 13:44:57 INFO - PROCESS | 3381 | |4;prototype.html;320.17714473802323;321.91147434455536;322.33277116369123;327.6494151258153;333.89816106087636;5188.066148093347;5203.323567936172;5206.167013277876;5214.921776173361;5240.371155461346;5154.484551544853;5157.510036546531;5163.380394352683;5166.4575219601875;5182.740862956856;3836.5779764225845;3890;3929.3713005918917;3991.42124391963;4059.985003749063;4023.7384570002855;4028.858989935353;4057.573954734755;4087.57080506547;4092.9795351023354;3995.1410446753944;4009.218202450523;4012.154408971862;4013.618706222904;4036.394540818886;3793.696504279651;3826.253880493305;3907.7069219808627;3979.960200397988;3997.8800635980965;3533.0990597397754;3550.289942011608;3559.7864128152396;3562.2163124112653;3567.625399333059;4942.159832828392;4948.752562371903;4956.752162391866;4984.355162796269;5024.171011783052;4486.394336764561;4527.16649756849;4559.954400455986;4571.885702857422;4589.35748995141;5275.472452754732;5288.81489147878;5322.946770532284;5325.440828712968;5328.706921119337;3906.8632597858937;3909.354956432185;3918.5101862267215;3934.996575873134;3940.566537680853;5339.199120132012;5480.835574932758;5520.503154716095;5527.198556209327;5601.523870471015;3941.3693808990424;3949.19041596472;3949.5458022327225;3956.8812935611977;3961.3265744823448;3980.3830406286493;3990.5610382857863;4008.599140085968;4012.4181993610764;4015.77913214776;4316.482022157361;4534.501204867462;4544.659150563721;4591.449026116888;4594.494605593382;5394.541463975606;5400.83797486076;5410.621256512085;5413.724696558604;5433.864153396117;1363.8158848555518;1379.0415661115428;1381.599336192513;1382.9861701382858;1383.080251632673;852.8336974289954;878.3412440669498;897.4749771383683;901.715959472764;910.2490445382585;5041.344625198701;5182.170852663631;5206.8958620828125;5248.501392367719;5251.842444726664;5476.534494567926;5491.560675145979;5507.862303442366;5549.472800083986;5565.777368905198;5249.606279529051;5291.894162116813;5293.285406470154;5299.867503312448;5300.946990530122;2916.3292442737866;2948.4840152973143;2967.2285205846206;2973.598564193806;2981.269588950721;5759.395263497357;5773.711314434261;5787.565932555075;5822.992226685047;5832.533397328203;5372.811951581676;5614.2701448811395;5620.831375058755;5643.915341269884;5663.546916246691;5677.914831277534;5694.373618901835;5725.570582206351;5726.198332233491;5751.22358481608;5258.631895767413;5486.561075113901;5517;5519.751611177427;5520.199571062093;5438.972805135949;5440.755166017618;5457.025920873054;5459.945400545944;5493.450654934634;5741.598088133791;5756;5760.135979603093;5765.221695071112;5765.538756899522;3853.1523064925673;3949.269385163754;3952.6245006724316;3977.4033894915992;3986.621270979252;5370.3287089113865;5409.161579955114;5521.779128834802;5522.2544956430365;5524.585905812246;5397.896209679371;5398.757055932414;5406.188926709597;5451.400345961862;5472.151816468454;5103.209002604603;5333.893322133458;5342.572594192533;5391.676499410048;5430.565554755689;5311.415744268204;5311.681299122065;5327.694714794745;5334.973325133349;5356.7589458473685;5213.739313034409;5299.364076310867;5309.946900530946;5380.919286210632;5438.2386465894015;5313.3889602694635;5342.3856256531;5348.010618035676;5352;5352.705601191972 13:44:57 INFO - PROCESS | 3381 | |5;yui.html;712.0956385390554;720.2617317249815;734.7501849371213;739.885317775745;763.2062654838968;13002.739945201101;13853.099548529339;14047.508337208199;14073.507427240062;14171.433142674294;13414.19514829111;13441.865581344184;13508.662283442918;13588.25264610446;13617.93191034046;639.3127388057833;667.2626747444077;766.31797700047;775.6974779835855;796.191865256762;791.3827214772487;808.8341889912583;809.4131754478016;809.4131754478016;809.9109097999216;855.8972923249188;856.8029353248756;857.0229937870832;857.4940784936886;857.6226460357454;682.737146198717;705.717712914833;809.2352726673296;843.0094638799417;852.0286872964825;610.7404353149893;616.9629822210682;618.4372221278614;618.4434009391583;618.7834258009706;13768.586942391745;13776.793348099787;13788.517401890886;13819.861801381958;13825.170489770546;13674.247916364597;13761.518346857813;13806.93096534521;13875.37560809766;13992.230427326493;11995.940020299842;12228.755424891542;12429;12626.74746505074;13097;4139.19285739281;4344.23975804233;4372.584604462571;4380.145871555048;4512.954870451319;61817.38182618161;63805.36194638087;64285;64726.37835622056;65047;10593.735156620993;10697.411642359744;10743.946280268705;10752.623658171926;10774.838377424345;20389.694154587694;20592.27927022547;20684;20824.375268741962;20842.68735968962;7230.963845180846;7309.707611695472;7344.118705755237;7497.9250207497225;7666.8849967250535;4363.912721745547;4394.340848872631;4439.866803995886;4515.14212299662;4614.653900957442;3196.5045417960255;3257.755668324885;3260.7717459777587;3262.6737326267657;3277.360914621626;570.7403131575123;572.9484346408843;583.0670926517623;594.925634295713;596.892559339323;540.367769709441;579.3569138256532;598.7186022569385;642.8649983503423;663.0981864664053;8414;8652.8702069469;8812.8678069829;9019.098090191059;9025.774355641162;633.1673848888696;645.4384685323705;658.8903056794528;664.3058004385429;689.2728171778722;4114.547399786021;4564.52072532386;4585.977070114628;4786.976065119722;5004.770015333985;78314;84824.21406287482;89976.55011724899;91208;93313.5334323324;26534.46931061368;27085.729142708715;47247;78346.21653783503;79223;42845.57154428416;43500.78249608795;58814;68753.65623171852;71501.2849871505;9368.484733339732;9807.509624518889;9905.55425005862;9918.355306905029;9921.603135874484;44959.77520112378;45880;46771.532284676716;47092.29361559648;48191.75904120597;60606.696966514886;66799.66600166968;66835;68486.65756671384;69795.65102174456;11977.520899164285;12095.21381110225;12291.446884890023;12324.445399956845;12644.73552644728;14307.713845723236;14403.207823569805;14517.927410362881;14580.85419145795;14922.701545969237;13158.60524184276;13474.86525134736;13829;13892.23592702411;14300.928495357874;12548.811767823672;12657.367131643565;12922.870771292542;13417.127886687334;13438;12804.61586152417;13172.143810652276;13352.866471335163;13412.463501460223;13807.51673691416;10871.619493317696;10905.618303359344;11113.777724445628;11297.209195356247;11362.375069371265;11259.324440533594;11437.199396042197;11569.942150289195;11723.531058757895;11785.528578856749 13:44:57 INFO - PROCESS | 3381 | __end_tp_report 13:44:57 INFO - PROCESS | 3381 | __start_cc_report 13:44:57 INFO - PROCESS | 3381 | _x_x_mozilla_cycle_collect,2325 13:44:57 INFO - PROCESS | 3381 | __end_cc_report 13:44:57 INFO - PROCESS | 3381 | __startTimestamp1477773897771__endTimestamp 13:44:57 INFO - PROCESS | 3381 | 13:44:57 INFO - PROCESS | 3381 | ------- Summary: start ------- 13:44:57 INFO - PROCESS | 3381 | Number of tests: 6 13:44:57 INFO - PROCESS | 3381 | 13:44:57 INFO - PROCESS | 3381 | [#0] dojo.html Cycles:165 Average:5338.35 Median:5574.92 stddev:601.90 (10.8%) stddev-sans-first:576.18 13:44:57 INFO - PROCESS | 3381 | Values: 3043.1 3087.0 3095.3 3130.0 3130.4 5129.6 5208.3 5290.6 5335.1 5370.8 5241.7 5354.6 5476.6 5513.4 5538.8 4865.0 4877.3 4925.0 4934.7 4952.6 4927.1 4989.3 4999.8 5027.4 5069.7 4855.3 4910.7 4920.4 4965.8 5013.9 4836.9 4869.8 4880.8 4893.5 4937.2 4835.8 4836.4 4837.5 4838.0 4892.2 5382.7 5387.5 5390.2 5390.3 5405.5 5557.9 5587.0 5589.2 5637.9 5742.2 5665.8 5682.7 5726.0 5739.9 5839.3 5375.0 5378.6 5380.5 5438.8 5441.4 5736.1 5846.6 5856.0 5863.4 5864.3 5525.0 5567.2 5574.9 5628.2 5628.8 5686.3 5721.5 5766.7 5772.7 5773.9 5654.1 5663.6 5670.6 5678.9 5683.4 5529.9 5708.7 5712.8 5714.1 5717.3 4358.8 4402.4 4403.7 4404.3 4404.6 3963.1 3963.7 3969.3 3980.7 3981.6 5325.8 5344.9 5409.8 5412.0 5432.9 5672.0 5738.6 5739.1 5742.9 5785.5 5436.4 5444.2 5446.7 5448.8 5453.0 4770.1 4797.7 4971.8 5017.7 5022.8 6096.5 6098.5 6104.4 6106.2 6123.8 5781.7 5833.5 5836.4 5856.7 5888.9 5862.5 5903.1 5909.4 5968.3 6093.4 5600.3 5602.4 5604.6 5605.4 5613.9 5713.5 5720.2 5726.3 5727.5 5733.7 5572.1 5609.5 5612.5 5622.9 5623.7 5572.7 5578.2 5580.9 5584.5 5591.3 5491.1 5639.2 5645.5 5649.0 5649.4 5640.3 5652.5 5685.2 5691.8 5746.7 5578.8 5579.6 5583.7 5584.4 5585.4 13:44:57 INFO - PROCESS | 3381 | 13:44:57 INFO - PROCESS | 3381 | [#1] ext.html Cycles:180 Average:55794.73 Median:39311.41 stddev:106001.22 (269.6%) stddev-sans-first:106217.54 13:44:57 INFO - PROCESS | 3381 | Values: 588.4 613.6 628.8 643.8 649.6 32105.4 34984.1 35087.3 35110.1 35115.6 42286.8 43235.0 43284.4 47251.3 47424.0 8793.6 8919.3 8933.0 8938.6 8946.7 8799.4 8879.2 8882.3 8889.4 8891.1 8151.4 8325.1 8336.4 8538.6 8548.1 10428.2 10645.1 10661.5 11082.8 11100.2 10618.6 10663.6 10686.7 10689.9 10692.5 40524.8 40826.4 40838.0 40838.2 40911.4 3574.9 3662.7 3730.2 4061.0 4068.1 30591.5 30855.8 30966.4 31005.4 32670.5 4193.4 4200.8 4392.4 4397.0 4484.5 314804.0 315629.0 317498.0 317771.0 318072.0 57589.4 57806.1 57947.0 58051.1 58149.4 60565.0 60602.7 60687.0 60757.4 60757.4 15303.9 15309.5 15428.2 15529.5 15551.4 11893.5 11921.7 11965.4 12042.8 12106.6 14705.3 16588.3 16679.9 16784.2 16886.9 4908.6 5670.5 5746.3 5752.9 5880.9 961.2 967.8 1028.4 1066.5 1105.6 29432.3 31147.4 31455.5 31509.8 32023.8 1093.4 1137.5 1153.2 1187.8 1219.1 16563.3 16627.2 16701.9 16717.7 16950.6 476429.0 479100.4 479835.0 480702.0 480956.0 56311.7 56337.0 56346.0 56493.2 56541.0 1239.8 1288.0 1322.0 1338.5 1350.4 30643.5 31306.0 31959.0 32075.0 32720.8 46874.8 47417.0 47460.5 47508.3 47557.3 377723.9 380277.0 381216.0 381745.0 428819.0 25915.9 27592.4 28014.4 28021.2 28045.2 46122.3 46477.6 47923.3 48047.8 48549.5 39266.2 39926.4 39928.4 41077.8 41995.4 39356.6 39833.2 40064.2 41216.0 41310.8 39750.6 40366.2 40725.8 40840.6 40857.8 33259.0 36293.6 36598.8 36600.3 36922.6 27539.2 28032.7 28115.4 28145.4 28189.9 13:44:57 INFO - PROCESS | 3381 | 13:44:57 INFO - PROCESS | 3381 | [#2] jquery.html Cycles:180 Average:26425.61 Median:2787.86 stddev:69024.59 (2475.9%) stddev-sans-first:69190.50 13:44:57 INFO - PROCESS | 3381 | Values: 370.5 389.3 391.0 404.9 421.7 13794.9 16117.5 18396.2 18963.8 19002.2 18963.7 18984.4 19025.2 19112.6 19308.1 4104.4 5385.6 5602.0 5613.3 5623.3 4088.7 4096.4 4185.3 6151.0 6253.1 6215.8 6218.5 6259.0 6265.2 6271.0 6056.0 6243.2 6271.3 6271.6 6293.2 5402.4 5577.3 5587.2 5589.3 5604.9 22883.8 23008.7 23062.9 23199.9 23298.7 2403.9 2490.9 2626.2 2682.3 2893.4 10743.5 13211.3 13683.5 13783.4 14078.5 1890.5 1951.6 1960.7 1960.8 1978.8 78473.6 79792.6 79931.6 82409.6 83171.0 10623.6 10906.9 11142.5 11148.5 11233.7 15456.7 15456.9 15477.8 15483.6 15490.3 7505.3 7819.5 7843.5 8044.7 8179.4 7308.6 7348.8 7542.1 7594.0 7634.8 4564.2 4612.7 4775.8 4818.5 4862.0 1815.4 1934.5 1946.6 1983.4 2019.7 942.2 948.7 983.2 1003.4 1012.0 19103.5 19133.8 19141.7 19351.0 19877.2 950.6 980.4 993.1 998.3 1021.9 10546.9 10784.7 10974.5 10985.8 11047.2 408222.0 413108.0 421852.0 423647.0 424406.0 57028.0 60494.0 76790.0 81977.2 92947.0 982.9 1001.3 1014.9 1030.9 1034.1 16904.7 17043.9 17637.0 17916.3 18343.4 40451.2 41343.4 41690.4 42038.0 42348.0 55508.0 55576.2 56123.7 56703.1 56946.0 8442.8 8449.2 8519.8 8540.8 8861.7 12541.2 12801.3 12878.6 13005.9 13128.5 11275.9 11492.2 11495.7 11628.8 11833.6 11004.3 11126.9 11231.7 11380.4 11667.6 11399.8 11597.1 11654.9 11851.2 11965.7 8347.5 8370.6 8509.8 8566.2 8768.6 10311.8 11224.2 11292.8 11698.6 11833.8 13:44:57 INFO - PROCESS | 3381 | 13:44:57 INFO - PROCESS | 3381 | [#3] mootools.html Cycles:180 Average:5442.35 Median:5005.22 stddev:3077.43 (61.5%) stddev-sans-first:3070.60 13:44:57 INFO - PROCESS | 3381 | Values: 1337.0 1467.9 1499.9 1622.0 1769.6 7209.4 7888.8 8102.9 8120.1 8307.8 8124.6 8175.7 8202.5 8206.3 8215.6 2204.8 2231.1 2234.3 2238.5 2244.2 2164.2 2210.1 2225.8 2236.7 2241.4 2207.8 2228.2 2242.0 2242.2 2262.4 2150.4 2160.1 2179.9 2181.7 2183.8 2191.6 2208.5 2209.4 2211.4 2216.4 8216.8 8270.7 8505.6 8610.5 8610.6 4945.2 5088.2 5134.3 5141.8 5147.1 3182.7 3328.9 3358.6 3386.5 3389.4 1092.9 1115.9 1122.2 1124.9 1130.6 11083.7 11141.7 11174.0 11201.9 11266.7 4020.1 4139.8 4190.2 4228.7 4263.5 8987.1 9020.0 9021.7 9026.9 9032.2 5002.0 5008.4 5017.1 5017.6 5020.8 3898.2 4137.4 4191.4 4673.4 4741.9 3410.8 3418.8 3525.9 3534.3 3545.1 1062.2 1068.8 1074.4 1075.7 1084.8 873.9 890.9 893.5 908.3 934.8 5311.3 5460.1 5462.1 5525.6 5614.4 879.2 888.3 897.6 917.3 922.5 3630.1 3693.0 3745.6 3748.7 3796.7 9778.5 10140.2 10401.5 10421.3 10528.9 10431.8 10440.8 10442.7 10445.8 10469.0 7827.5 8067.4 8080.0 8089.4 8095.3 5371.4 5455.1 5466.8 5529.2 5529.4 9341.4 9375.1 9381.8 9394.1 9400.5 9495.2 9544.6 9655.3 9696.4 9796.6 7089.0 7236.6 7236.8 7236.9 7241.6 8101.4 8212.2 8262.2 8272.9 8291.1 7386.3 7502.2 7536.7 7577.8 7641.5 7132.2 7287.6 7292.5 7331.5 7394.6 6769.4 6831.0 6863.2 6884.2 6887.2 4795.9 4920.6 4936.8 4938.5 4994.6 4632.1 4665.9 4690.9 4841.6 4853.0 13:44:57 INFO - PROCESS | 3381 | 13:44:57 INFO - PROCESS | 3381 | [#4] prototype.html Cycles:180 Average:4539.84 Median:5249.05 stddev:1335.96 (25.5%) stddev-sans-first:1301.63 13:44:57 INFO - PROCESS | 3381 | Values: 320.2 321.9 322.3 327.6 333.9 5188.1 5203.3 5206.2 5214.9 5240.4 5154.5 5157.5 5163.4 5166.5 5182.7 3836.6 3890.0 3929.4 3991.4 4060.0 4023.7 4028.9 4057.6 4087.6 4093.0 3995.1 4009.2 4012.2 4013.6 4036.4 3793.7 3826.3 3907.7 3980.0 3997.9 3533.1 3550.3 3559.8 3562.2 3567.6 4942.2 4948.8 4956.8 4984.4 5024.2 4486.4 4527.2 4560.0 4571.9 4589.4 5275.5 5288.8 5322.9 5325.4 5328.7 3906.9 3909.4 3918.5 3935.0 3940.6 5339.2 5480.8 5520.5 5527.2 5601.5 3941.4 3949.2 3949.5 3956.9 3961.3 3980.4 3990.6 4008.6 4012.4 4015.8 4316.5 4534.5 4544.7 4591.4 4594.5 5394.5 5400.8 5410.6 5413.7 5433.9 1363.8 1379.0 1381.6 1383.0 1383.1 852.8 878.3 897.5 901.7 910.2 5041.3 5182.2 5206.9 5248.5 5251.8 5476.5 5491.6 5507.9 5549.5 5565.8 5249.6 5291.9 5293.3 5299.9 5300.9 2916.3 2948.5 2967.2 2973.6 2981.3 5759.4 5773.7 5787.6 5823.0 5832.5 5372.8 5614.3 5620.8 5643.9 5663.5 5677.9 5694.4 5725.6 5726.2 5751.2 5258.6 5486.6 5517.0 5519.8 5520.2 5439.0 5440.8 5457.0 5459.9 5493.5 5741.6 5756.0 5760.1 5765.2 5765.5 3853.2 3949.3 3952.6 3977.4 3986.6 5370.3 5409.2 5521.8 5522.3 5524.6 5397.9 5398.8 5406.2 5451.4 5472.2 5103.2 5333.9 5342.6 5391.7 5430.6 5311.4 5311.7 5327.7 5335.0 5356.8 5213.7 5299.4 5309.9 5380.9 5438.2 5313.4 5342.4 5348.0 5352.0 5352.7 13:44:57 INFO - PROCESS | 3381 | 13:44:57 INFO - PROCESS | 3381 | [#5] yui.html Cycles:180 Average:16963.19 Median:4575.25 stddev:22145.25 (484.0%) stddev-sans-first:22173.75 13:44:57 INFO - PROCESS | 3381 | Values: 712.1 720.3 734.8 739.9 763.2 13002.7 13853.1 14047.5 14073.5 14171.4 13414.2 13441.9 13508.7 13588.3 13617.9 639.3 667.3 766.3 775.7 796.2 791.4 808.8 809.4 809.4 809.9 855.9 856.8 857.0 857.5 857.6 682.7 705.7 809.2 843.0 852.0 610.7 617.0 618.4 618.4 618.8 13768.6 13776.8 13788.5 13819.9 13825.2 13674.2 13761.5 13806.9 13875.4 13992.2 11995.9 12228.8 12429.0 12626.7 13097.0 4139.2 4344.2 4372.6 4380.1 4513.0 61817.4 63805.4 64285.0 64726.4 65047.0 10593.7 10697.4 10743.9 10752.6 10774.8 20389.7 20592.3 20684.0 20824.4 20842.7 7231.0 7309.7 7344.1 7497.9 7666.9 4363.9 4394.3 4439.9 4515.1 4614.7 3196.5 3257.8 3260.8 3262.7 3277.4 570.7 572.9 583.1 594.9 596.9 540.4 579.4 598.7 642.9 663.1 8414.0 8652.9 8812.9 9019.1 9025.8 633.2 645.4 658.9 664.3 689.3 4114.5 4564.5 4586.0 4787.0 5004.8 78314.0 84824.2 89976.6 91208.0 93313.5 26534.5 27085.7 47247.0 78346.2 79223.0 42845.6 43500.8 58814.0 68753.7 71501.3 9368.5 9807.5 9905.6 9918.4 9921.6 44959.8 45880.0 46771.5 47092.3 48191.8 60606.7 66799.7 66835.0 68486.7 69795.7 11977.5 12095.2 12291.4 12324.4 12644.7 14307.7 14403.2 14517.9 14580.9 14922.7 13158.6 13474.9 13829.0 13892.2 14300.9 12548.8 12657.4 12922.9 13417.1 13438.0 12804.6 13172.1 13352.9 13412.5 13807.5 10871.6 10905.6 11113.8 11297.2 11362.4 11259.3 11437.2 11569.9 11723.5 11785.5 13:44:57 INFO - PROCESS | 3381 | -------- Summary: end -------- 13:44:57 INFO - PROCESS | 3381 | 13:44:58 INFO - TEST-INFO | 3381: exit 0 13:44:58 INFO - TEST-OK | dromaeo_css | took 1120848ms 13:44:58 INFO - TEST-START | kraken 13:44:58 INFO - operating with platform_type : linux_ 13:44:58 INFO - Initialising browser for kraken test... 13:44:58 INFO - TEST-INFO | started process 3687 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpSN5F4w/profile http://localhost:54200/getInfo.html) 13:45:02 INFO - PROCESS | 3687 | __metrics Screen width/height:1600/1200 13:45:02 INFO - PROCESS | 3687 | colorDepth:24 13:45:02 INFO - PROCESS | 3687 | Browser inner width/height: 1024/697 13:45:02 INFO - PROCESS | 3687 | __metrics 13:45:03 INFO - PROCESS | 3687 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 13:45:03 INFO - PROCESS | 3687 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 205: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 13:45:04 INFO - PROCESS | 3687 | console.error: PushService: 13:45:04 INFO - PROCESS | 3687 | stateChangeProcessEnqueue: Error transitioning state 13:45:04 INFO - PROCESS | 3687 | UnknownError 13:45:04 INFO - TEST-INFO | 3687: exit 0 13:45:04 INFO - Browser initialized. 13:45:04 INFO - Running cycle 1/1 for kraken test... 13:45:04 INFO - TEST-INFO | started process 3768 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpSN5F4w/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 13:45:16 INFO - PROCESS | 3768 | RSS: Main: 172498944 13:45:16 INFO - PROCESS | 3768 | 13:45:19 INFO - PROCESS | 3768 | Cycle 1(1): loaded http://localhost:54200/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:54200/tests/kraken/driver.html?testName=audio-beat-detection) 13:45:20 INFO - PROCESS | 3768 | RSS: Main: 229744640 13:45:20 INFO - PROCESS | 3768 | 13:45:23 INFO - PROCESS | 3768 | Cycle 1(1): loaded http://localhost:54200/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:54200/tests/kraken/driver.html?testName=audio-dft) 13:45:23 INFO - PROCESS | 3768 | RSS: Main: 216453120 13:45:23 INFO - PROCESS | 3768 | 13:45:26 INFO - PROCESS | 3768 | Cycle 1(1): loaded http://localhost:54200/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:54200/tests/kraken/driver.html?testName=audio-fft) 13:45:27 INFO - PROCESS | 3768 | RSS: Main: 297758720 13:45:27 INFO - PROCESS | 3768 | 13:45:29 INFO - PROCESS | 3768 | Cycle 1(1): loaded http://localhost:54200/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:54200/tests/kraken/driver.html?testName=audio-oscillator) 13:45:30 INFO - PROCESS | 3768 | RSS: Main: 206909440 13:45:30 INFO - PROCESS | 3768 | 13:45:32 INFO - PROCESS | 3768 | Cycle 1(1): loaded http://localhost:54200/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:54200/tests/kraken/driver.html?testName=imaging-gaussian-blur) 13:45:32 INFO - PROCESS | 3768 | RSS: Main: 211488768 13:45:32 INFO - PROCESS | 3768 | 13:45:35 INFO - PROCESS | 3768 | Cycle 1(1): loaded http://localhost:54200/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:54200/tests/kraken/driver.html?testName=imaging-darkroom) 13:45:36 INFO - PROCESS | 3768 | RSS: Main: 247992320 13:45:36 INFO - PROCESS | 3768 | 13:45:39 INFO - PROCESS | 3768 | Cycle 1(1): loaded http://localhost:54200/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:54200/tests/kraken/driver.html?testName=imaging-desaturate) 13:45:40 INFO - PROCESS | 3768 | RSS: Main: 247078912 13:45:40 INFO - PROCESS | 3768 | 13:45:42 INFO - PROCESS | 3768 | Cycle 1(1): loaded http://localhost:54200/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:54200/tests/kraken/driver.html?testName=json-parse-financial) 13:45:43 INFO - PROCESS | 3768 | RSS: Main: 246648832 13:45:43 INFO - PROCESS | 3768 | 13:45:45 INFO - PROCESS | 3768 | Cycle 1(1): loaded http://localhost:54200/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:54200/tests/kraken/driver.html?testName=json-stringify-tinderbox) 13:45:45 INFO - PROCESS | 3768 | RSS: Main: 209158144 13:45:45 INFO - PROCESS | 3768 | 13:45:47 INFO - PROCESS | 3768 | Cycle 1(1): loaded http://localhost:54200/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:54200/tests/kraken/driver.html?testName=stanford-crypto-aes) 13:45:48 INFO - PROCESS | 3768 | RSS: Main: 216305664 13:45:48 INFO - PROCESS | 3768 | 13:45:50 INFO - PROCESS | 3768 | Cycle 1(1): loaded http://localhost:54200/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:54200/tests/kraken/driver.html?testName=stanford-crypto-ccm) 13:45:50 INFO - PROCESS | 3768 | RSS: Main: 226275328 13:45:50 INFO - PROCESS | 3768 | 13:45:53 INFO - PROCESS | 3768 | Cycle 1(1): loaded http://localhost:54200/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:54200/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 13:45:54 INFO - PROCESS | 3768 | RSS: Main: 234274816 13:45:54 INFO - PROCESS | 3768 | 13:45:56 INFO - PROCESS | 3768 | Cycle 1(1): loaded http://localhost:54200/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:54200/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 13:45:57 INFO - PROCESS | 3768 | RSS: Main: 231677952 13:45:57 INFO - PROCESS | 3768 | 13:45:59 INFO - PROCESS | 3768 | Cycle 1(1): loaded http://localhost:54200/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:54200/tests/kraken/driver.html?testName=ai-astar) 13:45:59 INFO - PROCESS | 3768 | RSS: Main: 282341376 13:45:59 INFO - PROCESS | 3768 | 13:45:59 INFO - PROCESS | 3768 | __start_tp_report 13:45:59 INFO - PROCESS | 3768 | _x_x_mozilla_page_load 13:45:59 INFO - PROCESS | 3768 | _x_x_mozilla_page_load_details 13:45:59 INFO - PROCESS | 3768 | |i|pagename|runs| 13:45:59 INFO - PROCESS | 3768 | |0;ai-astar;107;113;114;113;113;113;111;114;114;112 13:45:59 INFO - PROCESS | 3768 | |1;audio-beat-detection;153;124;123;168;124;123;123;126;163;127 13:45:59 INFO - PROCESS | 3768 | |2;audio-dft;160;161;161;161;160;162;162;162;161;161 13:45:59 INFO - PROCESS | 3768 | |3;audio-fft;76;75;77;108;77;77;77;77;98;77 13:45:59 INFO - PROCESS | 3768 | |4;audio-oscillator;83;83;123;82;82;83;105;83;84;116 13:45:59 INFO - PROCESS | 3768 | |5;imaging-gaussian-blur;116;116;117;117;116;117;116;117;117;116 13:45:59 INFO - PROCESS | 3768 | |6;imaging-darkroom;146;145;146;146;146;147;146;146;146;145 13:45:59 INFO - PROCESS | 3768 | |7;imaging-desaturate;85;85;85;84;85;84;85;84;85;84 13:45:59 INFO - PROCESS | 3768 | |8;json-parse-financial;53;52;52;56;52;54;58;54;53;54 13:45:59 INFO - PROCESS | 3768 | |9;json-stringify-tinderbox;62;61;61;60;62;60;61;61;61;62 13:45:59 INFO - PROCESS | 3768 | |10;stanford-crypto-aes;88;80;87;79;81;80;82;80;79;79 13:45:59 INFO - PROCESS | 3768 | |11;stanford-crypto-ccm;135;129;128;127;130;139;145;126;172;137 13:45:59 INFO - PROCESS | 3768 | |12;stanford-crypto-pbkdf2;164;171;169;173;166;167;171;167;172;167 13:45:59 INFO - PROCESS | 3768 | |13;stanford-crypto-sha256-iterative;63;64;68;66;64;64;64;64;63;63 13:45:59 INFO - PROCESS | 3768 | __end_tp_report 13:45:59 INFO - PROCESS | 3768 | __start_cc_report 13:45:59 INFO - PROCESS | 3768 | _x_x_mozilla_cycle_collect,1707 13:45:59 INFO - PROCESS | 3768 | __end_cc_report 13:45:59 INFO - PROCESS | 3768 | __startTimestamp1477773959378__endTimestamp 13:45:59 INFO - PROCESS | 3768 | 13:45:59 INFO - PROCESS | 3768 | ------- Summary: start ------- 13:45:59 INFO - PROCESS | 3768 | Number of tests: 14 13:45:59 INFO - PROCESS | 3768 | 13:45:59 INFO - PROCESS | 3768 | [#0] ai-astar Cycles:10 Average:112.40 Median:113.00 stddev:2.12 (1.9%) stddev-sans-first:1.00 13:45:59 INFO - PROCESS | 3768 | Values: 107.0 113.0 114.0 113.0 113.0 113.0 111.0 114.0 114.0 112.0 13:45:59 INFO - PROCESS | 3768 | 13:45:59 INFO - PROCESS | 3768 | [#1] audio-beat-detection Cycles:10 Average:135.40 Median:126.50 stddev:18.30 (14.5%) stddev-sans-first:18.27 13:45:59 INFO - PROCESS | 3768 | Values: 153.0 124.0 123.0 168.0 124.0 123.0 123.0 126.0 163.0 127.0 13:45:59 INFO - PROCESS | 3768 | 13:45:59 INFO - PROCESS | 3768 | [#2] audio-dft Cycles:10 Average:161.10 Median:161.00 stddev:0.74 (0.5%) stddev-sans-first:0.67 13:45:59 INFO - PROCESS | 3768 | Values: 160.0 161.0 161.0 161.0 160.0 162.0 162.0 162.0 161.0 161.0 13:45:59 INFO - PROCESS | 3768 | 13:45:59 INFO - PROCESS | 3768 | [#3] audio-fft Cycles:10 Average:81.90 Median:77.00 stddev:11.39 (14.8%) stddev-sans-first:11.88 13:45:59 INFO - PROCESS | 3768 | Values: 76.0 75.0 77.0 108.0 77.0 77.0 77.0 77.0 98.0 77.0 13:45:59 INFO - PROCESS | 3768 | 13:45:59 INFO - PROCESS | 3768 | [#4] audio-oscillator Cycles:10 Average:92.40 Median:83.00 stddev:15.96 (19.2%) stddev-sans-first:16.56 13:45:59 INFO - PROCESS | 3768 | Values: 83.0 83.0 123.0 82.0 82.0 83.0 105.0 83.0 84.0 116.0 13:45:59 INFO - PROCESS | 3768 | 13:45:59 INFO - PROCESS | 3768 | [#5] imaging-gaussian-blur Cycles:10 Average:116.50 Median:117.00 stddev:0.53 (0.5%) stddev-sans-first:0.53 13:45:59 INFO - PROCESS | 3768 | Values: 116.0 116.0 117.0 117.0 116.0 117.0 116.0 117.0 117.0 116.0 13:45:59 INFO - PROCESS | 3768 | 13:45:59 INFO - PROCESS | 3768 | [#6] imaging-darkroom Cycles:10 Average:145.90 Median:146.00 stddev:0.57 (0.4%) stddev-sans-first:0.60 13:45:59 INFO - PROCESS | 3768 | Values: 146.0 145.0 146.0 146.0 146.0 147.0 146.0 146.0 146.0 145.0 13:45:59 INFO - PROCESS | 3768 | 13:45:59 INFO - PROCESS | 3768 | [#7] imaging-desaturate Cycles:10 Average:84.60 Median:85.00 stddev:0.52 (0.6%) stddev-sans-first:0.53 13:45:59 INFO - PROCESS | 3768 | Values: 85.0 85.0 85.0 84.0 85.0 84.0 85.0 84.0 85.0 84.0 13:45:59 INFO - PROCESS | 3768 | 13:45:59 INFO - PROCESS | 3768 | [#8] json-parse-financial Cycles:10 Average:53.80 Median:54.00 stddev:1.93 (3.6%) stddev-sans-first:2.03 13:45:59 INFO - PROCESS | 3768 | Values: 53.0 52.0 52.0 56.0 52.0 54.0 58.0 54.0 53.0 54.0 13:45:59 INFO - PROCESS | 3768 | 13:45:59 INFO - PROCESS | 3768 | [#9] json-stringify-tinderbox Cycles:10 Average:61.10 Median:61.00 stddev:0.74 (1.2%) stddev-sans-first:0.71 13:45:59 INFO - PROCESS | 3768 | Values: 62.0 61.0 61.0 60.0 62.0 60.0 61.0 61.0 61.0 62.0 13:45:59 INFO - PROCESS | 3768 | 13:45:59 INFO - PROCESS | 3768 | [#10] stanford-crypto-aes Cycles:10 Average:81.50 Median:80.50 stddev:3.31 (4.1%) stddev-sans-first:2.54 13:45:59 INFO - PROCESS | 3768 | Values: 88.0 80.0 87.0 79.0 81.0 80.0 82.0 80.0 79.0 79.0 13:45:59 INFO - PROCESS | 3768 | 13:45:59 INFO - PROCESS | 3768 | [#11] stanford-crypto-ccm Cycles:10 Average:136.80 Median:136.00 stddev:13.79 (10.1%) stddev-sans-first:14.61 13:45:59 INFO - PROCESS | 3768 | Values: 135.0 129.0 128.0 127.0 130.0 139.0 145.0 126.0 172.0 137.0 13:45:59 INFO - PROCESS | 3768 | 13:45:59 INFO - PROCESS | 3768 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:168.70 Median:170.00 stddev:2.95 (1.7%) stddev-sans-first:2.59 13:45:59 INFO - PROCESS | 3768 | Values: 164.0 171.0 169.0 173.0 166.0 167.0 171.0 167.0 172.0 167.0 13:45:59 INFO - PROCESS | 3768 | 13:45:59 INFO - PROCESS | 3768 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:64.30 Median:64.00 stddev:1.57 (2.4%) stddev-sans-first:1.59 13:45:59 INFO - PROCESS | 3768 | Values: 63.0 64.0 68.0 66.0 64.0 64.0 64.0 64.0 63.0 63.0 13:45:59 INFO - PROCESS | 3768 | -------- Summary: end -------- 13:45:59 INFO - PROCESS | 3768 | 13:46:00 INFO - TEST-INFO | 3768: exit 0 13:46:00 INFO - TEST-OK | kraken | took 61903ms 13:46:00 INFO - SUITE-END | took 1182s 13:46:01 INFO - Completed test suite (00:19:43) 13:46:01 INFO - javascript benchmark 13:46:01 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3043.07186308176, 3087.0430166648352, 3095.257138286811, 3130.0140455756436, 3130.420872138653, 5129.563987061104, 5208.322918020652, 5290.576753859692, 5335.1197052486295, 5370.838874833757, 5241.659292146008, 5354.5716342692585, 5476.644018138818, 5513.393526712069, 5538.833834984936, 4864.951350486503, 4877.34155888954, 4924.950750492485, 4934.728589927553, 4952.57903078237, 4927.088488629597, 4989.326440930464, 4999.825006124786, 5027.421846487646, 5069.681882710485, 4855.320255164244, 4910.656254062217, 4920.384951881015, 4965.801367945278, 5013.949860501403, 4836.879078023042, 4869.82955596556, 4880.755962201875, 4893.510648935078, 4937.160682683916, 4835.782389792468, 4836.395450568679, 4837.467878533358, 4837.9516204837855, 4892.192788189945, 5382.6770393776105, 5387.4612538746205, 5390.164524498709, 5390.299261096033, 5405.5135037846385, 5557.888842223173, 5586.972065139689, 5589.189567512729, 5637.887242255132, 5742.196092547047, 5665.830025099253, 5682.687452190128, 5725.971370143123, 5739.942600573982, 5839.270091238595, 5374.973125134427, 5378.623496355218, 5380.542653874386, 5438.83683489492, 5441.401445840955, 5736.139579063174, 5846.561507886926, 5855.970720146457, 5863.442972917566, 5864.266966629171, 5524.972375138179, 5567.24842146305, 5574.916376254359, 5628.183913332544, 5628.831135065954, 5686.2607860977805, 5721.542276617861, 5766.740496677659, 5772.711364431846, 5773.942260577341, 5654.123610840326, 5663.575231857627, 5670.5747068969995, 5678.943210567842, 5683.403242659544, 5529.944700553024, 5708.71456427177, 5712.80005199816, 5714.114312281603, 5717.313922329347, 4358.760268185217, 4402.3836662867225, 4403.691741578059, 4404.339349097661, 4404.55954404557, 3963.0686788604653, 3963.722539422213, 3969.285528604879, 3980.661643760313, 3981.641652251253, 5325.813596524103, 5344.866378340573, 5409.83770486886, 5412.025835349675, 5432.91850622241, 5671.971640141773, 5738.569607279471, 5739.053056245672, 5742.856428589319, 5785.450382213767, 5436.401995780461, 5444.237806707064, 5446.727663616883, 5448.83653490396, 5453.018456677757, 4770.117528257283, 4797.664163508521, 4971.776270067856, 5017.7491125443585, 5022.84931452057, 6096.496448835484, 6098.522998456991, 6104.368208815833, 6106.15732346443, 6123.8162855114415, 5781.739821707949, 5833.533317334518, 5836.358000619844, 5856.736446859816, 5888.882222355443, 5862.530997520274, 5903.144044113666, 5909.438603332676, 5968.313643931004, 6093.360197179232, 5600.327960644749, 5602.383737788921, 5604.607677462538, 5605.411431799603, 5613.943860561342, 5713.514351280188, 5720.227769251098, 5726.284214473191, 5727.5417966561745, 5733.741981610921, 5572.136318870582, 5609.467100625434, 5612.466815652507, 5622.887542249214, 5623.718814059199, 5572.693501857275, 5578.219049333178, 5580.888382232251, 5584.525315348078, 5591.27313449249, 5491.121420572849, 5639.210510528447, 5645.520130788929, 5648.971755141198, 5649.4350564944825, 5640.32316122068, 5652.519535839335, 5685.232493613475, 5691.77232910679, 5746.712664366849, 5578.832635020955, 5579.637323573955, 5583.69289689071, 5584.3857175711455, 5585.357683866408], "value": 5297.9300895816, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [588.3819496384941, 613.5705006495452, 628.8302158417231, 643.7714611312983, 649.5972497051825, 32105.35789284213, 34984.12539686509, 35087.298254034904, 35110.12224694381, 35115.64884351156, 42286.78856605721, 43235.0, 43284.350734739004, 47251.29123063157, 47424.0, 8793.604287807064, 8919.28645708345, 8932.972708138583, 8938.553072346389, 8946.731598052069, 8799.384043116985, 8879.245264152554, 8882.289416846668, 8889.42218755782, 8891.110888911122, 8151.429399942006, 8325.084240733515, 8336.374771892102, 8538.615762290712, 8548.145185481433, 10428.165746740242, 10645.095166910784, 10661.466926653713, 11082.778344433147, 11100.222984391095, 10618.628348007782, 10663.573457061708, 10686.679399618024, 10689.893101068967, 10692.465376731132, 40524.79737601322, 40826.38760418596, 40838.0, 40838.183236335404, 40911.38632920509, 3574.8927532174075, 3662.6703596676425, 3730.1607138393915, 4061.045654271244, 4068.0846809467635, 30591.54112688289, 30855.84572077148, 30966.38067238665, 31005.379892402252, 32670.509942350884, 4193.350030745209, 4200.789960501963, 4392.428984232061, 4397.0, 4484.506704262529, 314804.0, 315629.0, 317498.0, 317771.0, 318072.0, 57589.424105759244, 57806.13290800642, 57947.0, 58051.129233060696, 58149.41850581524, 60565.0, 60602.696986514784, 60687.0, 60757.392426075174, 60757.392426076054, 15303.92348038275, 15309.46416875404, 15428.15145167004, 15529.45646902353, 15551.377944882079, 11893.524259029715, 11921.70195745096, 11965.40172991347, 12042.759144817055, 12106.636800895987, 14705.26473676312, 16588.25352859124, 16679.91660041692, 16784.223549701463, 16886.915565422096, 4908.60679691674, 5670.489655930986, 5746.281714785652, 5752.884942301214, 5880.882382352329, 961.20700422152, 967.811276801017, 1028.4138041316528, 1066.5200659703164, 1105.5688281570194, 29432.26419339534, 31147.377052459276, 31455.52816707751, 31509.8424507876, 32023.839880800446, 1093.3767752381066, 1137.4597066393396, 1153.2273376837538, 1187.8455800746021, 1219.1100496637505, 16563.337466501205, 16627.168641567874, 16701.916490417712, 16717.749233761504, 16950.57623559421, 476429.0, 479100.4404801792, 479835.0, 480702.0, 480956.0, 56311.71844140753, 56337.0, 56346.0, 56493.152602710994, 56541.0, 1239.8450193725785, 1287.9742405151844, 1321.9603411897658, 1338.4579245405625, 1350.4058214385639, 30643.54034689437, 31306.0, 31959.0, 32075.0, 32720.836395817867, 46874.76562617165, 47417.0, 47460.52539474561, 47508.28737569008, 47557.28664069973, 377723.8910443552, 380277.0, 381216.0, 381745.0, 428819.0, 25915.87042064853, 27592.448151037268, 28014.43971120607, 28021.159365219075, 28045.158645240674, 46122.308165376875, 46477.6056718299, 47923.281150782066, 48047.75976120237, 48549.51450485591, 39266.2146757069, 39926.401103982884, 39928.401073984496, 41077.79461102675, 41995.37006944959, 39356.60643393644, 39833.2033359337, 40064.1987160261, 41216.0, 41310.79344603258, 39750.60249397469, 40366.1926761469, 40725.796371017954, 40840.591594084864, 40857.79571102125, 33259.0, 36293.63706362902, 36598.8170059148, 36600.26799463943, 36922.63077369192, 27539.173824785288, 28032.71967280301, 28115.43769124647, 28145.43709125847, 28189.859050704614], "value": 19587.10024045277, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [370.4776265465694, 389.27206124547104, 391.0, 404.88056023473075, 421.6963786074028, 13794.931025344871, 16117.516474505768, 18396.17217225225, 18963.810361896376, 19002.239910403583, 18963.71554426681, 18984.430467085975, 19025.2389904404, 19112.617747645072, 19308.131134098963, 4104.363823607331, 5385.569154467643, 5601.971990140044, 5613.270274864262, 5623.297087864017, 4088.713790034699, 4096.3855421686685, 4185.330347144458, 6151.0, 6253.124562561223, 6215.787921355338, 6218.502519798405, 6259.0298503731765, 6265.216847894013, 6270.968645156768, 6056.0, 6243.219597550306, 6271.310155882849, 6271.592346497486, 6293.213348331458, 5402.405735369106, 5577.330720313547, 5587.245721827582, 5589.329280486368, 5604.915926261109, 22883.771162288496, 23008.734519601414, 23062.884685576464, 23199.88400058006, 23298.65052024221, 2403.9278821635203, 2490.9128180513594, 2626.1727555819857, 2682.3160094176055, 2893.4068515954177, 10743.51654175564, 13211.273379964097, 13683.452661893512, 13783.379747911367, 14078.507252246225, 1890.4801179675562, 1951.6194342103295, 1960.7058941158798, 1960.7647082350068, 1978.8120128587761, 78473.60763196205, 79792.60103699502, 79931.60034199792, 82409.58795205985, 83170.99999999939, 10623.575056997788, 10906.945465272624, 11142.49858756358, 11148.498317575728, 11233.719157020976, 15456.690866182613, 15456.92271538635, 15477.845221547866, 15483.612909677347, 15490.30293636789, 7505.324520793155, 7819.491733037335, 7843.450958432855, 8044.747470708211, 8179.386546008954, 7308.561486310732, 7348.77953661391, 7542.094948606203, 7593.962030189814, 7634.847303054019, 4564.178447879347, 4612.677112602153, 4775.832845850378, 4818.542238487338, 4862.0, 1815.4372144635206, 1934.4970307720093, 1946.639871623754, 1983.4446355020618, 2019.7475315585552, 942.2038377570941, 948.7248697877676, 983.2036050798876, 1003.3578509753763, 1012.0, 19103.522411939535, 19133.8086619132, 19141.712874306897, 19351.0, 19877.223327568005, 950.6387572722459, 980.4362491567377, 993.0665174735725, 998.3211416237028, 1021.8722659667542, 10546.945305469546, 10784.676459706221, 10974.506147223394, 10985.780284394426, 11047.226694131494, 408222.0, 413108.0, 421852.0, 423647.0, 424406.0, 57028.0, 60494.0, 76790.0, 81977.18022819696, 92947.0, 982.9262805289632, 1001.2990906365574, 1014.8934361891895, 1030.9432981185957, 1034.110664828247, 16904.746428803825, 17043.914780426017, 17637.0, 17916.283348665907, 18343.449696509128, 40451.19097617972, 41343.37984930168, 41690.374644380965, 42038.0, 42348.0, 55508.0, 55576.164502726635, 56123.71938140283, 56703.14945275742, 56946.0, 8442.831143377221, 8449.23956843887, 8519.829603407774, 8540.786480338042, 8861.73414797557, 12541.184822986477, 12801.29592872401, 12878.613641590768, 13005.869941300465, 13128.540501082416, 11275.887241127484, 11492.195546312012, 11495.655130345769, 11628.825567616661, 11833.585824496102, 11004.339739615649, 11126.944365278121, 11231.71920701989, 11380.430978450879, 11667.6499705009, 11399.829002565135, 11597.13021523406, 11654.941725291319, 11851.229670071418, 11965.700857478632, 8347.540885251126, 8370.623321950405, 8509.829803403773, 8566.229039386486, 8768.60541275657, 10311.793764124526, 11224.158188136085, 11292.830607541058, 11698.649040528799, 11833.822492662444], "value": 9114.942821638417, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1336.9933150334248, 1467.8825693944486, 1499.947501837436, 1621.9594510137244, 1769.5929936114685, 7209.3872020878225, 7888.802779930505, 8102.878456823152, 8120.106788253287, 8307.75076747697, 8124.553149576771, 8175.7138500152505, 8202.507849529033, 8206.261436470717, 8215.630296636651, 2204.7574766775683, 2231.0964059555904, 2234.2515257388795, 2238.541099074694, 2244.1920908472935, 2164.166795783619, 2210.06072419222, 2225.8219342452567, 2236.7204099487562, 2241.3724157236, 2207.7681843406453, 2228.231260215231, 2241.9551608967813, 2242.2040175737625, 2262.4230821140586, 2150.3656421355736, 2160.114353115223, 2179.9128034878586, 2181.7490988536283, 2183.792539708733, 2191.6274233380364, 2208.4810069633622, 2209.3813732154863, 2211.40292121128, 2216.357256395643, 8216.753497395088, 8270.669173233124, 8505.574721263913, 8610.483370997697, 8610.612522436442, 4945.23348880924, 5088.211327244283, 5134.2812006319145, 5141.845744627667, 5147.0992576298995, 3182.713555779991, 3328.916777080568, 3358.630550639428, 3386.4750963600436, 3389.4068538005995, 1092.8524649172339, 1115.857553497279, 1122.2256642916443, 1124.9212555121144, 1130.6381957773515, 11083.72290692731, 11141.72145696356, 11174.0, 11201.943990280079, 11266.718332041683, 4020.0954785173103, 4139.834406623701, 4190.224808410454, 4228.746275223496, 4263.531011588722, 8987.101289870961, 9019.954900225457, 9021.684241051531, 9026.86459703105, 9032.187103160748, 5002.049610573979, 5008.398992120969, 5017.122003649347, 5017.598592112695, 5020.849374518771, 3898.1813819098306, 4137.420761093449, 4191.413202151702, 4673.415823022122, 4741.881452963635, 3410.8294585271133, 3418.8290585470627, 3525.894223173309, 3534.2754735279204, 3545.13144279648, 1062.1768129699544, 1068.834330678746, 1074.425182527344, 1075.725689949058, 1084.8372744088292, 873.9475631462133, 890.9420887642412, 893.4907102951386, 908.2824568590739, 934.780326623243, 5311.256424100629, 5460.126379779216, 5462.126059830488, 5525.640833345819, 5614.410486898817, 879.2394578689515, 888.2583043159035, 897.6095398501542, 917.2799352508249, 922.5110691333604, 3630.09247688078, 3693.0, 3745.5505339358906, 3748.6626203641804, 3796.6901419010396, 9778.462184579916, 10140.239482038876, 10401.479926003669, 10421.270511064304, 10528.947355263175, 10431.791364172674, 10440.791184176274, 10442.738931526772, 10445.84331235032, 10469.0, 7827.452078354574, 8067.39494537912, 8079.959600201962, 8089.433739638169, 8095.311898488694, 5371.409144994126, 5455.1271796512365, 5466.835994920159, 5529.170624406372, 5529.385430397596, 9341.439513629204, 9375.10936461035, 9381.765455863659, 9394.107559781809, 9400.529973501434, 9495.192908602847, 9544.570494327632, 9655.275854310814, 9696.369735967139, 9796.559154838193, 7089.0, 7236.565806051653, 7236.782896513113, 7236.927630723625, 7241.565506069653, 8101.351891848756, 8212.17878212174, 8262.17378262169, 8272.875906861282, 8291.08798032228, 7386.261373862786, 7502.249775022454, 7536.7362142324755, 7577.772666820004, 7641.541507509567, 7132.179799323144, 7287.562746235243, 7292.489525733148, 7331.486795924234, 7394.593297368697, 6769.356911093439, 6831.0, 6863.210730766026, 6884.173899132136, 6887.173539175331, 4795.880102997314, 4920.630952678492, 4936.802527898843, 4938.506149385176, 4994.5754610858485, 4632.080597803579, 4665.906681866276, 4690.882727931829, 4841.636877234151, 4852.975735121302], "value": 4360.600332098341, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [320.17714473802323, 321.91147434455536, 322.33277116369123, 327.6494151258153, 333.89816106087636, 5188.066148093347, 5203.323567936172, 5206.167013277876, 5214.921776173361, 5240.371155461346, 5154.484551544853, 5157.510036546531, 5163.380394352683, 5166.4575219601875, 5182.740862956856, 3836.5779764225845, 3890.0, 3929.3713005918917, 3991.42124391963, 4059.985003749063, 4023.7384570002855, 4028.858989935353, 4057.573954734755, 4087.57080506547, 4092.9795351023354, 3995.1410446753944, 4009.218202450523, 4012.154408971862, 4013.618706222904, 4036.394540818886, 3793.696504279651, 3826.253880493305, 3907.7069219808627, 3979.960200397988, 3997.8800635980965, 3533.0990597397754, 3550.289942011608, 3559.7864128152396, 3562.2163124112653, 3567.625399333059, 4942.159832828392, 4948.752562371903, 4956.752162391866, 4984.355162796269, 5024.171011783052, 4486.394336764561, 4527.16649756849, 4559.954400455986, 4571.885702857422, 4589.35748995141, 5275.472452754732, 5288.81489147878, 5322.946770532284, 5325.440828712968, 5328.706921119337, 3906.8632597858937, 3909.354956432185, 3918.5101862267215, 3934.996575873134, 3940.566537680853, 5339.199120132012, 5480.835574932758, 5520.503154716095, 5527.198556209327, 5601.523870471015, 3941.3693808990424, 3949.19041596472, 3949.5458022327225, 3956.8812935611977, 3961.3265744823448, 3980.3830406286493, 3990.5610382857863, 4008.599140085968, 4012.4181993610764, 4015.77913214776, 4316.482022157361, 4534.501204867462, 4544.659150563721, 4591.449026116888, 4594.494605593382, 5394.541463975606, 5400.83797486076, 5410.621256512085, 5413.724696558604, 5433.864153396117, 1363.8158848555518, 1379.0415661115428, 1381.599336192513, 1382.9861701382858, 1383.080251632673, 852.8336974289954, 878.3412440669498, 897.4749771383683, 901.715959472764, 910.2490445382585, 5041.344625198701, 5182.170852663631, 5206.8958620828125, 5248.501392367719, 5251.842444726664, 5476.534494567926, 5491.560675145979, 5507.862303442366, 5549.472800083986, 5565.777368905198, 5249.606279529051, 5291.894162116813, 5293.285406470154, 5299.867503312448, 5300.946990530122, 2916.3292442737866, 2948.4840152973143, 2967.2285205846206, 2973.598564193806, 2981.269588950721, 5759.395263497357, 5773.711314434261, 5787.565932555075, 5822.992226685047, 5832.533397328203, 5372.811951581676, 5614.2701448811395, 5620.831375058755, 5643.915341269884, 5663.546916246691, 5677.914831277534, 5694.373618901835, 5725.570582206351, 5726.198332233491, 5751.22358481608, 5258.631895767413, 5486.561075113901, 5517.0, 5519.751611177427, 5520.199571062093, 5438.972805135949, 5440.755166017618, 5457.025920873054, 5459.945400545944, 5493.450654934634, 5741.598088133791, 5756.0, 5760.135979603093, 5765.221695071112, 5765.538756899522, 3853.1523064925673, 3949.269385163754, 3952.6245006724316, 3977.4033894915992, 3986.621270979252, 5370.3287089113865, 5409.161579955114, 5521.779128834802, 5522.2544956430365, 5524.585905812246, 5397.896209679371, 5398.757055932414, 5406.188926709597, 5451.400345961862, 5472.151816468454, 5103.209002604603, 5333.893322133458, 5342.572594192533, 5391.676499410048, 5430.565554755689, 5311.415744268204, 5311.681299122065, 5327.694714794745, 5334.973325133349, 5356.7589458473685, 5213.739313034409, 5299.364076310867, 5309.946900530946, 5380.919286210632, 5438.2386465894015, 5313.3889602694635, 5342.3856256531, 5348.010618035676, 5352.0, 5352.705601191972], "value": 4112.450185408172, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [712.0956385390554, 720.2617317249815, 734.7501849371213, 739.885317775745, 763.2062654838968, 13002.739945201101, 13853.099548529339, 14047.508337208199, 14073.507427240062, 14171.433142674294, 13414.19514829111, 13441.865581344184, 13508.662283442918, 13588.25264610446, 13617.93191034046, 639.3127388057833, 667.2626747444077, 766.31797700047, 775.6974779835855, 796.191865256762, 791.3827214772487, 808.8341889912583, 809.4131754478016, 809.4131754478016, 809.9109097999216, 855.8972923249188, 856.8029353248756, 857.0229937870832, 857.4940784936886, 857.6226460357454, 682.737146198717, 705.717712914833, 809.2352726673296, 843.0094638799417, 852.0286872964825, 610.7404353149893, 616.9629822210682, 618.4372221278614, 618.4434009391583, 618.7834258009706, 13768.586942391745, 13776.793348099787, 13788.517401890886, 13819.861801381958, 13825.170489770546, 13674.247916364597, 13761.518346857813, 13806.93096534521, 13875.37560809766, 13992.230427326493, 11995.940020299842, 12228.755424891542, 12429.0, 12626.74746505074, 13097.0, 4139.19285739281, 4344.23975804233, 4372.584604462571, 4380.145871555048, 4512.954870451319, 61817.38182618161, 63805.36194638087, 64285.0, 64726.37835622056, 65047.0, 10593.735156620993, 10697.411642359744, 10743.946280268705, 10752.623658171926, 10774.838377424345, 20389.694154587694, 20592.27927022547, 20684.0, 20824.375268741962, 20842.68735968962, 7230.963845180846, 7309.707611695472, 7344.118705755237, 7497.9250207497225, 7666.8849967250535, 4363.912721745547, 4394.340848872631, 4439.866803995886, 4515.14212299662, 4614.653900957442, 3196.5045417960255, 3257.755668324885, 3260.7717459777587, 3262.6737326267657, 3277.360914621626, 570.7403131575123, 572.9484346408843, 583.0670926517623, 594.925634295713, 596.892559339323, 540.367769709441, 579.3569138256532, 598.7186022569385, 642.8649983503423, 663.0981864664053, 8414.0, 8652.8702069469, 8812.8678069829, 9019.098090191059, 9025.774355641162, 633.1673848888696, 645.4384685323705, 658.8903056794528, 664.3058004385429, 689.2728171778722, 4114.547399786021, 4564.52072532386, 4585.977070114628, 4786.976065119722, 5004.770015333985, 78314.0, 84824.21406287482, 89976.55011724899, 91208.0, 93313.5334323324, 26534.46931061368, 27085.729142708715, 47247.0, 78346.21653783503, 79223.0, 42845.57154428416, 43500.78249608795, 58814.0, 68753.65623171852, 71501.2849871505, 9368.484733339732, 9807.509624518889, 9905.55425005862, 9918.355306905029, 9921.603135874484, 44959.77520112378, 45880.0, 46771.532284676716, 47092.29361559648, 48191.75904120597, 60606.696966514886, 66799.66600166968, 66835.0, 68486.65756671384, 69795.65102174456, 11977.520899164285, 12095.21381110225, 12291.446884890023, 12324.445399956845, 12644.73552644728, 14307.713845723236, 14403.207823569805, 14517.927410362881, 14580.85419145795, 14922.701545969237, 13158.60524184276, 13474.86525134736, 13829.0, 13892.23592702411, 14300.928495357874, 12548.811767823672, 12657.367131643565, 12922.870771292542, 13417.127886687334, 13438.0, 12804.61586152417, 13172.143810652276, 13352.866471335163, 13412.463501460223, 13807.51673691416, 10871.619493317696, 10905.618303359344, 11113.777724445628, 11297.209195356247, 11362.375069371265, 11259.324440533594, 11437.199396042197, 11569.942150289195, 11723.531058757895, 11785.528578856749], "value": 6956.279772875436, "unit": "score"}], "name": "dromaeo_css", "value": 7003.529138310916, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [107.0, 113.0, 114.0, 113.0, 113.0, 113.0, 111.0, 114.0, 114.0, 112.0], "value": 112.4, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [153.0, 124.0, 123.0, 168.0, 124.0, 123.0, 123.0, 126.0, 163.0, 127.0], "value": 135.4, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [160.0, 161.0, 161.0, 161.0, 160.0, 162.0, 162.0, 162.0, 161.0, 161.0], "value": 161.1, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 75.0, 77.0, 108.0, 77.0, 77.0, 77.0, 77.0, 98.0, 77.0], "value": 81.9, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [83.0, 83.0, 123.0, 82.0, 82.0, 83.0, 105.0, 83.0, 84.0, 116.0], "value": 92.4, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [116.0, 116.0, 117.0, 117.0, 116.0, 117.0, 116.0, 117.0, 117.0, 116.0], "value": 116.5, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 145.0, 146.0, 146.0, 146.0, 147.0, 146.0, 146.0, 146.0, 145.0], "value": 145.9, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 85.0, 85.0, 84.0, 85.0, 84.0, 85.0, 84.0, 85.0, 84.0], "value": 84.6, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [53.0, 52.0, 52.0, 56.0, 52.0, 54.0, 58.0, 54.0, 53.0, 54.0], "value": 53.8, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [62.0, 61.0, 61.0, 60.0, 62.0, 60.0, 61.0, 61.0, 61.0, 62.0], "value": 61.1, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [88.0, 80.0, 87.0, 79.0, 81.0, 80.0, 82.0, 80.0, 79.0, 79.0], "value": 81.5, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [135.0, 129.0, 128.0, 127.0, 130.0, 139.0, 145.0, 126.0, 172.0, 137.0], "value": 136.8, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [164.0, 171.0, 169.0, 173.0, 166.0, 167.0, 171.0, 167.0, 172.0, 167.0], "value": 168.7, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [63.0, 64.0, 68.0, 66.0, 64.0, 64.0, 64.0, 64.0, 63.0, 63.0], "value": 64.3, "unit": "score"}], "name": "kraken", "value": 1496.3999999999999, "alertThreshold": 2.0}]} 13:46:01 INFO - Return code: 0 13:46:01 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 13:46:01 INFO - # TBPL SUCCESS # 13:46:01 INFO - Running post-action listener: _resource_record_post_action 13:46:01 INFO - [mozharness: 2016-10-29 20:46:01.189836Z] Finished run-tests step (success) 13:46:01 INFO - Running post-run listener: _resource_record_post_run 13:46:01 INFO - Total resource usage - Wall time: 1200s; CPU: 13.0%; Read bytes: 7733248; Write bytes: 439234560; Read time: 1604; Write time: 451012 13:46:01 INFO - TinderboxPrint: CPU usage
13.1% 13:46:01 INFO - TinderboxPrint: I/O read bytes / time
7,733,248 / 1,604 13:46:01 INFO - TinderboxPrint: I/O write bytes / time
439,234,560 / 451,012 13:46:01 INFO - TinderboxPrint: CPU idle
8,321.6 (86.9%) 13:46:01 INFO - TinderboxPrint: CPU user
1,199.4 (12.5%) 13:46:01 INFO - TinderboxPrint: Swap in / out
0 / 0 13:46:01 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 4096; Write bytes: 57720832; Read time: 136; Write time: 52940 13:46:01 INFO - run-tests - Wall time: 1184s; CPU: 13.0%; Read bytes: 5513216; Write bytes: 349327360; Read time: 1148; Write time: 358240 13:46:01 INFO - Running post-run listener: _upload_blobber_files 13:46:01 INFO - Blob upload gear active. 13:46:01 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 13:46:01 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 13:46:01 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'] 13:46:01 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 13:46:02 INFO - (blobuploader) - INFO - Open directory for files ... 13:46:02 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 13:46:02 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:46:02 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:46:06 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 13:46:06 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:46:06 INFO - (blobuploader) - INFO - Done attempting. 13:46:06 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 13:46:06 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:46:06 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:46:07 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 13:46:07 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:46:07 INFO - (blobuploader) - INFO - Done attempting. 13:46:07 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 13:46:07 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:46:07 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:46:08 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 13:46:08 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:46:08 INFO - (blobuploader) - INFO - Done attempting. 13:46:08 INFO - (blobuploader) - INFO - Iteration through files over. 13:46:08 INFO - Return code: 0 13:46:08 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 13:46:08 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 13:46:08 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/a27e4f6e530b5c39db34f3cca6c769dc4b908c2d4aca7297cfeef5a2eafd8b52b8da4c4e28de81fef71bda348ff0e5247960609ebd8a7bf90cd5b77d8f87b3cf", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/66cef50f8a2adadf927aa6c1dc2315379e4cbe918a9c50438d0a0e867d2d241901a7eb18ff7e094e860be4cb10cee72be674057ab85e30370298c660ba275112", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/c5b21a4fd4ea61cc38b88de64c588d60ab94d57a244fd4ee961c27b1c754bc5625c76792aa67f0b047e46203a5ffe561305fd835e1cf01b06a629b1d9f27428d"} 13:46:08 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 13:46:08 INFO - Writing to file /builds/slave/test/properties/blobber_files 13:46:08 INFO - Contents: 13:46:08 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/a27e4f6e530b5c39db34f3cca6c769dc4b908c2d4aca7297cfeef5a2eafd8b52b8da4c4e28de81fef71bda348ff0e5247960609ebd8a7bf90cd5b77d8f87b3cf", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/66cef50f8a2adadf927aa6c1dc2315379e4cbe918a9c50438d0a0e867d2d241901a7eb18ff7e094e860be4cb10cee72be674057ab85e30370298c660ba275112", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/c5b21a4fd4ea61cc38b88de64c588d60ab94d57a244fd4ee961c27b1c754bc5625c76792aa67f0b047e46203a5ffe561305fd835e1cf01b06a629b1d9f27428d"} 13:46:08 INFO - Running post-run listener: copy_logs_to_upload_dir 13:46:08 INFO - Copying logs to upload dir... 13:46:08 INFO - mkdir: /builds/slave/test/build/upload/logs 13:46:08 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1244.988501 ========= master_lag: 0.29 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 45 secs) (at 2016-10-29 13:46:08.742085) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-10-29 13:46:08.745869) ========= 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=1f5564757af27664ca02d71f000001b0-1477772720.177993-371408972 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/a27e4f6e530b5c39db34f3cca6c769dc4b908c2d4aca7297cfeef5a2eafd8b52b8da4c4e28de81fef71bda348ff0e5247960609ebd8a7bf90cd5b77d8f87b3cf", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/66cef50f8a2adadf927aa6c1dc2315379e4cbe918a9c50438d0a0e867d2d241901a7eb18ff7e094e860be4cb10cee72be674057ab85e30370298c660ba275112", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/c5b21a4fd4ea61cc38b88de64c588d60ab94d57a244fd4ee961c27b1c754bc5625c76792aa67f0b047e46203a5ffe561305fd835e1cf01b06a629b1d9f27428d"} build_url:https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1477698451/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011171 build_url: 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1477698451/firefox-52.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/a27e4f6e530b5c39db34f3cca6c769dc4b908c2d4aca7297cfeef5a2eafd8b52b8da4c4e28de81fef71bda348ff0e5247960609ebd8a7bf90cd5b77d8f87b3cf", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/66cef50f8a2adadf927aa6c1dc2315379e4cbe918a9c50438d0a0e867d2d241901a7eb18ff7e094e860be4cb10cee72be674057ab85e30370298c660ba275112", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/c5b21a4fd4ea61cc38b88de64c588d60ab94d57a244fd4ee961c27b1c754bc5625c76792aa67f0b047e46203a5ffe561305fd835e1cf01b06a629b1d9f27428d"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-10-29 13:46:08.770616) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-10-29 13:46:08.770933) ========= 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=1f5564757af27664ca02d71f000001b0-1477772720.177993-371408972 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004316 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-10-29 13:46:08.856523) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-10-29 13:46:08.856837) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-10-29 13:46:08.857135) ========= ========= Total master_lag: 0.47 =========