builder: mozilla-central_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-034 starttime: 1490098099.63 results: success (0) revision: 67ecac412f76a6bf229fead47b40eed69c146d61 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-03-21 05:08:19.626009) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-03-21 05:08:19.626452) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-03-21 05:08:19.626718) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-03-21 05:08:19.641687) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-03-21 05:08:19.642064) ========= 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=d6bbd613908ccac0c6c9cb47000001f7-1490098099.210041-1547077723 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-03-21 05:08:20-- 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% 68.3M=0s 2017-03-21 05:08:20 (68.3 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.095722 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-03-21 05:08:19.751178) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-03-21 05:08:19.751488) ========= 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=d6bbd613908ccac0c6c9cb47000001f7-1490098099.210041-1547077723 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.016744 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-03-21 05:08:19.803683) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-03-21 05:08:19.807076) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 67ecac412f76a6bf229fead47b40eed69c146d61 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'python archiver_client.py mozharness --repo mozilla-central --rev 67ecac412f76a6bf229fead47b40eed69c146d61 --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=d6bbd613908ccac0c6c9cb47000001f7-1490098099.210041-1547077723 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-03-21 05:08:20,501 truncating revision to first 12 chars 2017-03-21 05:08:20,501 Setting DEBUG logging. 2017-03-21 05:08:20,502 attempt 1/10 2017-03-21 05:08:20,502 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/67ecac412f76?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-03-21 05:08:21,118 unpacking tar archive at: mozilla-central-67ecac412f76/testing/mozharness/ program finished with exit code 0 elapsedTime=0.922036 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-03-21 05:08:20.742251) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-03-21 05:08:20.742563) ========= script_repo_revision: 67ecac412f76a6bf229fead47b40eed69c146d61 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-03-21 05:08:20.742954) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-03-21 05:08:20.743211) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-03-21 05:08:20.751400) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 57 secs) (at 2017-03-21 05:08:20.751702) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 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', 'Firefox', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox'] 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=d6bbd613908ccac0c6c9cb47000001f7-1490098099.210041-1547077723 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 05:08:21 INFO - MultiFileLogger online at 20170321 05:08:21 in /builds/slave/test 05:08:21 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 05:08:21 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 05:08:21 INFO - {'append_to_log': False, 05:08:21 INFO - 'base_work_dir': '/builds/slave/test', 05:08:21 INFO - 'blob_upload_branch': 'Firefox', 05:08:21 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 05:08:21 INFO - 'branch': 'Firefox', 05:08:21 INFO - 'buildbot_json_path': 'buildprops.json', 05:08:21 INFO - 'config_files': ('talos/linux_config.py',), 05:08:21 INFO - 'default_actions': ('clobber', 05:08:21 INFO - 'read-buildbot-config', 05:08:21 INFO - 'download-and-extract', 05:08:21 INFO - 'populate-webroot', 05:08:21 INFO - 'create-virtualenv', 05:08:21 INFO - 'install', 05:08:21 INFO - 'run-tests'), 05:08:21 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 05:08:21 INFO - 'download_minidump_stackwalk': True, 05:08:21 INFO - 'download_symbols': 'ondemand', 05:08:21 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 05:08:21 INFO - 'tooltool.py': '/tools/tooltool.py', 05:08:21 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 05:08:21 INFO - '/tools/misc-python/virtualenv.py')}, 05:08:21 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 05:08:21 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 05:08:21 INFO - 'gecko_profile': False, 05:08:21 INFO - 'gecko_profile_interval': 0, 05:08:21 INFO - 'installer_path': 'installer.exe', 05:08:21 INFO - 'log_level': 'info', 05:08:21 INFO - 'log_name': 'talos', 05:08:21 INFO - 'log_to_console': True, 05:08:21 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 05:08:21 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 05:08:21 INFO - 'opt_config_files': (), 05:08:21 INFO - 'pip_index': False, 05:08:21 INFO - 'suite': 'dromaeojs', 05:08:21 INFO - 'system_bits': '32', 05:08:21 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 05:08:21 INFO - 'title': 'talos-linux64-ix-034', 05:08:21 INFO - 'tooltool_cache': '/builds/tooltool_cache', 05:08:21 INFO - 'use_talos_json': True, 05:08:21 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 05:08:21 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 05:08:21 INFO - 'work_dir': 'build'} 05:08:21 INFO - [mozharness: 2017-03-21 12:08:21.540628Z] Running clobber step. 05:08:21 INFO - Running pre-action listener: _resource_record_pre_action 05:08:21 INFO - Running main action method: clobber 05:08:21 INFO - rmtree: /builds/slave/test/build 05:08:21 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 05:08:23 INFO - Running post-action listener: _resource_record_post_action 05:08:23 INFO - [mozharness: 2017-03-21 12:08:23.086982Z] Finished clobber step (success) 05:08:23 INFO - [mozharness: 2017-03-21 12:08:23.087081Z] Running read-buildbot-config step. 05:08:23 INFO - Running pre-action listener: _resource_record_pre_action 05:08:23 INFO - Running main action method: read_buildbot_config 05:08:23 INFO - Using buildbot properties: 05:08:23 INFO - { 05:08:23 INFO - "project": "", 05:08:23 INFO - "product": "firefox", 05:08:23 INFO - "who": "cbook@mozilla.com", 05:08:23 INFO - "installer_path": "public/build/target.tar.bz2", 05:08:23 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs", 05:08:23 INFO - "repository": "https://hg.mozilla.org/mozilla-central/", 05:08:23 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central pgo talos dromaeojs", 05:08:23 INFO - "stage_platform": "linux64-pgo", 05:08:23 INFO - "basedir": "/builds/slave/test", 05:08:23 INFO - "buildnumber": 86, 05:08:23 INFO - "platform": "ubuntu64_hw", 05:08:23 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 05:08:23 INFO - "slavebuilddir": "test", 05:08:23 INFO - "taskId": "RxPiH65BSWufXPo4hWKbfg", 05:08:23 INFO - "branch": "mozilla-central", 05:08:23 INFO - "script_repo_revision": "production", 05:08:23 INFO - "revision": "67ecac412f76a6bf229fead47b40eed69c146d61", 05:08:23 INFO - "slavename": "talos-linux64-ix-034", 05:08:23 INFO - "repo_path": "mozilla-central" 05:08:23 INFO - } 05:08:23 INFO - Finding installer, test and symbols from parent task. 05:08:23 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/RxPiH65BSWufXPo4hWKbfg'}, attempt #1 05:08:23 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/RxPiH65BSWufXPo4hWKbfg'}, attempt #1 05:08:23 INFO - Task dependencies: Nr157VxGRqChZrbb35e78w 05:08:23 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Nr157VxGRqChZrbb35e78w'}, attempt #1 05:08:24 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/Nr157VxGRqChZrbb35e78w/artifacts/public/build/target.tar.bz2 05:08:24 INFO - Set test_url: https://queue.taskcluster.net/v1/task/Nr157VxGRqChZrbb35e78w/artifacts/public/build/test_packages.json 05:08:24 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/Nr157VxGRqChZrbb35e78w/artifacts/public/build/target.crashreporter-symbols.zip 05:08:24 INFO - Running post-action listener: _resource_record_post_action 05:08:24 INFO - [mozharness: 2017-03-21 12:08:24.442866Z] Finished read-buildbot-config step (success) 05:08:24 INFO - [mozharness: 2017-03-21 12:08:24.443083Z] Running download-and-extract step. 05:08:24 INFO - Running pre-action listener: _resource_record_pre_action 05:08:24 INFO - Running main action method: download_and_extract 05:08:24 INFO - mkdir: /builds/slave/test/build/tests 05:08: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')]} 05:08:24 INFO - trying https://queue.taskcluster.net/v1/task/Nr157VxGRqChZrbb35e78w/artifacts/public/build/target.test_packages.json 05:08:24 INFO - Downloading https://queue.taskcluster.net/v1/task/Nr157VxGRqChZrbb35e78w/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 05:08:24 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Nr157VxGRqChZrbb35e78w/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 05:08:24 INFO - Downloaded 986 bytes. 05:08:24 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 05:08:24 INFO - Using the following test package requirements: 05:08:24 INFO - {u'awsy': [u'target.common.tests.zip', u'target.awsy.tests.zip'], 05:08:24 INFO - u'common': [u'target.common.tests.zip'], 05:08:24 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 05:08:24 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 05:08:24 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 05:08:24 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 05:08:24 INFO - u'mozbase': [u'target.common.tests.zip'], 05:08:24 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 05:08:24 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 05:08:24 INFO - u'web-platform': [u'target.common.tests.zip', 05:08:24 INFO - u'target.web-platform.tests.zip'], 05:08:24 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 05:08:24 INFO - Downloading packages: [u'target.common.tests.zip'] for test suite category: common 05:08:24 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/Nr157VxGRqChZrbb35e78w/artifacts/public/build/target.common.tests.zip 05:08:24 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Nr157VxGRqChZrbb35e78w/artifacts/public/build/target.common.tests.zip'}, attempt #1 05:08:24 INFO - Fetch https://queue.taskcluster.net/v1/task/Nr157VxGRqChZrbb35e78w/artifacts/public/build/target.common.tests.zip into memory 05:08:26 INFO - Expected file size: 60308918 05:08:26 INFO - Obtained file size: 60308918 05:08:36 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite category: talos 05:08:36 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/Nr157VxGRqChZrbb35e78w/artifacts/public/build/target.common.tests.zip 05:08:36 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Nr157VxGRqChZrbb35e78w/artifacts/public/build/target.common.tests.zip'}, attempt #1 05:08:36 INFO - Fetch https://queue.taskcluster.net/v1/task/Nr157VxGRqChZrbb35e78w/artifacts/public/build/target.common.tests.zip into memory 05:08:37 INFO - Expected file size: 60308918 05:08:37 INFO - Obtained file size: 60308918 05:08:48 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/Nr157VxGRqChZrbb35e78w/artifacts/public/build/target.talos.tests.zip 05:08:48 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Nr157VxGRqChZrbb35e78w/artifacts/public/build/target.talos.tests.zip'}, attempt #1 05:08:48 INFO - Fetch https://queue.taskcluster.net/v1/task/Nr157VxGRqChZrbb35e78w/artifacts/public/build/target.talos.tests.zip into memory 05:08:48 INFO - Expected file size: 14404171 05:08:48 INFO - Obtained file size: 14404171 05:08: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')]} 05:08:49 INFO - trying https://queue.taskcluster.net/v1/task/Nr157VxGRqChZrbb35e78w/artifacts/public/build/target.tar.bz2 05:08:49 INFO - Downloading https://queue.taskcluster.net/v1/task/Nr157VxGRqChZrbb35e78w/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 05:08:49 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Nr157VxGRqChZrbb35e78w/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 05:08:50 INFO - Downloaded 67203112 bytes. 05:08:50 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/Nr157VxGRqChZrbb35e78w/artifacts/public/build/target.tar.bz2 05:08:50 INFO - mkdir: /builds/slave/test/properties 05:08:50 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 05:08:50 INFO - Writing to file /builds/slave/test/properties/build_url 05:08:50 INFO - Contents: 05:08:50 INFO - build_url:https://queue.taskcluster.net/v1/task/Nr157VxGRqChZrbb35e78w/artifacts/public/build/target.tar.bz2 05:08:50 INFO - Running post-action listener: _resource_record_post_action 05:08:50 INFO - Running post-action listener: set_extra_try_arguments 05:08:50 INFO - [mozharness: 2017-03-21 12:08:50.417484Z] Finished download-and-extract step (success) 05:08:50 INFO - [mozharness: 2017-03-21 12:08:50.417582Z] Running populate-webroot step. 05:08:50 INFO - Running pre-action listener: _resource_record_pre_action 05:08:50 INFO - Running main action method: populate_webroot 05:08:50 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 05:08:50 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 05:08:50 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 05:08:50 INFO - '--tppagecycles', 05:08:50 INFO - '7'], 05:08:50 INFO - 'tests': ['tsvgm']}}, 05:08:50 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 05:08:50 INFO - 'tests': ['tresize', 'tcanvasmark']}, 05:08:50 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 05:08:50 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 05:08:50 INFO - 'tests': ['dromaeo_css', 'kraken']}, 05:08:50 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 05:08:50 INFO - 'g1': {'pagesets_name': 'tp5n.zip', 05:08:50 INFO - 'talos_options': ['--disable-e10s'], 05:08:50 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:08:50 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 05:08:50 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:08:50 INFO - 'g2': {'pagesets_name': 'tp5n.zip', 05:08:50 INFO - 'talos_options': ['--disable-e10s'], 05:08:50 INFO - 'tests': ['damp', 'tps']}, 05:08:50 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 05:08:50 INFO - 'tests': ['damp', 'tps']}, 05:08:50 INFO - 'g3': {'talos_options': ['--disable-e10s'], 05:08:50 INFO - 'tests': ['dromaeo_dom']}, 05:08:50 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 05:08:50 INFO - 'g4': {'talos_options': ['--disable-e10s'], 05:08:50 INFO - 'tests': ['basic_compositor_video']}, 05:08:50 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 05:08:50 INFO - 'other': {'talos_options': ['--disable-e10s'], 05:08:50 INFO - 'tests': ['a11yr', 05:08:50 INFO - 'ts_paint', 05:08:50 INFO - 'tpaint', 05:08:50 INFO - 'sessionrestore', 05:08:50 INFO - 'sessionrestore_no_auto_restore', 05:08:50 INFO - 'tabpaint']}, 05:08:50 INFO - 'other-e10s': {'tests': ['a11yr', 05:08:50 INFO - 'ts_paint', 05:08:50 INFO - 'tpaint', 05:08:50 INFO - 'sessionrestore', 05:08:50 INFO - 'sessionrestore_no_auto_restore', 05:08:50 INFO - 'tabpaint']}, 05:08:50 INFO - 'other-e10s_l64': {'tests': ['a11yr', 05:08:50 INFO - 'ts_paint', 05:08:50 INFO - 'tpaint', 05:08:50 INFO - 'sessionrestore', 05:08:50 INFO - 'sessionrestore_no_auto_restore', 05:08:50 INFO - 'tabpaint']}, 05:08:50 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 05:08:50 INFO - 'ts_paint', 05:08:50 INFO - 'tpaint', 05:08:50 INFO - 'sessionrestore', 05:08:50 INFO - 'sessionrestore_no_auto_restore', 05:08:50 INFO - 'tabpaint']}, 05:08:50 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 05:08:50 INFO - 'tests': ['a11yr', 05:08:50 INFO - 'ts_paint', 05:08:50 INFO - 'tpaint', 05:08:50 INFO - 'sessionrestore', 05:08:50 INFO - 'sessionrestore_no_auto_restore', 05:08:50 INFO - 'tabpaint']}, 05:08:50 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 05:08:50 INFO - 'tests': ['a11yr', 05:08:50 INFO - 'ts_paint', 05:08:50 INFO - 'tpaint', 05:08:50 INFO - 'sessionrestore', 05:08:50 INFO - 'sessionrestore_no_auto_restore', 05:08:50 INFO - 'tabpaint']}, 05:08:50 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 05:08:50 INFO - 'tests': ['tsvgx', 05:08:50 INFO - 'tsvgr_opacity', 05:08:50 INFO - 'tart', 05:08:50 INFO - 'tscrollx', 05:08:50 INFO - 'cart', 05:08:50 INFO - 'tsvg_static']}, 05:08:50 INFO - 'svgr-e10s': {'tests': ['tsvgx', 05:08:50 INFO - 'tsvgr_opacity', 05:08:50 INFO - 'tart', 05:08:50 INFO - 'tscrollx', 05:08:50 INFO - 'cart', 05:08:50 INFO - 'tsvg_static']}, 05:08:50 INFO - 'tp5o': {'pagesets_name': 'tp5n.zip', 05:08:50 INFO - 'talos_options': ['--disable-e10s'], 05:08:50 INFO - 'tests': ['tp5o']}, 05:08:50 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 05:08:50 INFO - 'xperf': {'pagesets_name': 'tp5n.zip', 05:08:50 INFO - 'talos_options': ['--disable-e10s', 05:08:50 INFO - '--xperf_path', 05:08:50 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:08:50 INFO - 'tests': ['tp5n']}, 05:08:50 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 05:08:50 INFO - 'talos_options': ['--xperf_path', 05:08:50 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:08:50 INFO - 'tests': ['tp5n']}}, 05:08:50 INFO - 'talos.zip': {'path': '', 05:08:50 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 05:08:50 INFO - Running post-action listener: _resource_record_post_action 05:08:50 INFO - [mozharness: 2017-03-21 12:08:50.430805Z] Finished populate-webroot step (success) 05:08:50 INFO - [mozharness: 2017-03-21 12:08:50.430896Z] Running create-virtualenv step. 05:08:50 INFO - Running pre-action listener: _resource_record_pre_action 05:08:50 INFO - Running main action method: create_virtualenv 05:08:50 INFO - Creating virtualenv /builds/slave/test/build/venv 05:08:50 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 05:08:50 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 05:08:50 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 05:08:50 INFO - Using real prefix '/usr' 05:08:50 INFO - New python executable in /builds/slave/test/build/venv/bin/python 05:08:51 INFO - Installing distribute.............................................................................................................................................................................................done. 05:08:53 INFO - Installing pip.................done. 05:08:53 INFO - Return code: 0 05:08:53 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 05:08:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 05:08:53 INFO - Reading from file tmpfile_stdout 05:08:53 INFO - Output received: 05:08:53 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) 05:08:53 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 05:08:53 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')]} 05:08:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:08:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:08:53 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')]} 05:08:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:08:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:08:53 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 0x20dd1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x211aa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x237b310>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2378400>, '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 0x23793b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2379840>, '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': 'd6bbd613908ccac0c6c9cb47000001f7-1490098099.210041-1547077723', '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 05:08:53 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 05:08:53 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 05:08:53 INFO - Using env: {'DISPLAY': ':0', 05:08:53 INFO - 'HOME': '/home/cltbld', 05:08:53 INFO - 'LANG': 'en_US.UTF-8', 05:08:53 INFO - 'LANGUAGE': 'en_US:en', 05:08:53 INFO - 'LOGNAME': 'cltbld', 05:08:53 INFO - 'MAIL': '/var/mail/cltbld', 05:08:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:08:53 INFO - 'MOZ_NO_REMOTE': '1', 05:08:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:08:53 INFO - 'NO_EM_RESTART': '1', 05:08:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:08:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:08:53 INFO - 'PWD': '/builds/slave/test', 05:08:53 INFO - 'SHELL': '/bin/bash', 05:08:53 INFO - 'SHLVL': '1', 05:08:53 INFO - 'TERM': 'linux', 05:08:53 INFO - 'TMOUT': '86400', 05:08:53 INFO - 'USER': 'cltbld', 05:08:53 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1490098099.210041-1547077723', 05:08:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:08:53 INFO - '_': '/tools/buildbot/bin/python'} 05:08:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:08:53 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 05:08:53 INFO - Cleaning up... 05:08:53 INFO - Return code: 0 05:08:53 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 05:08:53 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')]} 05:08:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:08:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:08:53 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')]} 05:08:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:08:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:08:53 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 0x20dd1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x211aa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x237b310>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2378400>, '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 0x23793b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2379840>, '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': 'd6bbd613908ccac0c6c9cb47000001f7-1490098099.210041-1547077723', '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 05:08:53 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 05:08:53 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 05:08:53 INFO - Using env: {'DISPLAY': ':0', 05:08:53 INFO - 'HOME': '/home/cltbld', 05:08:53 INFO - 'LANG': 'en_US.UTF-8', 05:08:53 INFO - 'LANGUAGE': 'en_US:en', 05:08:53 INFO - 'LOGNAME': 'cltbld', 05:08:53 INFO - 'MAIL': '/var/mail/cltbld', 05:08:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:08:53 INFO - 'MOZ_NO_REMOTE': '1', 05:08:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:08:53 INFO - 'NO_EM_RESTART': '1', 05:08:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:08:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:08:53 INFO - 'PWD': '/builds/slave/test', 05:08:53 INFO - 'SHELL': '/bin/bash', 05:08:53 INFO - 'SHLVL': '1', 05:08:53 INFO - 'TERM': 'linux', 05:08:53 INFO - 'TMOUT': '86400', 05:08:53 INFO - 'USER': 'cltbld', 05:08:53 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1490098099.210041-1547077723', 05:08:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:08:53 INFO - '_': '/tools/buildbot/bin/python'} 05:08:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:08:53 INFO - Downloading/unpacking psutil>=3.1.1 05:08:53 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 05:08:53 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 05:08:53 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 05:08:53 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 05:08:53 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 05:08:53 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 05:08:55 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 05:08:55 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:08:55 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:08:55 INFO - Installing collected packages: psutil 05:08:55 INFO - Running setup.py install for psutil 05:08:55 INFO - building 'psutil._psutil_linux' extension 05:08:55 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 05:08:56 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 05:08:56 INFO - building 'psutil._psutil_posix' extension 05:08:56 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 05:08:56 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 05:08:56 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:08:56 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:08:56 INFO - Successfully installed psutil 05:08:56 INFO - Cleaning up... 05:08:56 INFO - Return code: 0 05:08:56 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 05:08:56 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')]} 05:08:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:08:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:08:56 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')]} 05:08:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:08:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:08:56 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 0x20dd1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x211aa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x237b310>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2378400>, '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 0x23793b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2379840>, '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': 'd6bbd613908ccac0c6c9cb47000001f7-1490098099.210041-1547077723', '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 05:08:56 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 05:08:56 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 05:08:56 INFO - Using env: {'DISPLAY': ':0', 05:08:56 INFO - 'HOME': '/home/cltbld', 05:08:56 INFO - 'LANG': 'en_US.UTF-8', 05:08:56 INFO - 'LANGUAGE': 'en_US:en', 05:08:56 INFO - 'LOGNAME': 'cltbld', 05:08:56 INFO - 'MAIL': '/var/mail/cltbld', 05:08:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:08:56 INFO - 'MOZ_NO_REMOTE': '1', 05:08:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:08:56 INFO - 'NO_EM_RESTART': '1', 05:08:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:08:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:08:56 INFO - 'PWD': '/builds/slave/test', 05:08:56 INFO - 'SHELL': '/bin/bash', 05:08:56 INFO - 'SHLVL': '1', 05:08:56 INFO - 'TERM': 'linux', 05:08:56 INFO - 'TMOUT': '86400', 05:08:56 INFO - 'USER': 'cltbld', 05:08:56 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1490098099.210041-1547077723', 05:08:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:08:56 INFO - '_': '/tools/buildbot/bin/python'} 05:08:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:08:56 INFO - Downloading/unpacking mozsystemmonitor==0.3 05:08:56 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 05:08:56 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 05:08:56 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 05:08:56 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 05:08:56 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 05:08:56 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 05:08:58 INFO - Downloading mozsystemmonitor-0.3.tar.gz 05:08:58 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 05:08:58 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 05:08:58 INFO - Installing collected packages: mozsystemmonitor 05:08:58 INFO - Running setup.py install for mozsystemmonitor 05:08:58 INFO - Successfully installed mozsystemmonitor 05:08:58 INFO - Cleaning up... 05:08:58 INFO - Return code: 0 05:08:58 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 05:08:58 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')]} 05:08:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:08:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:08:58 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')]} 05:08:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:08:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:08:58 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 0x20dd1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x211aa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x237b310>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2378400>, '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 0x23793b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2379840>, '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': 'd6bbd613908ccac0c6c9cb47000001f7-1490098099.210041-1547077723', '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 05:08:58 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 05:08:58 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 05:08:58 INFO - Using env: {'DISPLAY': ':0', 05:08:58 INFO - 'HOME': '/home/cltbld', 05:08:58 INFO - 'LANG': 'en_US.UTF-8', 05:08:58 INFO - 'LANGUAGE': 'en_US:en', 05:08:58 INFO - 'LOGNAME': 'cltbld', 05:08:58 INFO - 'MAIL': '/var/mail/cltbld', 05:08:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:08:58 INFO - 'MOZ_NO_REMOTE': '1', 05:08:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:08:58 INFO - 'NO_EM_RESTART': '1', 05:08:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:08:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:08:58 INFO - 'PWD': '/builds/slave/test', 05:08:58 INFO - 'SHELL': '/bin/bash', 05:08:58 INFO - 'SHLVL': '1', 05:08:58 INFO - 'TERM': 'linux', 05:08:58 INFO - 'TMOUT': '86400', 05:08:58 INFO - 'USER': 'cltbld', 05:08:58 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1490098099.210041-1547077723', 05:08:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:08:58 INFO - '_': '/tools/buildbot/bin/python'} 05:08:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:08:58 INFO - Downloading/unpacking jsonschema==2.5.1 05:08:58 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 05:08:58 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 05:08:58 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 05:08:58 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 05:08:58 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 05:08:58 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 05:09:00 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 05:09:00 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 05:09:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:09:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:09:00 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:09:00 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:09:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:09:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:09:01 INFO - Downloading functools32-3.2.3-2.tar.gz 05:09:01 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 05:09:01 INFO - warning: no files found matching '*.txt' 05:09:01 INFO - no previously-included directories found matching 'build' 05:09:01 INFO - no previously-included directories found matching 'dist' 05:09:01 INFO - no previously-included directories found matching '.git*' 05:09:01 INFO - Installing collected packages: jsonschema, functools32 05:09:01 INFO - Running setup.py install for functools32 05:09:01 INFO - warning: no files found matching '*.txt' 05:09:01 INFO - no previously-included directories found matching 'build' 05:09:01 INFO - no previously-included directories found matching 'dist' 05:09:01 INFO - no previously-included directories found matching '.git*' 05:09:01 INFO - Successfully installed jsonschema functools32 05:09:01 INFO - Cleaning up... 05:09:01 INFO - Return code: 0 05:09:01 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 05:09:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:09:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:09:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:09:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:09:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:09:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:09:01 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 0x20dd1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x211aa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x237b310>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2378400>, '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 0x23793b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2379840>, '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': 'd6bbd613908ccac0c6c9cb47000001f7-1490098099.210041-1547077723', '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 05:09:01 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 05:09:01 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 05:09:01 INFO - Using env: {'DISPLAY': ':0', 05:09:01 INFO - 'HOME': '/home/cltbld', 05:09:01 INFO - 'LANG': 'en_US.UTF-8', 05:09:01 INFO - 'LANGUAGE': 'en_US:en', 05:09:01 INFO - 'LOGNAME': 'cltbld', 05:09:01 INFO - 'MAIL': '/var/mail/cltbld', 05:09:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:09:01 INFO - 'MOZ_NO_REMOTE': '1', 05:09:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:09:01 INFO - 'NO_EM_RESTART': '1', 05:09:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:09:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:09:01 INFO - 'PWD': '/builds/slave/test', 05:09:01 INFO - 'SHELL': '/bin/bash', 05:09:01 INFO - 'SHLVL': '1', 05:09:01 INFO - 'TERM': 'linux', 05:09:01 INFO - 'TMOUT': '86400', 05:09:01 INFO - 'USER': 'cltbld', 05:09:01 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1490098099.210041-1547077723', 05:09:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:09:01 INFO - '_': '/tools/buildbot/bin/python'} 05:09:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:09:01 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 05:09:01 INFO - Cleaning up... 05:09:01 INFO - Return code: 0 05:09:01 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 05:09:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:09:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:09:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:09:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:09:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:09:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:09:01 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 0x20dd1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x211aa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x237b310>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2378400>, '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 0x23793b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2379840>, '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': 'd6bbd613908ccac0c6c9cb47000001f7-1490098099.210041-1547077723', '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 05:09:01 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 05:09:01 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 05:09:01 INFO - Using env: {'DISPLAY': ':0', 05:09:01 INFO - 'HOME': '/home/cltbld', 05:09:01 INFO - 'LANG': 'en_US.UTF-8', 05:09:01 INFO - 'LANGUAGE': 'en_US:en', 05:09:01 INFO - 'LOGNAME': 'cltbld', 05:09:01 INFO - 'MAIL': '/var/mail/cltbld', 05:09:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:09:01 INFO - 'MOZ_NO_REMOTE': '1', 05:09:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:09:01 INFO - 'NO_EM_RESTART': '1', 05:09:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:09:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:09:01 INFO - 'PWD': '/builds/slave/test', 05:09:01 INFO - 'SHELL': '/bin/bash', 05:09:01 INFO - 'SHLVL': '1', 05:09:01 INFO - 'TERM': 'linux', 05:09:01 INFO - 'TMOUT': '86400', 05:09:01 INFO - 'USER': 'cltbld', 05:09:01 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1490098099.210041-1547077723', 05:09:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:09:01 INFO - '_': '/tools/buildbot/bin/python'} 05:09:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:09:01 INFO - Downloading/unpacking blobuploader==1.2.4 05:09:01 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 05:09:01 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 05:09:01 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 05:09:01 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 05:09:01 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 05:09:01 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 05:09:03 INFO - Downloading blobuploader-1.2.4.tar.gz 05:09:03 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 05:09:04 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 05:09:04 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 05:09:04 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 05:09:04 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 05:09:04 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 05:09:04 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 05:09:04 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 05:09:04 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 05:09:04 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 05:09:04 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 05:09:04 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 05:09:04 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 05:09:04 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 05:09:04 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 05:09:04 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 05:09:04 INFO - Downloading docopt-0.6.1.tar.gz 05:09:04 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 05:09:04 INFO - Installing collected packages: blobuploader, requests, docopt 05:09:04 INFO - Running setup.py install for blobuploader 05:09:04 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 05:09:04 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 05:09:04 INFO - Running setup.py install for requests 05:09:05 INFO - Running setup.py install for docopt 05:09:05 INFO - Successfully installed blobuploader requests docopt 05:09:05 INFO - Cleaning up... 05:09:05 INFO - Return code: 0 05:09:05 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:09:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:09:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:09:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:09:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:09:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:09:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:09:05 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 0x20dd1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x211aa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x237b310>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2378400>, '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 0x23793b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2379840>, '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': 'd6bbd613908ccac0c6c9cb47000001f7-1490098099.210041-1547077723', '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 05:09:05 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 05:09:05 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 05:09:05 INFO - Using env: {'DISPLAY': ':0', 05:09:05 INFO - 'HOME': '/home/cltbld', 05:09:05 INFO - 'LANG': 'en_US.UTF-8', 05:09:05 INFO - 'LANGUAGE': 'en_US:en', 05:09:05 INFO - 'LOGNAME': 'cltbld', 05:09:05 INFO - 'MAIL': '/var/mail/cltbld', 05:09:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:09:05 INFO - 'MOZ_NO_REMOTE': '1', 05:09:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:09:05 INFO - 'NO_EM_RESTART': '1', 05:09:05 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:09:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:09:05 INFO - 'PWD': '/builds/slave/test', 05:09:05 INFO - 'SHELL': '/bin/bash', 05:09:05 INFO - 'SHLVL': '1', 05:09:05 INFO - 'TERM': 'linux', 05:09:05 INFO - 'TMOUT': '86400', 05:09:05 INFO - 'USER': 'cltbld', 05:09:05 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1490098099.210041-1547077723', 05:09:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:09:05 INFO - '_': '/tools/buildbot/bin/python'} 05:09:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:09:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 05:09:05 INFO - Running setup.py (path:/tmp/pip-qmdFLu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 05:09:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 05:09:05 INFO - Running setup.py (path:/tmp/pip-VuJrYq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 05:09:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 05:09:05 INFO - Running setup.py (path:/tmp/pip-1Sf4PJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 05:09:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 05:09:05 INFO - Running setup.py (path:/tmp/pip-LNFHuG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 05:09:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 05:09:05 INFO - Running setup.py (path:/tmp/pip-4iL98I-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 05:09:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 05:09:05 INFO - Running setup.py (path:/tmp/pip-EWu66s-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 05:09:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 05:09:06 INFO - Running setup.py (path:/tmp/pip-PPvqvu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 05:09:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 05:09:06 INFO - Running setup.py (path:/tmp/pip-AmNwKA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 05:09:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 05:09:06 INFO - Running setup.py (path:/tmp/pip-SFBAeU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 05:09:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 05:09:06 INFO - Running setup.py (path:/tmp/pip-b3xpWH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 05:09:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 05:09:06 INFO - Running setup.py (path:/tmp/pip-npdnm3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 05:09:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 05:09:06 INFO - Running setup.py (path:/tmp/pip-cYhuoP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 05:09:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 05:09:06 INFO - Running setup.py (path:/tmp/pip-gSisrq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 05:09:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 05:09:06 INFO - Running setup.py (path:/tmp/pip-Ix3jhU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 05:09:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 05:09:06 INFO - Running setup.py (path:/tmp/pip-dERMu9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 05:09:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 05:09:06 INFO - Running setup.py (path:/tmp/pip-d0lrjy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 05:09:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 05:09:06 INFO - Running setup.py (path:/tmp/pip-661NTV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 05:09:06 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 05:09:06 INFO - Running setup.py install for manifestparser 05:09:06 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 05:09:06 INFO - Running setup.py install for mozcrash 05:09:07 INFO - Running setup.py install for mozdebug 05:09:07 INFO - Running setup.py install for mozdevice 05:09:07 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 05:09:07 INFO - Installing dm script to /builds/slave/test/build/venv/bin 05:09:07 INFO - Running setup.py install for mozfile 05:09:07 INFO - Running setup.py install for mozhttpd 05:09:07 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 05:09:07 INFO - Running setup.py install for mozinfo 05:09:07 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 05:09:07 INFO - Running setup.py install for mozInstall 05:09:07 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 05:09:07 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 05:09:07 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 05:09:07 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 05:09:07 INFO - Running setup.py install for mozleak 05:09:07 INFO - Running setup.py install for mozlog 05:09:07 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 05:09:07 INFO - Running setup.py install for moznetwork 05:09:07 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 05:09:07 INFO - Running setup.py install for mozprocess 05:09:08 INFO - Running setup.py install for mozprofile 05:09:08 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 05:09:08 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 05:09:08 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 05:09:08 INFO - Running setup.py install for mozrunner 05:09:08 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 05:09:08 INFO - Running setup.py install for mozscreenshot 05:09:08 INFO - Running setup.py install for moztest 05:09:08 INFO - Running setup.py install for mozversion 05:09:08 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 05:09:08 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 05:09:08 INFO - Cleaning up... 05:09:08 INFO - Return code: 0 05:09:08 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:09:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:09:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:09:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:09:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:09:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:09:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:09:08 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 0x20dd1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x211aa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x237b310>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2378400>, '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 0x23793b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2379840>, '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': 'd6bbd613908ccac0c6c9cb47000001f7-1490098099.210041-1547077723', '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 05:09:08 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 05:09:08 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 05:09:08 INFO - Using env: {'DISPLAY': ':0', 05:09:08 INFO - 'HOME': '/home/cltbld', 05:09:08 INFO - 'LANG': 'en_US.UTF-8', 05:09:08 INFO - 'LANGUAGE': 'en_US:en', 05:09:08 INFO - 'LOGNAME': 'cltbld', 05:09:08 INFO - 'MAIL': '/var/mail/cltbld', 05:09:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:09:08 INFO - 'MOZ_NO_REMOTE': '1', 05:09:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:09:08 INFO - 'NO_EM_RESTART': '1', 05:09:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:09:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:09:08 INFO - 'PWD': '/builds/slave/test', 05:09:08 INFO - 'SHELL': '/bin/bash', 05:09:08 INFO - 'SHLVL': '1', 05:09:08 INFO - 'TERM': 'linux', 05:09:08 INFO - 'TMOUT': '86400', 05:09:08 INFO - 'USER': 'cltbld', 05:09:08 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1490098099.210041-1547077723', 05:09:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:09:08 INFO - '_': '/tools/buildbot/bin/python'} 05:09:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:09:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 05:09:08 INFO - Running setup.py (path:/tmp/pip-CHs3iJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 05:09:08 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)) 05:09:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 05:09:08 INFO - Running setup.py (path:/tmp/pip-8hzvIA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 05:09:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==1.0 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)) 05:09:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 05:09:08 INFO - Running setup.py (path:/tmp/pip-0Zq2Y6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 05:09:09 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)) 05:09:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 05:09:09 INFO - Running setup.py (path:/tmp/pip-3mXKMX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 05:09:09 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.49 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)) 05:09:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 05:09:09 INFO - Running setup.py (path:/tmp/pip-4RusSZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 05:09:09 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)) 05:09:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 05:09:09 INFO - Running setup.py (path:/tmp/pip-IrVwQy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 05:09:09 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)) 05:09:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 05:09:09 INFO - Running setup.py (path:/tmp/pip-p6_jd3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 05:09:09 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)) 05:09:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 05:09:09 INFO - Running setup.py (path:/tmp/pip-lxTkPV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 05:09:09 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)) 05:09:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 05:09:09 INFO - Running setup.py (path:/tmp/pip-NoBnlW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 05:09:09 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)) 05:09:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 05:09:09 INFO - Running setup.py (path:/tmp/pip-EYFaZO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 05:09:09 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)) 05:09:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 05:09:09 INFO - Running setup.py (path:/tmp/pip-AeRIGM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 05:09:09 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)) 05:09:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 05:09:09 INFO - Running setup.py (path:/tmp/pip-sMnKrT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 05:09:09 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.25 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)) 05:09:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 05:09:09 INFO - Running setup.py (path:/tmp/pip-sK1dsY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 05:09:09 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)) 05:09:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 05:09:09 INFO - Running setup.py (path:/tmp/pip-kLFJSU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 05:09:09 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.13 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)) 05:09:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 05:09:09 INFO - Running setup.py (path:/tmp/pip-JRp2di-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 05:09:09 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)) 05:09:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 05:09:09 INFO - Running setup.py (path:/tmp/pip-8IJA1w-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 05:09:09 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.8 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)) 05:09:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 05:09:10 INFO - Running setup.py (path:/tmp/pip-r39sgV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 05:09:10 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)) 05:09:10 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 05:09:10 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 05:09:10 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)) 05:09:10 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.49->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 05:09:10 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.49->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 05:09:10 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 05:09:10 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 05:09:10 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 05:09:10 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 05:09:10 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 05:09:10 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 05:09:10 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 05:09:12 INFO - Downloading blessings-1.6.tar.gz 05:09:12 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 05:09:12 INFO - Installing collected packages: blessings 05:09:12 INFO - Running setup.py install for blessings 05:09:12 INFO - Successfully installed blessings 05:09:12 INFO - Cleaning up... 05:09:12 INFO - Return code: 0 05:09:12 INFO - Done creating virtualenv /builds/slave/test/build/venv. 05:09:12 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 05:09:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 05:09:12 INFO - Reading from file tmpfile_stdout 05:09:12 INFO - Current package versions: 05:09:12 INFO - argparse == 1.2.1 05:09:12 INFO - blessings == 1.6 05:09:12 INFO - blobuploader == 1.2.4 05:09:12 INFO - docopt == 0.6.1 05:09:12 INFO - functools32 == 3.2.3-2 05:09:12 INFO - jsonschema == 2.5.1 05:09:12 INFO - manifestparser == 1.1 05:09:12 INFO - mozInstall == 1.12 05:09:12 INFO - mozcrash == 1.0 05:09:12 INFO - mozdebug == 0.1 05:09:12 INFO - mozdevice == 0.49 05:09:12 INFO - mozfile == 1.2 05:09:12 INFO - mozhttpd == 0.7 05:09:12 INFO - mozinfo == 0.9 05:09:12 INFO - mozleak == 0.1 05:09:12 INFO - mozlog == 3.4 05:09:12 INFO - moznetwork == 0.27 05:09:12 INFO - mozprocess == 0.25 05:09:12 INFO - mozprofile == 0.28 05:09:12 INFO - mozrunner == 6.13 05:09:12 INFO - mozscreenshot == 0.1 05:09:12 INFO - mozsystemmonitor == 0.3 05:09:12 INFO - moztest == 0.8 05:09:12 INFO - mozversion == 1.4 05:09:12 INFO - psutil == 3.1.1 05:09:12 INFO - requests == 1.2.3 05:09:12 INFO - wsgiref == 0.1.2 05:09:12 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:09:12 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')]} 05:09:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:09:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:09:12 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')]} 05:09:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:09:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:09:12 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 0x20dd1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x211aa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x237b310>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2378400>, '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 0x23793b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2379840>, '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': 'd6bbd613908ccac0c6c9cb47000001f7-1490098099.210041-1547077723', '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 05:09:12 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 05:09:12 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 05:09:12 INFO - Using env: {'DISPLAY': ':0', 05:09:12 INFO - 'HOME': '/home/cltbld', 05:09:12 INFO - 'LANG': 'en_US.UTF-8', 05:09:12 INFO - 'LANGUAGE': 'en_US:en', 05:09:12 INFO - 'LOGNAME': 'cltbld', 05:09:12 INFO - 'MAIL': '/var/mail/cltbld', 05:09:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:09:12 INFO - 'MOZ_NO_REMOTE': '1', 05:09:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:09:12 INFO - 'NO_EM_RESTART': '1', 05:09:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:09:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:09:12 INFO - 'PWD': '/builds/slave/test', 05:09:12 INFO - 'SHELL': '/bin/bash', 05:09:12 INFO - 'SHLVL': '1', 05:09:12 INFO - 'TERM': 'linux', 05:09:12 INFO - 'TMOUT': '86400', 05:09:12 INFO - 'USER': 'cltbld', 05:09:12 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1490098099.210041-1547077723', 05:09:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:09:12 INFO - '_': '/tools/buildbot/bin/python'} 05:09:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:09:12 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)) 05:09:12 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)) 05:09:12 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)) 05:09:12 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)) 05:09:12 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)) 05:09:12 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)) 05:09:12 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)) 05:09:12 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)) 05:09:12 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)) 05:09:12 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)) 05:09:12 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)) 05:09:12 INFO - Cleaning up... 05:09:12 INFO - Return code: 0 05:09:12 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 05:09:12 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')]} 05:09:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:09:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:09:12 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')]} 05:09:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:09:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:09:12 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 0x20dd1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x211aa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x237b310>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2378400>, '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 0x23793b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2379840>, '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': 'd6bbd613908ccac0c6c9cb47000001f7-1490098099.210041-1547077723', '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 05:09:12 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 05:09:12 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 05:09:12 INFO - Using env: {'DISPLAY': ':0', 05:09:12 INFO - 'HOME': '/home/cltbld', 05:09:12 INFO - 'LANG': 'en_US.UTF-8', 05:09:12 INFO - 'LANGUAGE': 'en_US:en', 05:09:12 INFO - 'LOGNAME': 'cltbld', 05:09:12 INFO - 'MAIL': '/var/mail/cltbld', 05:09:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:09:12 INFO - 'MOZ_NO_REMOTE': '1', 05:09:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:09:12 INFO - 'NO_EM_RESTART': '1', 05:09:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:09:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:09:12 INFO - 'PWD': '/builds/slave/test', 05:09:12 INFO - 'SHELL': '/bin/bash', 05:09:12 INFO - 'SHLVL': '1', 05:09:12 INFO - 'TERM': 'linux', 05:09:12 INFO - 'TMOUT': '86400', 05:09:12 INFO - 'USER': 'cltbld', 05:09:12 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1490098099.210041-1547077723', 05:09:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:09:12 INFO - '_': '/tools/buildbot/bin/python'} 05:09:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:09:13 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 05:09:13 INFO - Cleaning up... 05:09:13 INFO - Return code: 0 05:09:13 INFO - Running post-action listener: _resource_record_post_action 05:09:13 INFO - Running post-action listener: _start_resource_monitoring 05:09:13 INFO - Starting resource monitoring. 05:09:13 INFO - [mozharness: 2017-03-21 12:09:13.059473Z] Finished create-virtualenv step (success) 05:09:13 INFO - [mozharness: 2017-03-21 12:09:13.059989Z] Running install step. 05:09:13 INFO - Running pre-action listener: _resource_record_pre_action 05:09:13 INFO - Running main action method: install 05:09:13 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 05:09:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 05:09:13 INFO - Reading from file tmpfile_stdout 05:09:13 INFO - Detecting whether we're running mozinstall >=1.0... 05:09:13 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 05:09:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 05:09:13 INFO - Reading from file tmpfile_stdout 05:09:13 INFO - Output received: 05:09:13 INFO - Usage: mozinstall [options] installer 05:09:13 INFO - Options: 05:09:13 INFO - -h, --help show this help message and exit 05:09:13 INFO - -d DEST, --destination=DEST 05:09:13 INFO - Directory to install application into. [default: 05:09:13 INFO - "/builds/slave/test"] 05:09:13 INFO - --app=APP Application being installed. [default: firefox] 05:09:13 INFO - mkdir: /builds/slave/test/build/application 05:09:13 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/target.tar.bz2', '--destination', '/builds/slave/test/build/application'] 05:09:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 05:09:31 INFO - Reading from file tmpfile_stdout 05:09:31 INFO - Output received: 05:09:31 INFO - /builds/slave/test/build/application/firefox/firefox 05:09:31 INFO - Running post-action listener: _resource_record_post_action 05:09:31 INFO - [mozharness: 2017-03-21 12:09:31.175527Z] Finished install step (success) 05:09:31 INFO - [mozharness: 2017-03-21 12:09:31.175806Z] Running run-tests step. 05:09:31 INFO - Running pre-action listener: _resource_record_pre_action 05:09:31 INFO - Running main action method: run_tests 05:09:31 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 05:09:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 05:09:31 INFO - Python 2.7.3 05:09:31 INFO - Return code: 0 05:09:31 INFO - grabbing minidump binary from tooltool 05:09:31 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')]} 05:09:31 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 0x2378400>, '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 0x23793b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2379840>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 05:09:31 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 05:09:31 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 05:09:31 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 05:09:31 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 05:09:31 INFO - Return code: 0 05:09:31 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 05:09:31 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 05:09:31 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 05:09:31 INFO - ENV: RUST_BACKTRACE is now 1 05:09:31 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 05:09:31 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 05:09:31 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Nr157VxGRqChZrbb35e78w/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-034', '--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 05:09:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/Nr157VxGRqChZrbb35e78w/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-034 --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 05:09:31 INFO - Using env: {'DISPLAY': ':0', 05:09:31 INFO - 'HOME': '/home/cltbld', 05:09:31 INFO - 'LANG': 'en_US.UTF-8', 05:09:31 INFO - 'LANGUAGE': 'en_US:en', 05:09:31 INFO - 'LOGNAME': 'cltbld', 05:09:31 INFO - 'MAIL': '/var/mail/cltbld', 05:09:31 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 05:09:31 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 05:09:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:09:31 INFO - 'MOZ_NO_REMOTE': '1', 05:09:31 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 05:09:31 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:09:31 INFO - 'NO_EM_RESTART': '1', 05:09:31 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:09:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:09:31 INFO - 'PWD': '/builds/slave/test', 05:09:31 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 05:09:31 INFO - 'RUST_BACKTRACE': '1', 05:09:31 INFO - 'SHELL': '/bin/bash', 05:09:31 INFO - 'SHLVL': '1', 05:09:31 INFO - 'TERM': 'linux', 05:09:31 INFO - 'TMOUT': '86400', 05:09:31 INFO - 'USER': 'cltbld', 05:09:31 INFO - 'XDG_SESSION_COOKIE': 'd6bbd613908ccac0c6c9cb47000001f7-1490098099.210041-1547077723', 05:09:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:09:31 INFO - '_': '/tools/buildbot/bin/python'} 05:09:31 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Nr157VxGRqChZrbb35e78w/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-034', '--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 05:09:31 INFO - mozversion application_buildid: 20170321110313 05:09:31 INFO - mozversion application_changeset: 67ecac412f76a6bf229fead47b40eed69c146d61 05:09:31 INFO - mozversion application_display_name: Nightly 05:09:31 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 05:09:31 INFO - mozversion application_name: Firefox 05:09:31 INFO - mozversion application_remotingname: firefox 05:09:31 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 05:09:31 INFO - mozversion application_vendor: Mozilla 05:09:31 INFO - mozversion application_version: 55.0a1 05:09:31 INFO - mozversion platform_buildid: 20170321110313 05:09:31 INFO - mozversion platform_changeset: 67ecac412f76a6bf229fead47b40eed69c146d61 05:09:31 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 05:09:31 INFO - mozversion platform_version: 55.0a1 05:09:31 INFO - using testdate: 1490098171 05:09:31 INFO - actual date: 1490098171 05:09:31 INFO - starting webserver on 'localhost:60664' 05:09:31 INFO - SUITE-START | Running 2 tests 05:09:31 INFO - TEST-START | dromaeo_css 05:09:31 INFO - operating with platform_type : linux_ 05:09:31 INFO - Initialising browser for dromaeo_css test... 05:09:31 INFO - TEST-INFO | started process 17294 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpF_uUha/profile http://localhost:60664/getInfo.html) 05:09:35 INFO - PID 17294 | __metrics Screen width/height:1600/1200 05:09:35 INFO - PID 17294 | colorDepth:24 05:09:35 INFO - PID 17294 | Browser inner width/height: 1024/697 05:09:35 INFO - PID 17294 | __metrics 05:09:36 INFO - PID 17294 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 673: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 05:09:36 INFO - PID 17294 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 303: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 05:09:37 INFO - TEST-INFO | 17294: exit 0 05:09:37 INFO - Browser initialized. 05:09:37 INFO - Running cycle 1/1 for dromaeo_css test... 05:09:37 INFO - TEST-INFO | started process 17394 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpF_uUha/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 05:09:49 INFO - PID 17394 | RSS: Main: 144474112 05:09:49 INFO - PID 17394 | 05:12:51 INFO - PID 17394 | Cycle 1(1): loaded http://localhost:60664/tests/dromaeo/cssquery-dojo.html (next: http://localhost:60664/tests/dromaeo/cssquery-ext.html) 05:12:53 INFO - PID 17394 | RSS: Main: 336850944 05:12:53 INFO - PID 17394 | 05:14:39 INFO - PID 17394 | ************************* 05:14:39 INFO - PID 17394 | A coding exception was thrown and uncaught in a Task. 05:14:39 INFO - PID 17394 | 05:14:39 ERROR - PID 17394 | Full message: TypeError: NetworkError when attempting to fetch resource. 05:14:39 INFO - PID 17394 | Full stack: 05:14:39 INFO - PID 17394 | ************************* 05:15:56 INFO - PID 17394 | Cycle 1(1): loaded http://localhost:60664/tests/dromaeo/cssquery-ext.html (next: http://localhost:60664/tests/dromaeo/cssquery-jquery.html) 05:15:56 INFO - PID 17394 | RSS: Main: 232763392 05:15:56 INFO - PID 17394 | 05:18:58 INFO - PID 17394 | Cycle 1(1): loaded http://localhost:60664/tests/dromaeo/cssquery-jquery.html (next: http://localhost:60664/tests/dromaeo/cssquery-mootools.html) 05:18:59 INFO - PID 17394 | RSS: Main: 178450432 05:18:59 INFO - PID 17394 | 05:22:01 INFO - PID 17394 | Cycle 1(1): loaded http://localhost:60664/tests/dromaeo/cssquery-mootools.html (next: http://localhost:60664/tests/dromaeo/cssquery-prototype.html) 05:22:01 INFO - PID 17394 | RSS: Main: 177909760 05:22:01 INFO - PID 17394 | 05:25:04 INFO - PID 17394 | Cycle 1(1): loaded http://localhost:60664/tests/dromaeo/cssquery-prototype.html (next: http://localhost:60664/tests/dromaeo/cssquery-yui.html) 05:25:05 INFO - PID 17394 | RSS: Main: 182845440 05:25:05 INFO - PID 17394 | 05:28:07 INFO - PID 17394 | Cycle 1(1): loaded http://localhost:60664/tests/dromaeo/cssquery-yui.html (next: http://localhost:60664/tests/dromaeo/cssquery-dojo.html) 05:28:08 INFO - PID 17394 | RSS: Main: 270569472 05:28:08 INFO - PID 17394 | 05:28:08 INFO - PID 17394 | __start_tp_report 05:28:08 INFO - PID 17394 | _x_x_mozilla_page_load 05:28:08 INFO - PID 17394 | _x_x_mozilla_page_load_details 05:28:08 INFO - PID 17394 | |i|pagename|runs| 05:28:08 INFO - PID 17394 | |0;dojo.html;3251.7398608111353;3305.4711246200613;3329.66703329667;3335.4496508076168;3350.8324583770805;5571.470710282517;5651.632643878155;5754.597178197522;5759.366469688331;5793.855153621156;5582.106862901936;5615.101583746591;5617.747201375938;5741.995150848596;5809.2738407699035;5063.797448102072;5097.464766199551;5108.489151084899;5131.050755610206;5148.691078535281;5084.923726144111;5114.923276150861;5201.063808514466;5225.503577160182;5229.189475631264;5047.924281135786;5155.664881782672;5162.354705661793;5225.529702326789;5271.789128434877;5082.1360368737405;5113.105206588869;5119.692818430869;5142.794288228466;5203.557697595709;5132.024915266087;5153.123968925292;5154.201098829687;5165.276861239429;5217.50433708797;5642.7742890284335;5714.51426628737;5716.971415142939;5727.971360143172;5751.022326204556;6017.789377371815;6068.757249710006;6071.392860713938;6145.508359331243;6198.163247961513;6288.276848162428;6291.5281353898645;6297.6536290504;6301.558890877641;6314.526410519229;5823;5829.8251052468495;5830.883382332329;5833.708314584212;5882.529397648178;6108.50170232864;6160;6330.715117819709;6387.201599800025;6391.776287829904;5851.6781577012825;6117.694115294217;6124.418180272867;6133.346641381411;6135.04893764628;6025.186599809057;6029.517638588903;6128.575417880124;6183.598066125777;6187.907181392283;6127.785527506516;6174.938250617436;6181.041938499539;6185.41238582334;6190.535709821691;5968.552358573124;6189.381061893775;6193.597416167935;6199.659018754011;6200.131981522591;4648.97675511627;4727.929081063787;4754.358161648202;4754.833580824655;4777.928331075037;4182.958170418317;4198.580141985777;4200.264953633102;4202.85290014848;4235.555266697014;5831.910774452644;5832.445917637818;5837.182794408786;5837.737301821428;5890.49930755882;6008.909866352008;6031.24609423822;6173.783917562864;6203.16257305258;6242.063690446469;5853.590248682552;5865.912011319833;5867;5876.882462350729;5906.5570082244;5238.345206849144;5266.578673706094;5287.550558202596;5293.894122117613;5294.947050529522;6168.228971378578;6236.126942228001;6308.274548426806;6431.421172094534;6519.185101862267;6133.05924499315;6167.290761562298;6171.506279497719;6174.197354343906;6177.166082578974;6391.424771770563;6392.3927226913365;6392.744290228339;6407.871842563216;6412.775552855627;5920.407959204045;5996.910046349221;6027.246594175728;6072.392760723892;6082.452579267887;6148.139260503623;6162.383761623802;6206.937930620636;6219.533534984804;6221.346758590464;6064.393560644076;6065.514758819372;6078.817635470943;6083.6045657032155;6128.417800308964;5864.853378665567;5871.559633027455;5913.29040515141;5918.408159184047;5919.970400147971;5947.762089516544;5947.851303717269;5949.25634295713;5953.196318496947;5953.613015154001;5955.255593050869;5962.940370596239;5972.432618901197;5977.133315669291;5981.3719559445635;5904.261967254093;5940.28716553999;5944.821655350346;5990.191324171181;6007.48936340416 05:28:08 INFO - PID 17394 | |1;ext.html;673.3064943108596;737.2885165814987;744.8659241336558;753.4273951796633;773.2229109744706;27970.440591188162;28485.584734366155;28541.714582854165;28577.285567860814;28621.42757144856;35754.2849143017;36384.45423318646;36403.089922751875;36456.27087458249;36486;2529.936751581216;2530.860802655853;2532.670752802133;2545.5799793034125;2604.010476019115;2471.098049212034;2536.03630620364;2680.437108207269;2792.45547118312;2798.244473992021;2833.8724757385967;2897.406031763494;2907.4766542022426;2909.2872246299685;2912.2428168676192;2881.5389537673977;2916.3000879788697;2916.941661166765;2922.7077292270815;2930.60436841028;2236.3514580771557;2250.2911582851348;2645.4444566640836;2673.1980405878353;2673.79946504011;33680.83159584186;34342.82828585841;34403.655963440295;34413;34413.311733765186;2994.31130839908;3002.6396832380256;3008.638963324393;3026.3039500914692;3032.3177285110896;25614.487710245878;25663.74336256632;25701.742982570122;25809.61285580718;26423.735762642318;3457.3085382923264;3476.5654293213347;3483.947740783865;3485.3029394121277;3501.9124521887156;199578;199630;199747;199932;200515;49380.753096234286;49445.50554494481;49495.50504494981;49509.50490495049;49544.75227623839;51608.22587661188;51801.7409912948;51807;51813;51829.48170518322;13097.083204175617;13494.257815820225;13510.729785404237;13513.594592162252;13515.121517101357;10691.037806597444;10712.250142490107;10714.41070741101;10717.78564428707;10735.409552474688;10489.527971241312;10642.946785266024;12301.446434910451;12600.747985040249;13104.082714209913;5040.319556859777;5155.226715992631;5217.686938783685;5273.551748101378;5278;1025.8050970315617;1027.337367398039;1031.7626945802358;1044.5612842605972;1055.8099542082346;25155.87422062878;25461.36346591313;25471.872640636677;25551.744482555307;25610.359741006625;1101.6254473479055;1125.859267591551;1130.8416821644976;1161.4018780328138;1165.7143999719954;12828.615141545768;13101.239576515556;13199.20804751718;13200.14199077057;13256.867431325756;280179;282350;282634;283564.16435835377;283859;52700.20949685758;52780;53030.204546931825;53179.20231196535;53274.73362633162;1387.1191793211383;1447.536788227778;1460.2552698124034;1461.3423959218608;1473.8673519383092;23240.418989524722;23586.410339741644;24184.75815241825;24412.6338104925;24475.877620611784;38302.23395532018;38307.23385532218;38340.80829595834;38395;38441.231175376895;276485;276589;277069;277196;278842;32716;32934.505982409806;33033.17417064593;33178.834105829315;33207.833960830045;40927.38608920928;41097;41158;41384.793076034424;41434.58565414428;34209.82895085509;34275.657243427246;34337.484937726455;35189.29621407506;35202;34652.48021279733;35156;35279.294414111064;35310.64689353176;35433.82283088568;35735.98508390305;36218;36924;37260;37410.25179496449;29951.85024074953;31733.523997140524;31790.682093178773;31971.200719982186;32031.35937281195;24834.26823049427;25447.236582902544;25486.74513254918;25748.485030298914;25873.353166170997 05:28:08 INFO - PID 17394 | |2;jquery.html;384.6559679229538;433.98264069437226;440.4076517084522;441.22124450345126;462.56518872260074;18137.546561335974;19105.713414298778;20277.99999999998;21060.157593696233;21172.57654846902;14269.643258918532;20268.391948241577;20419.897900510477;20464.590708185828;22103.226387076455;4284.828606855722;4397.340398940152;4400.515943246241;4400.97799511002;4407.096545208225;4155.854545090922;4223.577642235782;4256;4300.1829652366105;4357.564243575649;4229.111886503838;4237.788110594473;4238.745675259479;4239.47006624172;4243.172581346638;4183.226103170923;4237.279662457389;4242.618164365206;4321.178975994551;4338.761368124768;3963.801809909522;3989.6608788252743;3990.900227494307;3992.061865461614;4081.7142800004012;25498;25709.871450642815;26106.86946565274;26273.605895911576;26303.605445918325;1999.5401057756796;2026.6858636911154;2030.46192758919;2034.2778313698573;2036.6028624418245;15524.301406436738;16165.757513637305;16337.754933675886;16942.745858812126;17102.914485427493;1875.5498680316762;1917.2331067573082;1921.1642935323039;1923.6056608395245;1934.216642259887;98352.50823745907;101959.4902025485;102637.48681256546;103736;105284;12092.334921579397;12315.568955086528;12413.31726755019;12483.812742808865;12880.227186368847;17641;17699.557511062325;17709;17727.202275897616;17752.46742597724;7322.3158673505395;7952.3638108951145;8004.51972881629;8300.377471689648;8330.083690794008;7262.874254490563;7378;7545.962270188724;7547.962260188774;7555.886661700079;7668.463207575416;7755.573443460551;7796.376289896794;8028.237317454832;8070.556119413489;2223.49971256466;2235.552889422122;2261.118163916074;2284.2804516577226;2381.5356005578747;993.9602415903283;994.4679596415883;1014.4319181258371;1016.898310168992;1034.7361422837128;19833.900830495757;20291.492712682302;20295.376369890375;20381.898090509454;20518.281860134823;1019.2559431614962;1019.8470229465639;1026.743314171457;1029.1355261580159;1052.147760314148;10158.492075396201;10910.727231819268;10912.945435272773;10957.342559446459;10976.396298203676;515685;548133;550886;571675;579973.503312086;86984;98399;100647.49676251572;103638.37265695815;106398.46800765947;1151.122909112315;1193.5524178433088;1212.8665846756849;1217.3122185965078;1217.5190799634272;16317.347306108097;16422.167889160803;16901.239444224793;16995.830041699424;17692;47127.76436117935;47534.04931901273;48136.89429073994;48380.274295886295;49031;60828.69585652043;61385.693071534355;62818.68590657017;63194.684026579576;64176;8972.013078561484;9112.95443522778;9113.225375843127;9260.768480788034;9676.371035882645;11875.168738188244;13055.738885222052;13343.599692009255;13344.332783360598;13798.17210967345;11724.88275117238;11829.408529573315;11854.762904741685;11900.285982841056;12247.816282755588;11731.648050558497;11840.467178976794;11954;12053.939730301643;12248.938755306523;12154.331511766584;12379.442925068213;12477;12577;12682.556110536087;9083.545822708971;9251.583678734338;9513.809723805347;9521.714348569554;9674.70975870725;12205.20666156697;12251.142420030512;12327.876721232673;12398.504059837505;12421.565245216374 05:28:08 INFO - PID 17394 | |3;mootools.html;1331.7403106394254;1369.5138225929795;1396.1274203622736;1401.5374926274324;1402.0466083063513;10396.636117735872;10768.946155269212;10771.892281077187;10786.838197427034;10787.946060269698;10560.577576896914;10821.945890270557;10881.183911206672;10891.83662245067;10893.618723344685;2345.566070277;2378.702662167229;2379.6311571706415;2384.7853693167613;2395.748446413119;2044.9386518404472;2115.3971118231307;2319.9652005219937;2381.0356805493716;2382.1781485387514;2369.514249578841;2429.7691719286727;2435.622478515833;2435.695538057743;2439.8170137239777;2348.3894187511287;2356.7643235676383;2364.8817559121976;2366.1008816649564;2373.169390713254;2301.309607117858;2309.711286089239;2325;2328.1269523928527;2428.8220213196587;11138.554457821678;11245.775084498264;11245.775084498346;11256.774864502664;11273.37996410197;6158.753649854;6324.272708638519;6339.1442155308905;6347.39699728525;6365.267994180682;3955.663768579674;3981.542122655903;4097.631213190827;4124.876253712393;4143.6892233082335;1244.3031902134833;1294.0876681939305;1335.986640133596;1343.523049317488;1356.5455572383264;16265.674686506321;16548.255328510248;16752.49742507727;16770.413035543697;16805.91597042007;5160.819371321985;5323.414424413311;5422.539084177889;5484.177373393943;5533.391326954032;12278.140530162982;12319.199252048587;12323;12328.876711232951;12337.383130843422;6310.400511951358;6315.147455093595;6328.525360597973;6334.683265836689;6343.460805831556;5616.803411880564;5672.971635141798;5703;5800.24596802413;5815.476607105296;4223.72545784523;4286.292761694285;4308.375285583573;4352.717073390219;4412.84555040572;1177.7821103095955;1196.347990345264;1266.9303188324732;1274.1144904291427;1322.7552902712837;813.0893399392718;839.8787618529332;869.6651789061257;875.7329014650466;903.1555495611624;6505.804825855232;6561.475081993429;6679.76620818269;6684.866302674017;6911.6544172791155;958.5782255807422;960.5437417226901;971.621067783565;975.7804493988796;981.3523074770617;4399.5160532341415;4499.460064792181;4605.194091034055;4640.164770341371;4738.123447162286;14432.278386080863;14834.184119873511;14845.480408185662;14863.405463781328;14873.92563037178;13847.515336963157;14323.355449004612;14334.21161836109;14665.193414362098;14776.778348324784;10088.899111008795;10304.33021853592;10321.122704570045;10367.896321036844;10375.896241037644;6873.690683919136;7218;7242.3843973262865;7243.23945985685;7260;13048.41282142287;13189.868101318863;13273.137246078973;13488.595342139752;13488.73022539524;12621.432035558606;12728.61814145577;12914.031447641277;13360.398782054637;13633.931830341182;9219.400738951947;9309.44143351401;9369.156775890202;9400.29497787655;9454.621815127319;10356.275060745675;10397.220208484545;10458;10459.424731639832;10508.894911050791;7517.812054698677;9075.27397808187;9103.90896091057;9112.726618201465;9322.114399132071;8660.437071590326;8819.735407937773;8861.158189971942;8867.201951824109;8918.687845925362;8017.318527925192;8044.919550804417;8075.111737708965;8122.634481448231;8139.674413023413;6191;6245.156903818108;6250.499960003098;6294.748210071546;6455.709493072917;5882.5293976480925;6065.8180254592435;6076.088586712029;6232.470240029648;6292.433680968735 05:28:08 INFO - PID 17394 | |4;prototype.html;401.9236345094434;404.50044195418656;404.98785036448896;409.26610243572935;411.66449343784814;5738.913916291253;5788.218590490283;5814.418558144189;5822.737976791049;5836.270466191726;5144.562712169461;5678.5741069419855;5710.714464276791;5742.454466825655;5761.4814666679995;4561.475430325505;4562.676823721117;4566.8629941101735;4567.584048944821;4581.977090114545;4560.2019646561885;4575.22221222393;4593.150267200579;4597.126545956275;4611.907761844761;4473.485549161839;4494.662900282492;4508.752018638974;4530.682852200347;4553.977230113845;4523.231050721369;4528.3886675298745;4541.704789188709;4544.113897789933;4544.590986811169;4120.814563344657;4122.40225167349;4127.153933443667;4143.647789937829;4153.1070819773595;5460.290162278918;5570.749316280777;5585.636933599303;5602.971985140089;5618.185363122325;5310.522053015247;5319.5744340452675;5327.413984461706;5335.039692855285;5335.5464785492895;5909.674967876765;6087.05650624154;6087.391260873921;6102.237220347457;6124.049987757871;4531.501534831166;4537.909241815179;4556.3393307970155;4566.995261042599;4574.794134263966;6090.33006369299;6305.9999999999545;6307.27466341372;6336.809895703136;6339.58792678479;4406.162829062468;4595.9080818383445;4614.676972611885;4614.930776038362;4688.038952014829;4718.41019872516;4752.881177970509;4758.500357462417;4760.45254795696;4768.6661933665;4932.880720591447;5041.420236672756;5299.49654782795;5320.228566857862;5339.038972984822;6126.509879209652;6142.648617304186;6146.508279337642;6151.876962460726;6184.134221209034;1616.5473667373155;1655.9420420285232;1668.57451349905;1673.9748903766454;1675.9245833937503;1146.0659562456572;1159.2464897816487;1174.3541052421135;1175.7707247086737;1183.875693052217;5817.76728930838;5831.854203644858;5840.5035571976005;5842.503387212049;5849.181114643953;6233.594816336924;6243.875122497525;6244.594101383395;6252.499800015988;6272.153259310026;5553.16702494629;5837.620554663933;5843.912341314884;5869.73586188614;5898.469137777621;3301.5873015873017;3325.5011748237957;3326.850291736829;3335.7831740936763;3348.1964328561457;6303;6474.546781725328;6551.312112228243;6560.475161987029;6586.6377349245295;6349.873002539924;6358.300586935434;6363.949948258485;6376.330485298977;6402.359764023654;6483.643399613066;6486.610803351814;6493.480521558264;6498.935010649928;6509;5941.37615550361;6206.937930620636;6288.434040936338;6290.308066112632;6316.368363163647;6228.314885362516;6245.531585131224;6263.185785847811;6264.5301602379095;6303.747850085945;5709.885802284014;6046.27444706638;6438.806835794933;6462.515311351762;6525;4386.232409328419;4408.404865343266;4424.446944131983;4430.579094985971;4444.200043992112;6207.6275423474735;6236.126942228182;6284.214473190851;6311.053341998553;6332.715027823667;6073.514118870568;6094.421030002142;6139;6154.969225153845;6157;6073.210482637229;6088.51291896656;6110.388961103854;6132.601380910227;6145.66198859067;5788.334341550607;6062.969685151546;6126.866529692022;6130.754769809158;6133.110698948538;6146.416090471398;6158.414950579688;6168.321484636776;6176.258848938156;6191.1641928339095;5882.911756323744;5893.116032595145;5964.493018093511;5982.46157845796;5984.371640977634 05:28:08 INFO - PID 17394 | |5;yui.html;669.3406994110803;674.1640365946229;717.5658726470485;747.8242612985947;782.1044903585397;13586.796198057036;14045.719085618282;15874.047557146565;16470.83529164708;16689.91655041726;14974.475893343735;15021.549353519385;15202.923985380057;15480.845191548082;15610;828.3000864269698;842.1746688245523;843.1694780641094;844.3414136973171;846.6697987784769;832.3258160889668;844.5270648436864;850.5662112322728;852.2031900173326;853.4751128056232;882.5234373438335;887.1660638999319;887.1970866365949;888.2760550151638;888.471359541072;882.0121463960373;882.6778225947515;884.2130503851578;885.313881741649;886.0209468537238;647.7409036385436;648.0376640688573;648.1153225846732;648.2350826025288;648.610833499901;15530.767038494432;15548.533543993699;15879.444219452263;15981.920090399473;16149.838501615068;14488.637784055378;14742.852571474255;14784.260786960609;15285.312160952784;15466.690666186612;11337.43312834355;11387.25982811123;11543.365114918675;11667.241629294154;12280.570180043745;3027.5206591061283;3040.771942104329;3130.2330928922333;3193.0740085375214;3197.904062878117;84187;84226.57886710588;84877.15122848754;85673.57163214206;87860;11993.64019079429;12043;12290.569830055905;12378.257304561756;12396.690082747824;22309;22314.55370892573;22424.18788805907;22463.101475941105;22861.19985800489;7844.84310313802;7855.960720196476;7872.56700881457;7940.960295198487;8020.598970051474;3911.9022024449046;3939.1727737175515;3987.1427643056304;4012.3580227163516;4113.650339721097;4159.750414975111;4259.42497762798;4565.474970378449;4683.2038553446;4706.976465117653;878.8549889268327;887.086301109845;890.9242714369351;894.1282249806387;914.0950459045497;629.8645791154833;634.4765568406084;652.1522021372197;654.8035589323184;659.4262991197593;9886.505674716236;10118.241131914989;10165.796684066278;10202.857399945946;10297.74255643615;585.9824205273763;602.6534742523066;609.4932286788842;612.8314713453747;614.1402037147939;4729.858104256878;4838.806447742121;4855.8057677693205;4870.853874383774;4871.171900776876;54410.183847242326;69336.65331673309;74269.6286518564;75426;77748.61125694448;65132;66147.33852661509;66342;66678.33146696506;69121;46354.30468542974;46759.766201169456;57218;59892;60811.087833681646;10158.949205253926;10693.867396442343;10866.13070954306;10884.836727448936;10963.122950164126;28894.7110528892;28984.420311594073;31164;32257.677423226407;32409.52233390209;51208;51430;51687.48312516827;52558.47441525536;52698.736506317226;13924.930375348464;13939.372728227458;13975.930120349332;14109.647258818612;14464.20446875432;15056.397744090551;15313.846861531687;15383.538493845203;16126;16160.353585856434;13487.460501579826;14119;14216.21810800416;14307.71384572282;15133.394664213309;13650.385732641857;13784.241866697026;14059.702079931072;14171.149731016172;14756.188409637572;13330.600081997556;13936.79094813599;14096.436142554183;14420.206888621227;14558.563243102724;11704.565309637184;12041.217320874115;12379.75240495203;12379.814302785286;12519.93740031294;11516.136289778133;11656.18406711556;11728.530858765895;11851.969693956455;11932.940335298268 05:28:08 INFO - PID 17394 | __end_tp_report 05:28:08 INFO - PID 17394 | __start_cc_report 05:28:08 INFO - PID 17394 | _x_x_mozilla_cycle_collect,2004 05:28:08 INFO - PID 17394 | __end_cc_report 05:28:08 INFO - PID 17394 | __startTimestamp1490099288173__endTimestamp 05:28:08 INFO - PID 17394 | 05:28:08 INFO - PID 17394 | ------- Summary: start ------- 05:28:08 INFO - PID 17394 | Number of tests: 6 05:28:08 INFO - PID 17394 | 05:28:08 INFO - PID 17394 | [#0] dojo.html Cycles:165 Average:5703.27 Median:5920.41 stddev:661.38 (11.2%) stddev-sans-first:634.83 05:28:08 INFO - PID 17394 | Values: 3251.7 3305.5 3329.7 3335.4 3350.8 5571.5 5651.6 5754.6 5759.4 5793.9 5582.1 5615.1 5617.7 5742.0 5809.3 5063.8 5097.5 5108.5 5131.1 5148.7 5084.9 5114.9 5201.1 5225.5 5229.2 5047.9 5155.7 5162.4 5225.5 5271.8 5082.1 5113.1 5119.7 5142.8 5203.6 5132.0 5153.1 5154.2 5165.3 5217.5 5642.8 5714.5 5717.0 5728.0 5751.0 6017.8 6068.8 6071.4 6145.5 6198.2 6288.3 6291.5 6297.7 6301.6 6314.5 5823.0 5829.8 5830.9 5833.7 5882.5 6108.5 6160.0 6330.7 6387.2 6391.8 5851.7 6117.7 6124.4 6133.3 6135.0 6025.2 6029.5 6128.6 6183.6 6187.9 6127.8 6174.9 6181.0 6185.4 6190.5 5968.6 6189.4 6193.6 6199.7 6200.1 4649.0 4727.9 4754.4 4754.8 4777.9 4183.0 4198.6 4200.3 4202.9 4235.6 5831.9 5832.4 5837.2 5837.7 5890.5 6008.9 6031.2 6173.8 6203.2 6242.1 5853.6 5865.9 5867.0 5876.9 5906.6 5238.3 5266.6 5287.6 5293.9 5294.9 6168.2 6236.1 6308.3 6431.4 6519.2 6133.1 6167.3 6171.5 6174.2 6177.2 6391.4 6392.4 6392.7 6407.9 6412.8 5920.4 5996.9 6027.2 6072.4 6082.5 6148.1 6162.4 6206.9 6219.5 6221.3 6064.4 6065.5 6078.8 6083.6 6128.4 5864.9 5871.6 5913.3 5918.4 5920.0 5947.8 5947.9 5949.3 5953.2 5953.6 5955.3 5962.9 5972.4 5977.1 5981.4 5904.3 5940.3 5944.8 5990.2 6007.5 05:28:08 INFO - PID 17394 | 05:28:08 INFO - PID 17394 | [#1] ext.html Cycles:180 Average:40078.68 Median:15751.48 stddev:67334.42 (427.5%) stddev-sans-first:67458.31 05:28:08 INFO - PID 17394 | Values: 673.3 737.3 744.9 753.4 773.2 27970.4 28485.6 28541.7 28577.3 28621.4 35754.3 36384.5 36403.1 36456.3 36486.0 2529.9 2530.9 2532.7 2545.6 2604.0 2471.1 2536.0 2680.4 2792.5 2798.2 2833.9 2897.4 2907.5 2909.3 2912.2 2881.5 2916.3 2916.9 2922.7 2930.6 2236.4 2250.3 2645.4 2673.2 2673.8 33680.8 34342.8 34403.7 34413.0 34413.3 2994.3 3002.6 3008.6 3026.3 3032.3 25614.5 25663.7 25701.7 25809.6 26423.7 3457.3 3476.6 3483.9 3485.3 3501.9 199578.0 199630.0 199747.0 199932.0 200515.0 49380.8 49445.5 49495.5 49509.5 49544.8 51608.2 51801.7 51807.0 51813.0 51829.5 13097.1 13494.3 13510.7 13513.6 13515.1 10691.0 10712.3 10714.4 10717.8 10735.4 10489.5 10642.9 12301.4 12600.7 13104.1 5040.3 5155.2 5217.7 5273.6 5278.0 1025.8 1027.3 1031.8 1044.6 1055.8 25155.9 25461.4 25471.9 25551.7 25610.4 1101.6 1125.9 1130.8 1161.4 1165.7 12828.6 13101.2 13199.2 13200.1 13256.9 280179.0 282350.0 282634.0 283564.2 283859.0 52700.2 52780.0 53030.2 53179.2 53274.7 1387.1 1447.5 1460.3 1461.3 1473.9 23240.4 23586.4 24184.8 24412.6 24475.9 38302.2 38307.2 38340.8 38395.0 38441.2 276485.0 276589.0 277069.0 277196.0 278842.0 32716.0 32934.5 33033.2 33178.8 33207.8 40927.4 41097.0 41158.0 41384.8 41434.6 34209.8 34275.7 34337.5 35189.3 35202.0 34652.5 35156.0 35279.3 35310.6 35433.8 35736.0 36218.0 36924.0 37260.0 37410.3 29951.9 31733.5 31790.7 31971.2 32031.4 24834.3 25447.2 25486.7 25748.5 25873.4 05:28:08 INFO - PID 17394 | 05:28:08 INFO - PID 17394 | [#2] jquery.html Cycles:180 Average:32222.57 Median:20491.44 stddev:91550.50 (446.8%) stddev-sans-first:91776.11 05:28:08 INFO - PID 17394 | Values: 384.7 434.0 440.4 441.2 462.6 18137.5 19105.7 20278.0 21060.2 21172.6 14269.6 20268.4 20419.9 20464.6 22103.2 4284.8 4397.3 4400.5 4401.0 4407.1 4155.9 4223.6 4256.0 4300.2 4357.6 4229.1 4237.8 4238.7 4239.5 4243.2 4183.2 4237.3 4242.6 4321.2 4338.8 3963.8 3989.7 3990.9 3992.1 4081.7 25498.0 25709.9 26106.9 26273.6 26303.6 1999.5 2026.7 2030.5 2034.3 2036.6 15524.3 16165.8 16337.8 16942.7 17102.9 1875.5 1917.2 1921.2 1923.6 1934.2 98352.5 101959.5 102637.5 103736.0 105284.0 12092.3 12315.6 12413.3 12483.8 12880.2 17641.0 17699.6 17709.0 17727.2 17752.5 7322.3 7952.4 8004.5 8300.4 8330.1 7262.9 7378.0 7546.0 7548.0 7555.9 7668.5 7755.6 7796.4 8028.2 8070.6 2223.5 2235.6 2261.1 2284.3 2381.5 994.0 994.5 1014.4 1016.9 1034.7 19833.9 20291.5 20295.4 20381.9 20518.3 1019.3 1019.8 1026.7 1029.1 1052.1 10158.5 10910.7 10912.9 10957.3 10976.4 515685.0 548133.0 550886.0 571675.0 579973.5 86984.0 98399.0 100647.5 103638.4 106398.5 1151.1 1193.6 1212.9 1217.3 1217.5 16317.3 16422.2 16901.2 16995.8 17692.0 47127.8 47534.0 48136.9 48380.3 49031.0 60828.7 61385.7 62818.7 63194.7 64176.0 8972.0 9113.0 9113.2 9260.8 9676.4 11875.2 13055.7 13343.6 13344.3 13798.2 11724.9 11829.4 11854.8 11900.3 12247.8 11731.6 11840.5 11954.0 12053.9 12248.9 12154.3 12379.4 12477.0 12577.0 12682.6 9083.5 9251.6 9513.8 9521.7 9674.7 12205.2 12251.1 12327.9 12398.5 12421.6 05:28:08 INFO - PID 17394 | 05:28:08 INFO - PID 17394 | [#3] mootools.html Cycles:180 Average:7040.47 Median:2429.30 stddev:4430.90 (182.4%) stddev-sans-first:4422.57 05:28:08 INFO - PID 17394 | Values: 1331.7 1369.5 1396.1 1401.5 1402.0 10396.6 10768.9 10771.9 10786.8 10787.9 10560.6 10821.9 10881.2 10891.8 10893.6 2345.6 2378.7 2379.6 2384.8 2395.7 2044.9 2115.4 2320.0 2381.0 2382.2 2369.5 2429.8 2435.6 2435.7 2439.8 2348.4 2356.8 2364.9 2366.1 2373.2 2301.3 2309.7 2325.0 2328.1 2428.8 11138.6 11245.8 11245.8 11256.8 11273.4 6158.8 6324.3 6339.1 6347.4 6365.3 3955.7 3981.5 4097.6 4124.9 4143.7 1244.3 1294.1 1336.0 1343.5 1356.5 16265.7 16548.3 16752.5 16770.4 16805.9 5160.8 5323.4 5422.5 5484.2 5533.4 12278.1 12319.2 12323.0 12328.9 12337.4 6310.4 6315.1 6328.5 6334.7 6343.5 5616.8 5673.0 5703.0 5800.2 5815.5 4223.7 4286.3 4308.4 4352.7 4412.8 1177.8 1196.3 1266.9 1274.1 1322.8 813.1 839.9 869.7 875.7 903.2 6505.8 6561.5 6679.8 6684.9 6911.7 958.6 960.5 971.6 975.8 981.4 4399.5 4499.5 4605.2 4640.2 4738.1 14432.3 14834.2 14845.5 14863.4 14873.9 13847.5 14323.4 14334.2 14665.2 14776.8 10088.9 10304.3 10321.1 10367.9 10375.9 6873.7 7218.0 7242.4 7243.2 7260.0 13048.4 13189.9 13273.1 13488.6 13488.7 12621.4 12728.6 12914.0 13360.4 13633.9 9219.4 9309.4 9369.2 9400.3 9454.6 10356.3 10397.2 10458.0 10459.4 10508.9 7517.8 9075.3 9103.9 9112.7 9322.1 8660.4 8819.7 8861.2 8867.2 8918.7 8017.3 8044.9 8075.1 8122.6 8139.7 6191.0 6245.2 6250.5 6294.7 6455.7 5882.5 6065.8 6076.1 6232.5 6292.4 05:28:08 INFO - PID 17394 | 05:28:08 INFO - PID 17394 | [#4] prototype.html Cycles:180 Average:5161.12 Median:5816.09 stddev:1478.70 (25.4%) stddev-sans-first:1439.06 05:28:08 INFO - PID 17394 | Values: 401.9 404.5 405.0 409.3 411.7 5738.9 5788.2 5814.4 5822.7 5836.3 5144.6 5678.6 5710.7 5742.5 5761.5 4561.5 4562.7 4566.9 4567.6 4582.0 4560.2 4575.2 4593.2 4597.1 4611.9 4473.5 4494.7 4508.8 4530.7 4554.0 4523.2 4528.4 4541.7 4544.1 4544.6 4120.8 4122.4 4127.2 4143.6 4153.1 5460.3 5570.7 5585.6 5603.0 5618.2 5310.5 5319.6 5327.4 5335.0 5335.5 5909.7 6087.1 6087.4 6102.2 6124.0 4531.5 4537.9 4556.3 4567.0 4574.8 6090.3 6306.0 6307.3 6336.8 6339.6 4406.2 4595.9 4614.7 4614.9 4688.0 4718.4 4752.9 4758.5 4760.5 4768.7 4932.9 5041.4 5299.5 5320.2 5339.0 6126.5 6142.6 6146.5 6151.9 6184.1 1616.5 1655.9 1668.6 1674.0 1675.9 1146.1 1159.2 1174.4 1175.8 1183.9 5817.8 5831.9 5840.5 5842.5 5849.2 6233.6 6243.9 6244.6 6252.5 6272.2 5553.2 5837.6 5843.9 5869.7 5898.5 3301.6 3325.5 3326.9 3335.8 3348.2 6303.0 6474.5 6551.3 6560.5 6586.6 6349.9 6358.3 6363.9 6376.3 6402.4 6483.6 6486.6 6493.5 6498.9 6509.0 5941.4 6206.9 6288.4 6290.3 6316.4 6228.3 6245.5 6263.2 6264.5 6303.7 5709.9 6046.3 6438.8 6462.5 6525.0 4386.2 4408.4 4424.4 4430.6 4444.2 6207.6 6236.1 6284.2 6311.1 6332.7 6073.5 6094.4 6139.0 6155.0 6157.0 6073.2 6088.5 6110.4 6132.6 6145.7 5788.3 6063.0 6126.9 6130.8 6133.1 6146.4 6158.4 6168.3 6176.3 6191.2 5882.9 5893.1 5964.5 5982.5 5984.4 05:28:08 INFO - PID 17394 | 05:28:08 INFO - PID 17394 | [#5] yui.html Cycles:180 Average:17084.31 Median:3963.16 stddev:21320.39 (538.0%) stddev-sans-first:21344.57 05:28:08 INFO - PID 17394 | Values: 669.3 674.2 717.6 747.8 782.1 13586.8 14045.7 15874.0 16470.8 16689.9 14974.5 15021.5 15202.9 15480.8 15610.0 828.3 842.2 843.2 844.3 846.7 832.3 844.5 850.6 852.2 853.5 882.5 887.2 887.2 888.3 888.5 882.0 882.7 884.2 885.3 886.0 647.7 648.0 648.1 648.2 648.6 15530.8 15548.5 15879.4 15981.9 16149.8 14488.6 14742.9 14784.3 15285.3 15466.7 11337.4 11387.3 11543.4 11667.2 12280.6 3027.5 3040.8 3130.2 3193.1 3197.9 84187.0 84226.6 84877.2 85673.6 87860.0 11993.6 12043.0 12290.6 12378.3 12396.7 22309.0 22314.6 22424.2 22463.1 22861.2 7844.8 7856.0 7872.6 7941.0 8020.6 3911.9 3939.2 3987.1 4012.4 4113.7 4159.8 4259.4 4565.5 4683.2 4707.0 878.9 887.1 890.9 894.1 914.1 629.9 634.5 652.2 654.8 659.4 9886.5 10118.2 10165.8 10202.9 10297.7 586.0 602.7 609.5 612.8 614.1 4729.9 4838.8 4855.8 4870.9 4871.2 54410.2 69336.7 74269.6 75426.0 77748.6 65132.0 66147.3 66342.0 66678.3 69121.0 46354.3 46759.8 57218.0 59892.0 60811.1 10158.9 10693.9 10866.1 10884.8 10963.1 28894.7 28984.4 31164.0 32257.7 32409.5 51208.0 51430.0 51687.5 52558.5 52698.7 13924.9 13939.4 13975.9 14109.6 14464.2 15056.4 15313.8 15383.5 16126.0 16160.4 13487.5 14119.0 14216.2 14307.7 15133.4 13650.4 13784.2 14059.7 14171.1 14756.2 13330.6 13936.8 14096.4 14420.2 14558.6 11704.6 12041.2 12379.8 12379.8 12519.9 11516.1 11656.2 11728.5 11852.0 11932.9 05:28:08 INFO - PID 17394 | -------- Summary: end -------- 05:28:08 INFO - PID 17394 | 05:28:09 INFO - TEST-INFO | 17394: exit 0 05:28:09 INFO - TEST-OK | dromaeo_css | took 1117595ms 05:28:09 INFO - TEST-START | kraken 05:28:09 INFO - operating with platform_type : linux_ 05:28:09 INFO - Initialising browser for kraken test... 05:28:09 INFO - TEST-INFO | started process 17722 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpHW0m0d/profile http://localhost:60664/getInfo.html) 05:28:13 INFO - PID 17722 | __metrics Screen width/height:1600/1200 05:28:13 INFO - PID 17722 | colorDepth:24 05:28:13 INFO - PID 17722 | Browser inner width/height: 1024/697 05:28:13 INFO - PID 17722 | __metrics 05:28:14 INFO - PID 17722 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 673: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 05:28:14 INFO - PID 17722 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 303: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 05:28:15 INFO - TEST-INFO | 17722: exit 0 05:28:15 INFO - Browser initialized. 05:28:15 INFO - Running cycle 1/1 for kraken test... 05:28:15 INFO - TEST-INFO | started process 17815 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpHW0m0d/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 05:28:27 INFO - PID 17815 | RSS: Main: 144392192 05:28:27 INFO - PID 17815 | 05:28:29 INFO - PID 17815 | Cycle 1(1): loaded http://localhost:60664/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:60664/tests/kraken/driver.html?testName=audio-beat-detection) 05:28:30 INFO - PID 17815 | RSS: Main: 200802304 05:28:30 INFO - PID 17815 | 05:28:33 INFO - PID 17815 | Cycle 1(1): loaded http://localhost:60664/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:60664/tests/kraken/driver.html?testName=audio-dft) 05:28:33 INFO - PID 17815 | RSS: Main: 180170752 05:28:33 INFO - PID 17815 | 05:28:36 INFO - PID 17815 | Cycle 1(1): loaded http://localhost:60664/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:60664/tests/kraken/driver.html?testName=audio-fft) 05:28:37 INFO - PID 17815 | RSS: Main: 261181440 05:28:37 INFO - PID 17815 | 05:28:39 INFO - PID 17815 | Cycle 1(1): loaded http://localhost:60664/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:60664/tests/kraken/driver.html?testName=audio-oscillator) 05:28:39 INFO - PID 17815 | RSS: Main: 173056000 05:28:39 INFO - PID 17815 | 05:28:41 INFO - PID 17815 | Cycle 1(1): loaded http://localhost:60664/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:60664/tests/kraken/driver.html?testName=imaging-gaussian-blur) 05:28:42 INFO - PID 17815 | RSS: Main: 175734784 05:28:42 INFO - PID 17815 | 05:28:45 INFO - PID 17815 | Cycle 1(1): loaded http://localhost:60664/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:60664/tests/kraken/driver.html?testName=imaging-darkroom) 05:28:46 INFO - PID 17815 | RSS: Main: 215408640 05:28:46 INFO - PID 17815 | 05:28:49 INFO - PID 17815 | Cycle 1(1): loaded http://localhost:60664/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:60664/tests/kraken/driver.html?testName=imaging-desaturate) 05:28:50 INFO - PID 17815 | RSS: Main: 229425152 05:28:50 INFO - PID 17815 | 05:28:53 INFO - PID 17815 | Cycle 1(1): loaded http://localhost:60664/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:60664/tests/kraken/driver.html?testName=json-parse-financial) 05:28:53 INFO - PID 17815 | RSS: Main: 240807936 05:28:53 INFO - PID 17815 | 05:28:55 INFO - PID 17815 | Cycle 1(1): loaded http://localhost:60664/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:60664/tests/kraken/driver.html?testName=json-stringify-tinderbox) 05:28:55 INFO - PID 17815 | RSS: Main: 178565120 05:28:55 INFO - PID 17815 | 05:28:57 INFO - PID 17815 | Cycle 1(1): loaded http://localhost:60664/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:60664/tests/kraken/driver.html?testName=stanford-crypto-aes) 05:28:58 INFO - PID 17815 | RSS: Main: 185450496 05:28:58 INFO - PID 17815 | 05:29:00 INFO - PID 17815 | Cycle 1(1): loaded http://localhost:60664/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:60664/tests/kraken/driver.html?testName=stanford-crypto-ccm) 05:29:00 INFO - PID 17815 | RSS: Main: 194613248 05:29:00 INFO - PID 17815 | 05:29:03 INFO - PID 17815 | Cycle 1(1): loaded http://localhost:60664/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:60664/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 05:29:04 INFO - PID 17815 | RSS: Main: 203526144 05:29:04 INFO - PID 17815 | 05:29:07 INFO - PID 17815 | Cycle 1(1): loaded http://localhost:60664/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:60664/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 05:29:07 INFO - PID 17815 | RSS: Main: 200069120 05:29:07 INFO - PID 17815 | 05:29:09 INFO - PID 17815 | Cycle 1(1): loaded http://localhost:60664/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:60664/tests/kraken/driver.html?testName=ai-astar) 05:29:09 INFO - PID 17815 | RSS: Main: 267853824 05:29:09 INFO - PID 17815 | 05:29:09 INFO - PID 17815 | __start_tp_report 05:29:09 INFO - PID 17815 | _x_x_mozilla_page_load 05:29:09 INFO - PID 17815 | _x_x_mozilla_page_load_details 05:29:09 INFO - PID 17815 | |i|pagename|runs| 05:29:09 INFO - PID 17815 | |0;ai-astar;102;108;109;110;112;108;111;110;111;110 05:29:09 INFO - PID 17815 | |1;audio-beat-detection;149;118;116;161;120;120;118;116;138;118 05:29:09 INFO - PID 17815 | |2;audio-dft;161;164;161;161;162;163;161;162;162;161 05:29:09 INFO - PID 17815 | |3;audio-fft;75;77;75;109;75;75;74;74;103;74 05:29:09 INFO - PID 17815 | |4;audio-oscillator;83;83;115;83;82;83;102;82;83;102 05:29:09 INFO - PID 17815 | |5;imaging-gaussian-blur;114;113;113;114;113;112;114;113;113;113 05:29:09 INFO - PID 17815 | |6;imaging-darkroom;147;147;146;147;146;146;147;147;148;146 05:29:09 INFO - PID 17815 | |7;imaging-desaturate;94;94;94;95;94;94;94;94;94;94 05:29:09 INFO - PID 17815 | |8;json-parse-financial;57;58;57;57;60;59;59;58;58;58 05:29:09 INFO - PID 17815 | |9;json-stringify-tinderbox;54;55;54;54;54;54;54;55;54;54 05:29:09 INFO - PID 17815 | |10;stanford-crypto-aes;81;81;83;80;89;89;79;81;81;79 05:29:09 INFO - PID 17815 | |11;stanford-crypto-ccm;127;129;139;135;136;126;136;129;184;136 05:29:09 INFO - PID 17815 | |12;stanford-crypto-pbkdf2;195;181;184;197;181;194;188;195;191;184 05:29:09 INFO - PID 17815 | |13;stanford-crypto-sha256-iterative;65;67;66;66;67;67;65;65;66;66 05:29:09 INFO - PID 17815 | __end_tp_report 05:29:09 INFO - PID 17815 | __start_cc_report 05:29:09 INFO - PID 17815 | _x_x_mozilla_cycle_collect,1758 05:29:09 INFO - PID 17815 | __end_cc_report 05:29:09 INFO - PID 17815 | __startTimestamp1490099349776__endTimestamp 05:29:09 INFO - PID 17815 | 05:29:09 INFO - PID 17815 | ------- Summary: start ------- 05:29:09 INFO - PID 17815 | Number of tests: 14 05:29:09 INFO - PID 17815 | 05:29:09 INFO - PID 17815 | [#0] ai-astar Cycles:10 Average:109.10 Median:110.00 stddev:2.81 (2.6%) stddev-sans-first:1.36 05:29:09 INFO - PID 17815 | Values: 102.0 108.0 109.0 110.0 112.0 108.0 111.0 110.0 111.0 110.0 05:29:09 INFO - PID 17815 | 05:29:09 INFO - PID 17815 | [#1] audio-beat-detection Cycles:10 Average:127.40 Median:120.00 stddev:16.13 (13.4%) stddev-sans-first:15.10 05:29:09 INFO - PID 17815 | Values: 149.0 118.0 116.0 161.0 120.0 120.0 118.0 116.0 138.0 118.0 05:29:09 INFO - PID 17815 | 05:29:09 INFO - PID 17815 | [#2] audio-dft Cycles:10 Average:161.80 Median:162.00 stddev:1.03 (0.6%) stddev-sans-first:1.05 05:29:09 INFO - PID 17815 | Values: 161.0 164.0 161.0 161.0 162.0 163.0 161.0 162.0 162.0 161.0 05:29:09 INFO - PID 17815 | 05:29:09 INFO - PID 17815 | [#3] audio-fft Cycles:10 Average:81.10 Median:75.00 stddev:13.23 (17.6%) stddev-sans-first:13.85 05:29:09 INFO - PID 17815 | Values: 75.0 77.0 75.0 109.0 75.0 75.0 74.0 74.0 103.0 74.0 05:29:09 INFO - PID 17815 | 05:29:09 INFO - PID 17815 | [#4] audio-oscillator Cycles:10 Average:89.80 Median:83.00 stddev:11.95 (14.4%) stddev-sans-first:12.42 05:29:09 INFO - PID 17815 | Values: 83.0 83.0 115.0 83.0 82.0 83.0 102.0 82.0 83.0 102.0 05:29:09 INFO - PID 17815 | 05:29:09 INFO - PID 17815 | [#5] imaging-gaussian-blur Cycles:10 Average:113.20 Median:113.00 stddev:0.63 (0.6%) stddev-sans-first:0.60 05:29:09 INFO - PID 17815 | Values: 114.0 113.0 113.0 114.0 113.0 112.0 114.0 113.0 113.0 113.0 05:29:09 INFO - PID 17815 | 05:29:09 INFO - PID 17815 | [#6] imaging-darkroom Cycles:10 Average:146.70 Median:147.00 stddev:0.67 (0.5%) stddev-sans-first:0.71 05:29:09 INFO - PID 17815 | Values: 147.0 147.0 146.0 147.0 146.0 146.0 147.0 147.0 148.0 146.0 05:29:09 INFO - PID 17815 | 05:29:09 INFO - PID 17815 | [#7] imaging-desaturate Cycles:10 Average:94.10 Median:94.00 stddev:0.32 (0.3%) stddev-sans-first:0.33 05:29:09 INFO - PID 17815 | Values: 94.0 94.0 94.0 95.0 94.0 94.0 94.0 94.0 94.0 94.0 05:29:09 INFO - PID 17815 | 05:29:09 INFO - PID 17815 | [#8] json-parse-financial Cycles:10 Average:58.10 Median:58.00 stddev:0.99 (1.7%) stddev-sans-first:0.97 05:29:09 INFO - PID 17815 | Values: 57.0 58.0 57.0 57.0 60.0 59.0 59.0 58.0 58.0 58.0 05:29:09 INFO - PID 17815 | 05:29:09 INFO - PID 17815 | [#9] json-stringify-tinderbox Cycles:10 Average:54.20 Median:54.00 stddev:0.42 (0.8%) stddev-sans-first:0.44 05:29:09 INFO - PID 17815 | Values: 54.0 55.0 54.0 54.0 54.0 54.0 54.0 55.0 54.0 54.0 05:29:09 INFO - PID 17815 | 05:29:09 INFO - PID 17815 | [#10] stanford-crypto-aes Cycles:10 Average:82.30 Median:81.00 stddev:3.71 (4.6%) stddev-sans-first:3.91 05:29:09 INFO - PID 17815 | Values: 81.0 81.0 83.0 80.0 89.0 89.0 79.0 81.0 81.0 79.0 05:29:09 INFO - PID 17815 | 05:29:09 INFO - PID 17815 | [#11] stanford-crypto-ccm Cycles:10 Average:137.70 Median:136.00 stddev:16.88 (12.4%) stddev-sans-first:17.45 05:29:09 INFO - PID 17815 | Values: 127.0 129.0 139.0 135.0 136.0 126.0 136.0 129.0 184.0 136.0 05:29:09 INFO - PID 17815 | 05:29:09 INFO - PID 17815 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:189.00 Median:192.50 stddev:6.18 (3.2%) stddev-sans-first:6.16 05:29:09 INFO - PID 17815 | Values: 195.0 181.0 184.0 197.0 181.0 194.0 188.0 195.0 191.0 184.0 05:29:09 INFO - PID 17815 | 05:29:09 INFO - PID 17815 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:66.00 Median:66.00 stddev:0.82 (1.2%) stddev-sans-first:0.78 05:29:09 INFO - PID 17815 | Values: 65.0 67.0 66.0 66.0 67.0 67.0 65.0 65.0 66.0 66.0 05:29:09 INFO - PID 17815 | -------- Summary: end -------- 05:29:09 INFO - PID 17815 | 05:29:10 INFO - TEST-INFO | 17815: exit 0 05:29:10 INFO - TEST-OK | kraken | took 61848ms 05:29:10 INFO - SUITE-END | took 1179s 05:29:10 INFO - Completed test suite (00:19:39) 05:29:10 INFO - javascript benchmark 05:29:10 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": [], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7223.681724081672, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3251.7398608111353, 3305.4711246200613, 3329.66703329667, 3335.4496508076168, 3350.8324583770805, 5571.470710282517, 5651.632643878155, 5754.597178197522, 5759.366469688331, 5793.855153621156, 5582.106862901936, 5615.101583746591, 5617.747201375938, 5741.995150848596, 5809.2738407699035, 5063.797448102072, 5097.464766199551, 5108.489151084899, 5131.050755610206, 5148.691078535281, 5084.923726144111, 5114.923276150861, 5201.063808514466, 5225.503577160182, 5229.189475631264, 5047.924281135786, 5155.664881782672, 5162.354705661793, 5225.529702326789, 5271.789128434877, 5082.1360368737405, 5113.105206588869, 5119.692818430869, 5142.794288228466, 5203.557697595709, 5132.024915266087, 5153.123968925292, 5154.201098829687, 5165.276861239429, 5217.50433708797, 5642.7742890284335, 5714.51426628737, 5716.971415142939, 5727.971360143172, 5751.022326204556, 6017.789377371815, 6068.757249710006, 6071.392860713938, 6145.508359331243, 6198.163247961513, 6288.276848162428, 6291.5281353898645, 6297.6536290504, 6301.558890877641, 6314.526410519229, 5823.0, 5829.8251052468495, 5830.883382332329, 5833.708314584212, 5882.529397648178, 6108.50170232864, 6160.0, 6330.715117819709, 6387.201599800025, 6391.776287829904, 5851.6781577012825, 6117.694115294217, 6124.418180272867, 6133.346641381411, 6135.04893764628, 6025.186599809057, 6029.517638588903, 6128.575417880124, 6183.598066125777, 6187.907181392283, 6127.785527506516, 6174.938250617436, 6181.041938499539, 6185.41238582334, 6190.535709821691, 5968.552358573124, 6189.381061893775, 6193.597416167935, 6199.659018754011, 6200.131981522591, 4648.97675511627, 4727.929081063787, 4754.358161648202, 4754.833580824655, 4777.928331075037, 4182.958170418317, 4198.580141985777, 4200.264953633102, 4202.85290014848, 4235.555266697014, 5831.910774452644, 5832.445917637818, 5837.182794408786, 5837.737301821428, 5890.49930755882, 6008.909866352008, 6031.24609423822, 6173.783917562864, 6203.16257305258, 6242.063690446469, 5853.590248682552, 5865.912011319833, 5867.0, 5876.882462350729, 5906.5570082244, 5238.345206849144, 5266.578673706094, 5287.550558202596, 5293.894122117613, 5294.947050529522, 6168.228971378578, 6236.126942228001, 6308.274548426806, 6431.421172094534, 6519.185101862267, 6133.05924499315, 6167.290761562298, 6171.506279497719, 6174.197354343906, 6177.166082578974, 6391.424771770563, 6392.3927226913365, 6392.744290228339, 6407.871842563216, 6412.775552855627, 5920.407959204045, 5996.910046349221, 6027.246594175728, 6072.392760723892, 6082.452579267887, 6148.139260503623, 6162.383761623802, 6206.937930620636, 6219.533534984804, 6221.346758590464, 6064.393560644076, 6065.514758819372, 6078.817635470943, 6083.6045657032155, 6128.417800308964, 5864.853378665567, 5871.559633027455, 5913.29040515141, 5918.408159184047, 5919.970400147971, 5947.762089516544, 5947.851303717269, 5949.25634295713, 5953.196318496947, 5953.613015154001, 5955.255593050869, 5962.940370596239, 5972.432618901197, 5977.133315669291, 5981.3719559445635, 5904.261967254093, 5940.28716553999, 5944.821655350346, 5990.191324171181, 6007.48936340416], "value": 5657.963782652723, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [673.3064943108596, 737.2885165814987, 744.8659241336558, 753.4273951796633, 773.2229109744706, 27970.440591188162, 28485.584734366155, 28541.714582854165, 28577.285567860814, 28621.42757144856, 35754.2849143017, 36384.45423318646, 36403.089922751875, 36456.27087458249, 36486.0, 2529.936751581216, 2530.860802655853, 2532.670752802133, 2545.5799793034125, 2604.010476019115, 2471.098049212034, 2536.03630620364, 2680.437108207269, 2792.45547118312, 2798.244473992021, 2833.8724757385967, 2897.406031763494, 2907.4766542022426, 2909.2872246299685, 2912.2428168676192, 2881.5389537673977, 2916.3000879788697, 2916.941661166765, 2922.7077292270815, 2930.60436841028, 2236.3514580771557, 2250.2911582851348, 2645.4444566640836, 2673.1980405878353, 2673.79946504011, 33680.83159584186, 34342.82828585841, 34403.655963440295, 34413.0, 34413.311733765186, 2994.31130839908, 3002.6396832380256, 3008.638963324393, 3026.3039500914692, 3032.3177285110896, 25614.487710245878, 25663.74336256632, 25701.742982570122, 25809.61285580718, 26423.735762642318, 3457.3085382923264, 3476.5654293213347, 3483.947740783865, 3485.3029394121277, 3501.9124521887156, 199578.0, 199630.0, 199747.0, 199932.0, 200515.0, 49380.753096234286, 49445.50554494481, 49495.50504494981, 49509.50490495049, 49544.75227623839, 51608.22587661188, 51801.7409912948, 51807.0, 51813.0, 51829.48170518322, 13097.083204175617, 13494.257815820225, 13510.729785404237, 13513.594592162252, 13515.121517101357, 10691.037806597444, 10712.250142490107, 10714.41070741101, 10717.78564428707, 10735.409552474688, 10489.527971241312, 10642.946785266024, 12301.446434910451, 12600.747985040249, 13104.082714209913, 5040.319556859777, 5155.226715992631, 5217.686938783685, 5273.551748101378, 5278.0, 1025.8050970315617, 1027.337367398039, 1031.7626945802358, 1044.5612842605972, 1055.8099542082346, 25155.87422062878, 25461.36346591313, 25471.872640636677, 25551.744482555307, 25610.359741006625, 1101.6254473479055, 1125.859267591551, 1130.8416821644976, 1161.4018780328138, 1165.7143999719954, 12828.615141545768, 13101.239576515556, 13199.20804751718, 13200.14199077057, 13256.867431325756, 280179.0, 282350.0, 282634.0, 283564.16435835377, 283859.0, 52700.20949685758, 52780.0, 53030.204546931825, 53179.20231196535, 53274.73362633162, 1387.1191793211383, 1447.536788227778, 1460.2552698124034, 1461.3423959218608, 1473.8673519383092, 23240.418989524722, 23586.410339741644, 24184.75815241825, 24412.6338104925, 24475.877620611784, 38302.23395532018, 38307.23385532218, 38340.80829595834, 38395.0, 38441.231175376895, 276485.0, 276589.0, 277069.0, 277196.0, 278842.0, 32716.0, 32934.505982409806, 33033.17417064593, 33178.834105829315, 33207.833960830045, 40927.38608920928, 41097.0, 41158.0, 41384.793076034424, 41434.58565414428, 34209.82895085509, 34275.657243427246, 34337.484937726455, 35189.29621407506, 35202.0, 34652.48021279733, 35156.0, 35279.294414111064, 35310.64689353176, 35433.82283088568, 35735.98508390305, 36218.0, 36924.0, 37260.0, 37410.25179496449, 29951.85024074953, 31733.523997140524, 31790.682093178773, 31971.200719982186, 32031.35937281195, 24834.26823049427, 25447.236582902544, 25486.74513254918, 25748.485030298914, 25873.353166170997], "value": 14385.404396701188, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [384.6559679229538, 433.98264069437226, 440.4076517084522, 441.22124450345126, 462.56518872260074, 18137.546561335974, 19105.713414298778, 20277.99999999998, 21060.157593696233, 21172.57654846902, 14269.643258918532, 20268.391948241577, 20419.897900510477, 20464.590708185828, 22103.226387076455, 4284.828606855722, 4397.340398940152, 4400.515943246241, 4400.97799511002, 4407.096545208225, 4155.854545090922, 4223.577642235782, 4256.0, 4300.1829652366105, 4357.564243575649, 4229.111886503838, 4237.788110594473, 4238.745675259479, 4239.47006624172, 4243.172581346638, 4183.226103170923, 4237.279662457389, 4242.618164365206, 4321.178975994551, 4338.761368124768, 3963.801809909522, 3989.6608788252743, 3990.900227494307, 3992.061865461614, 4081.7142800004012, 25498.0, 25709.871450642815, 26106.86946565274, 26273.605895911576, 26303.605445918325, 1999.5401057756796, 2026.6858636911154, 2030.46192758919, 2034.2778313698573, 2036.6028624418245, 15524.301406436738, 16165.757513637305, 16337.754933675886, 16942.745858812126, 17102.914485427493, 1875.5498680316762, 1917.2331067573082, 1921.1642935323039, 1923.6056608395245, 1934.216642259887, 98352.50823745907, 101959.4902025485, 102637.48681256546, 103736.0, 105284.0, 12092.334921579397, 12315.568955086528, 12413.31726755019, 12483.812742808865, 12880.227186368847, 17641.0, 17699.557511062325, 17709.0, 17727.202275897616, 17752.46742597724, 7322.3158673505395, 7952.3638108951145, 8004.51972881629, 8300.377471689648, 8330.083690794008, 7262.874254490563, 7378.0, 7545.962270188724, 7547.962260188774, 7555.886661700079, 7668.463207575416, 7755.573443460551, 7796.376289896794, 8028.237317454832, 8070.556119413489, 2223.49971256466, 2235.552889422122, 2261.118163916074, 2284.2804516577226, 2381.5356005578747, 993.9602415903283, 994.4679596415883, 1014.4319181258371, 1016.898310168992, 1034.7361422837128, 19833.900830495757, 20291.492712682302, 20295.376369890375, 20381.898090509454, 20518.281860134823, 1019.2559431614962, 1019.8470229465639, 1026.743314171457, 1029.1355261580159, 1052.147760314148, 10158.492075396201, 10910.727231819268, 10912.945435272773, 10957.342559446459, 10976.396298203676, 515685.0, 548133.0, 550886.0, 571675.0, 579973.503312086, 86984.0, 98399.0, 100647.49676251572, 103638.37265695815, 106398.46800765947, 1151.122909112315, 1193.5524178433088, 1212.8665846756849, 1217.3122185965078, 1217.5190799634272, 16317.347306108097, 16422.167889160803, 16901.239444224793, 16995.830041699424, 17692.0, 47127.76436117935, 47534.04931901273, 48136.89429073994, 48380.274295886295, 49031.0, 60828.69585652043, 61385.693071534355, 62818.68590657017, 63194.684026579576, 64176.0, 8972.013078561484, 9112.95443522778, 9113.225375843127, 9260.768480788034, 9676.371035882645, 11875.168738188244, 13055.738885222052, 13343.599692009255, 13344.332783360598, 13798.17210967345, 11724.88275117238, 11829.408529573315, 11854.762904741685, 11900.285982841056, 12247.816282755588, 11731.648050558497, 11840.467178976794, 11954.0, 12053.939730301643, 12248.938755306523, 12154.331511766584, 12379.442925068213, 12477.0, 12577.0, 12682.556110536087, 9083.545822708971, 9251.583678734338, 9513.809723805347, 9521.714348569554, 9674.70975870725, 12205.20666156697, 12251.142420030512, 12327.876721232673, 12398.504059837505, 12421.565245216374], "value": 9520.871286400252, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1331.7403106394254, 1369.5138225929795, 1396.1274203622736, 1401.5374926274324, 1402.0466083063513, 10396.636117735872, 10768.946155269212, 10771.892281077187, 10786.838197427034, 10787.946060269698, 10560.577576896914, 10821.945890270557, 10881.183911206672, 10891.83662245067, 10893.618723344685, 2345.566070277, 2378.702662167229, 2379.6311571706415, 2384.7853693167613, 2395.748446413119, 2044.9386518404472, 2115.3971118231307, 2319.9652005219937, 2381.0356805493716, 2382.1781485387514, 2369.514249578841, 2429.7691719286727, 2435.622478515833, 2435.695538057743, 2439.8170137239777, 2348.3894187511287, 2356.7643235676383, 2364.8817559121976, 2366.1008816649564, 2373.169390713254, 2301.309607117858, 2309.711286089239, 2325.0, 2328.1269523928527, 2428.8220213196587, 11138.554457821678, 11245.775084498264, 11245.775084498346, 11256.774864502664, 11273.37996410197, 6158.753649854, 6324.272708638519, 6339.1442155308905, 6347.39699728525, 6365.267994180682, 3955.663768579674, 3981.542122655903, 4097.631213190827, 4124.876253712393, 4143.6892233082335, 1244.3031902134833, 1294.0876681939305, 1335.986640133596, 1343.523049317488, 1356.5455572383264, 16265.674686506321, 16548.255328510248, 16752.49742507727, 16770.413035543697, 16805.91597042007, 5160.819371321985, 5323.414424413311, 5422.539084177889, 5484.177373393943, 5533.391326954032, 12278.140530162982, 12319.199252048587, 12323.0, 12328.876711232951, 12337.383130843422, 6310.400511951358, 6315.147455093595, 6328.525360597973, 6334.683265836689, 6343.460805831556, 5616.803411880564, 5672.971635141798, 5703.0, 5800.24596802413, 5815.476607105296, 4223.72545784523, 4286.292761694285, 4308.375285583573, 4352.717073390219, 4412.84555040572, 1177.7821103095955, 1196.347990345264, 1266.9303188324732, 1274.1144904291427, 1322.7552902712837, 813.0893399392718, 839.8787618529332, 869.6651789061257, 875.7329014650466, 903.1555495611624, 6505.804825855232, 6561.475081993429, 6679.76620818269, 6684.866302674017, 6911.6544172791155, 958.5782255807422, 960.5437417226901, 971.621067783565, 975.7804493988796, 981.3523074770617, 4399.5160532341415, 4499.460064792181, 4605.194091034055, 4640.164770341371, 4738.123447162286, 14432.278386080863, 14834.184119873511, 14845.480408185662, 14863.405463781328, 14873.92563037178, 13847.515336963157, 14323.355449004612, 14334.21161836109, 14665.193414362098, 14776.778348324784, 10088.899111008795, 10304.33021853592, 10321.122704570045, 10367.896321036844, 10375.896241037644, 6873.690683919136, 7218.0, 7242.3843973262865, 7243.23945985685, 7260.0, 13048.41282142287, 13189.868101318863, 13273.137246078973, 13488.595342139752, 13488.73022539524, 12621.432035558606, 12728.61814145577, 12914.031447641277, 13360.398782054637, 13633.931830341182, 9219.400738951947, 9309.44143351401, 9369.156775890202, 9400.29497787655, 9454.621815127319, 10356.275060745675, 10397.220208484545, 10458.0, 10459.424731639832, 10508.894911050791, 7517.812054698677, 9075.27397808187, 9103.90896091057, 9112.726618201465, 9322.114399132071, 8660.437071590326, 8819.735407937773, 8861.158189971942, 8867.201951824109, 8918.687845925362, 8017.318527925192, 8044.919550804417, 8075.111737708965, 8122.634481448231, 8139.674413023413, 6191.0, 6245.156903818108, 6250.499960003098, 6294.748210071546, 6455.709493072917, 5882.5293976480925, 6065.8180254592435, 6076.088586712029, 6232.470240029648, 6292.433680968735], "value": 5336.940701899376, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [401.9236345094434, 404.50044195418656, 404.98785036448896, 409.26610243572935, 411.66449343784814, 5738.913916291253, 5788.218590490283, 5814.418558144189, 5822.737976791049, 5836.270466191726, 5144.562712169461, 5678.5741069419855, 5710.714464276791, 5742.454466825655, 5761.4814666679995, 4561.475430325505, 4562.676823721117, 4566.8629941101735, 4567.584048944821, 4581.977090114545, 4560.2019646561885, 4575.22221222393, 4593.150267200579, 4597.126545956275, 4611.907761844761, 4473.485549161839, 4494.662900282492, 4508.752018638974, 4530.682852200347, 4553.977230113845, 4523.231050721369, 4528.3886675298745, 4541.704789188709, 4544.113897789933, 4544.590986811169, 4120.814563344657, 4122.40225167349, 4127.153933443667, 4143.647789937829, 4153.1070819773595, 5460.290162278918, 5570.749316280777, 5585.636933599303, 5602.971985140089, 5618.185363122325, 5310.522053015247, 5319.5744340452675, 5327.413984461706, 5335.039692855285, 5335.5464785492895, 5909.674967876765, 6087.05650624154, 6087.391260873921, 6102.237220347457, 6124.049987757871, 4531.501534831166, 4537.909241815179, 4556.3393307970155, 4566.995261042599, 4574.794134263966, 6090.33006369299, 6305.9999999999545, 6307.27466341372, 6336.809895703136, 6339.58792678479, 4406.162829062468, 4595.9080818383445, 4614.676972611885, 4614.930776038362, 4688.038952014829, 4718.41019872516, 4752.881177970509, 4758.500357462417, 4760.45254795696, 4768.6661933665, 4932.880720591447, 5041.420236672756, 5299.49654782795, 5320.228566857862, 5339.038972984822, 6126.509879209652, 6142.648617304186, 6146.508279337642, 6151.876962460726, 6184.134221209034, 1616.5473667373155, 1655.9420420285232, 1668.57451349905, 1673.9748903766454, 1675.9245833937503, 1146.0659562456572, 1159.2464897816487, 1174.3541052421135, 1175.7707247086737, 1183.875693052217, 5817.76728930838, 5831.854203644858, 5840.5035571976005, 5842.503387212049, 5849.181114643953, 6233.594816336924, 6243.875122497525, 6244.594101383395, 6252.499800015988, 6272.153259310026, 5553.16702494629, 5837.620554663933, 5843.912341314884, 5869.73586188614, 5898.469137777621, 3301.5873015873017, 3325.5011748237957, 3326.850291736829, 3335.7831740936763, 3348.1964328561457, 6303.0, 6474.546781725328, 6551.312112228243, 6560.475161987029, 6586.6377349245295, 6349.873002539924, 6358.300586935434, 6363.949948258485, 6376.330485298977, 6402.359764023654, 6483.643399613066, 6486.610803351814, 6493.480521558264, 6498.935010649928, 6509.0, 5941.37615550361, 6206.937930620636, 6288.434040936338, 6290.308066112632, 6316.368363163647, 6228.314885362516, 6245.531585131224, 6263.185785847811, 6264.5301602379095, 6303.747850085945, 5709.885802284014, 6046.27444706638, 6438.806835794933, 6462.515311351762, 6525.0, 4386.232409328419, 4408.404865343266, 4424.446944131983, 4430.579094985971, 4444.200043992112, 6207.6275423474735, 6236.126942228182, 6284.214473190851, 6311.053341998553, 6332.715027823667, 6073.514118870568, 6094.421030002142, 6139.0, 6154.969225153845, 6157.0, 6073.210482637229, 6088.51291896656, 6110.388961103854, 6132.601380910227, 6145.66198859067, 5788.334341550607, 6062.969685151546, 6126.866529692022, 6130.754769809158, 6133.110698948538, 6146.416090471398, 6158.414950579688, 6168.321484636776, 6176.258848938156, 6191.1641928339095, 5882.911756323744, 5893.116032595145, 5964.493018093511, 5982.46157845796, 5984.371640977634], "value": 4711.4828685304055, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [669.3406994110803, 674.1640365946229, 717.5658726470485, 747.8242612985947, 782.1044903585397, 13586.796198057036, 14045.719085618282, 15874.047557146565, 16470.83529164708, 16689.91655041726, 14974.475893343735, 15021.549353519385, 15202.923985380057, 15480.845191548082, 15610.0, 828.3000864269698, 842.1746688245523, 843.1694780641094, 844.3414136973171, 846.6697987784769, 832.3258160889668, 844.5270648436864, 850.5662112322728, 852.2031900173326, 853.4751128056232, 882.5234373438335, 887.1660638999319, 887.1970866365949, 888.2760550151638, 888.471359541072, 882.0121463960373, 882.6778225947515, 884.2130503851578, 885.313881741649, 886.0209468537238, 647.7409036385436, 648.0376640688573, 648.1153225846732, 648.2350826025288, 648.610833499901, 15530.767038494432, 15548.533543993699, 15879.444219452263, 15981.920090399473, 16149.838501615068, 14488.637784055378, 14742.852571474255, 14784.260786960609, 15285.312160952784, 15466.690666186612, 11337.43312834355, 11387.25982811123, 11543.365114918675, 11667.241629294154, 12280.570180043745, 3027.5206591061283, 3040.771942104329, 3130.2330928922333, 3193.0740085375214, 3197.904062878117, 84187.0, 84226.57886710588, 84877.15122848754, 85673.57163214206, 87860.0, 11993.64019079429, 12043.0, 12290.569830055905, 12378.257304561756, 12396.690082747824, 22309.0, 22314.55370892573, 22424.18788805907, 22463.101475941105, 22861.19985800489, 7844.84310313802, 7855.960720196476, 7872.56700881457, 7940.960295198487, 8020.598970051474, 3911.9022024449046, 3939.1727737175515, 3987.1427643056304, 4012.3580227163516, 4113.650339721097, 4159.750414975111, 4259.42497762798, 4565.474970378449, 4683.2038553446, 4706.976465117653, 878.8549889268327, 887.086301109845, 890.9242714369351, 894.1282249806387, 914.0950459045497, 629.8645791154833, 634.4765568406084, 652.1522021372197, 654.8035589323184, 659.4262991197593, 9886.505674716236, 10118.241131914989, 10165.796684066278, 10202.857399945946, 10297.74255643615, 585.9824205273763, 602.6534742523066, 609.4932286788842, 612.8314713453747, 614.1402037147939, 4729.858104256878, 4838.806447742121, 4855.8057677693205, 4870.853874383774, 4871.171900776876, 54410.183847242326, 69336.65331673309, 74269.6286518564, 75426.0, 77748.61125694448, 65132.0, 66147.33852661509, 66342.0, 66678.33146696506, 69121.0, 46354.30468542974, 46759.766201169456, 57218.0, 59892.0, 60811.087833681646, 10158.949205253926, 10693.867396442343, 10866.13070954306, 10884.836727448936, 10963.122950164126, 28894.7110528892, 28984.420311594073, 31164.0, 32257.677423226407, 32409.52233390209, 51208.0, 51430.0, 51687.48312516827, 52558.47441525536, 52698.736506317226, 13924.930375348464, 13939.372728227458, 13975.930120349332, 14109.647258818612, 14464.20446875432, 15056.397744090551, 15313.846861531687, 15383.538493845203, 16126.0, 16160.353585856434, 13487.460501579826, 14119.0, 14216.21810800416, 14307.71384572282, 15133.394664213309, 13650.385732641857, 13784.241866697026, 14059.702079931072, 14171.149731016172, 14756.188409637572, 13330.600081997556, 13936.79094813599, 14096.436142554183, 14420.206888621227, 14558.563243102724, 11704.565309637184, 12041.217320874115, 12379.75240495203, 12379.814302785286, 12519.93740031294, 11516.136289778133, 11656.18406711556, 11728.530858765895, 11851.969693956455, 11932.940335298268], "value": 7291.5145170891665, "unit": "score"}]}, {"extraOptions": [], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1510.5, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [102.0, 108.0, 109.0, 110.0, 112.0, 108.0, 111.0, 110.0, 111.0, 110.0], "value": 109.1, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [149.0, 118.0, 116.0, 161.0, 120.0, 120.0, 118.0, 116.0, 138.0, 118.0], "value": 127.4, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [161.0, 164.0, 161.0, 161.0, 162.0, 163.0, 161.0, 162.0, 162.0, 161.0], "value": 161.8, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 77.0, 75.0, 109.0, 75.0, 75.0, 74.0, 74.0, 103.0, 74.0], "value": 81.1, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [83.0, 83.0, 115.0, 83.0, 82.0, 83.0, 102.0, 82.0, 83.0, 102.0], "value": 89.8, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [114.0, 113.0, 113.0, 114.0, 113.0, 112.0, 114.0, 113.0, 113.0, 113.0], "value": 113.2, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 147.0, 146.0, 147.0, 146.0, 146.0, 147.0, 147.0, 148.0, 146.0], "value": 146.7, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [94.0, 94.0, 94.0, 95.0, 94.0, 94.0, 94.0, 94.0, 94.0, 94.0], "value": 94.1, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [57.0, 58.0, 57.0, 57.0, 60.0, 59.0, 59.0, 58.0, 58.0, 58.0], "value": 58.1, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [54.0, 55.0, 54.0, 54.0, 54.0, 54.0, 54.0, 55.0, 54.0, 54.0], "value": 54.2, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [81.0, 81.0, 83.0, 80.0, 89.0, 89.0, 79.0, 81.0, 81.0, 79.0], "value": 82.3, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [127.0, 129.0, 139.0, 135.0, 136.0, 126.0, 136.0, 129.0, 184.0, 136.0], "value": 137.7, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [195.0, 181.0, 184.0, 197.0, 181.0, 194.0, 188.0, 195.0, 191.0, 184.0], "value": 189.0, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [65.0, 67.0, 66.0, 66.0, 67.0, 67.0, 65.0, 65.0, 66.0, 66.0], "value": 66.0, "unit": "score"}]}]} 05:29:11 INFO - Return code: 0 05:29:11 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 05:29:11 ERROR - # TBPL SUCCESS # 05:29:11 INFO - Running post-action listener: _resource_record_post_action 05:29:11 INFO - [mozharness: 2017-03-21 12:29:11.078279Z] Finished run-tests step (success) 05:29:11 INFO - Running post-run listener: _resource_record_post_run 05:29:11 INFO - Total resource usage - Wall time: 1197s; CPU: 13.0%; Read bytes: 0; Write bytes: 379179008; Read time: 0; Write time: 345188 05:29:11 INFO - TinderboxPrint: CPU usage
12.9% 05:29:11 INFO - TinderboxPrint: I/O read bytes / time
0 / 0 05:29:11 INFO - TinderboxPrint: I/O write bytes / time
379,179,008 / 345,188 05:29:11 INFO - TinderboxPrint: CPU idle
8,318.2 (87.0%) 05:29:11 INFO - TinderboxPrint: CPU user
1,187.6 (12.4%) 05:29:11 INFO - TinderboxPrint: Swap in / out
0 / 0 05:29:11 INFO - install - Wall time: 18s; CPU: 13.0%; Read bytes: 0; Write bytes: 124252160; Read time: 0; Write time: 144688 05:29:11 INFO - run-tests - Wall time: 1180s; CPU: 13.0%; Read bytes: 0; Write bytes: 254910464; Read time: 0; Write time: 200500 05:29:11 INFO - Running post-run listener: _upload_blobber_files 05:29:11 INFO - Blob upload gear active. 05:29:11 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 05:29:11 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 05:29:11 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', 'Firefox', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 05:29:11 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 Firefox -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 05:29:12 INFO - (blobuploader) - INFO - Open directory for files ... 05:29:12 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 05:29:12 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:29:12 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:29:12 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 05:29:12 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:29:12 INFO - (blobuploader) - INFO - Done attempting. 05:29:12 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 05:29:12 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:29:12 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:29:13 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 05:29:13 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:29:13 INFO - (blobuploader) - INFO - Done attempting. 05:29:13 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 05:29:13 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:29:13 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:29:14 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 05:29:14 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:29:14 INFO - (blobuploader) - INFO - Done attempting. 05:29:14 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 05:29:14 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:29:14 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:29:19 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 05:29:19 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:29:19 INFO - (blobuploader) - INFO - Done attempting. 05:29:19 INFO - (blobuploader) - INFO - Iteration through files over. 05:29:19 INFO - Return code: 0 05:29:19 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 05:29:19 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 05:29:19 INFO - Setting buildbot property blobber_files to {"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/158cef31b84a79fe2c85a7218e75454734f6f608bb097277594315a3578d247defb6489f317368e4d52287e9d8229494faa1bc8d3755c17e41754307ae0eac4e", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/874075dce5a68557d1d33fb0a659c1da710565688b4fdd1703f401a95554543afd0d4da88fe8df5b436e08f7b137d58e35c49c5d9c651f41c1becedc9492c769", "dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/fb6c2a1b6194afff16c28f2053c2b92db9758eaba1225858a86ee53b595ea896df9576b4e0ae6272c4a3940fcc28404b8d0f54b42f57db08b59eb1d45c1c8442", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/37464124069dd8a136c6a7db6354a6978404dc4e1873d3abf9c9ba302f9424ae0e6c7dacb370e473c198c041e39ec3ef67b64678966836490275225f51bb4333"} 05:29:19 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 05:29:19 INFO - Writing to file /builds/slave/test/properties/blobber_files 05:29:19 INFO - Contents: 05:29:19 INFO - blobber_files:{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/158cef31b84a79fe2c85a7218e75454734f6f608bb097277594315a3578d247defb6489f317368e4d52287e9d8229494faa1bc8d3755c17e41754307ae0eac4e", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/874075dce5a68557d1d33fb0a659c1da710565688b4fdd1703f401a95554543afd0d4da88fe8df5b436e08f7b137d58e35c49c5d9c651f41c1becedc9492c769", "dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/fb6c2a1b6194afff16c28f2053c2b92db9758eaba1225858a86ee53b595ea896df9576b4e0ae6272c4a3940fcc28404b8d0f54b42f57db08b59eb1d45c1c8442", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/37464124069dd8a136c6a7db6354a6978404dc4e1873d3abf9c9ba302f9424ae0e6c7dacb370e473c198c041e39ec3ef67b64678966836490275225f51bb4333"} 05:29:19 INFO - Running post-run listener: copy_logs_to_upload_dir 05:29:19 INFO - Copying logs to upload dir... 05:29:19 INFO - mkdir: /builds/slave/test/build/upload/logs 05:29:19 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1257.760586 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 57 secs) (at 2017-03-21 05:29:18.517802) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-03-21 05:29:18.523402) ========= 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=d6bbd613908ccac0c6c9cb47000001f7-1490098099.210041-1547077723 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/158cef31b84a79fe2c85a7218e75454734f6f608bb097277594315a3578d247defb6489f317368e4d52287e9d8229494faa1bc8d3755c17e41754307ae0eac4e", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/874075dce5a68557d1d33fb0a659c1da710565688b4fdd1703f401a95554543afd0d4da88fe8df5b436e08f7b137d58e35c49c5d9c651f41c1becedc9492c769", "dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/fb6c2a1b6194afff16c28f2053c2b92db9758eaba1225858a86ee53b595ea896df9576b4e0ae6272c4a3940fcc28404b8d0f54b42f57db08b59eb1d45c1c8442", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/37464124069dd8a136c6a7db6354a6978404dc4e1873d3abf9c9ba302f9424ae0e6c7dacb370e473c198c041e39ec3ef67b64678966836490275225f51bb4333"} build_url:https://queue.taskcluster.net/v1/task/Nr157VxGRqChZrbb35e78w/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011281 build_url: 'https://queue.taskcluster.net/v1/task/Nr157VxGRqChZrbb35e78w/artifacts/public/build/target.tar.bz2' blobber_files: '{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/158cef31b84a79fe2c85a7218e75454734f6f608bb097277594315a3578d247defb6489f317368e4d52287e9d8229494faa1bc8d3755c17e41754307ae0eac4e", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/874075dce5a68557d1d33fb0a659c1da710565688b4fdd1703f401a95554543afd0d4da88fe8df5b436e08f7b137d58e35c49c5d9c651f41c1becedc9492c769", "dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/fb6c2a1b6194afff16c28f2053c2b92db9758eaba1225858a86ee53b595ea896df9576b4e0ae6272c4a3940fcc28404b8d0f54b42f57db08b59eb1d45c1c8442", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/37464124069dd8a136c6a7db6354a6978404dc4e1873d3abf9c9ba302f9424ae0e6c7dacb370e473c198c041e39ec3ef67b64678966836490275225f51bb4333"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-03-21 05:29:18.548259) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-03-21 05:29:18.548578) ========= 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=d6bbd613908ccac0c6c9cb47000001f7-1490098099.210041-1547077723 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004398 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-03-21 05:29:18.633773) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-03-21 05:29:18.634089) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-03-21 05:29:18.634379) ========= ========= Total master_lag: 0.16 =========