builder: mozilla-central_ubuntu64_hw_test-dromaeojs-stylo-disabled-e10s slave: talos-linux64-ix-070 starttime: 1505469145.02 results: success (0) revision: f36106f3f52a9bb2769860d20568c589fc2498d0 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-09-15 02:52:25.016171) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-09-15 02:52:25.023426) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-09-15 02:52:25.023716) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-09-15 02:52:25.075955) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-09-15 02:52:25.076314) ========= 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=2432103b8b3de4003b23cad4000001c2-1505461794.715586-1022375943 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-09-15 02:52:24-- 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% 219M=0s 2017-09-15 02:52:24 (219 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.108537 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-09-15 02:52:25.201725) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-09-15 02:52:25.204137) ========= 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=2432103b8b3de4003b23cad4000001c2-1505461794.715586-1022375943 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.022730 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-09-15 02:52:25.258122) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 12 secs) (at 2017-09-15 02:52:25.258431) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev f36106f3f52a9bb2769860d20568c589fc2498d0 --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 f36106f3f52a9bb2769860d20568c589fc2498d0 --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=2432103b8b3de4003b23cad4000001c2-1505461794.715586-1022375943 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-09-15 02:52:25,072 truncating revision to first 12 chars 2017-09-15 02:52:25,072 Setting DEBUG logging. 2017-09-15 02:52:25,073 attempt 1/10 2017-09-15 02:52:25,073 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/f36106f3f52a?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-09-15 02:52:25,754 sleeping for 11.00s (attempt 1/10) 2017-09-15 02:52:36,766 attempt 2/10 2017-09-15 02:52:36,766 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/f36106f3f52a?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-09-15 02:52:37,260 unpacking tar archive at: mozilla-central-f36106f3f52a/testing/mozharness/ program finished with exit code 0 elapsedTime=12.677179 ========= master_lag: 0.05 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 12 secs) (at 2017-09-15 02:52:37.988345) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-09-15 02:52:37.988643) ========= script_repo_revision: f36106f3f52a9bb2769860d20568c589fc2498d0 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-09-15 02:52:37.991057) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-09-15 02:52:37.991329) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-09-15 02:52:38.003977) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 41 secs) (at 2017-09-15 02:52:38.004305) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-stylo-disabled-e10s --add-option --webServer,localhost --branch-name Firefox-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-Non-PGO 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-stylo-disabled-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox-Non-PGO'] 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=2432103b8b3de4003b23cad4000001c2-1505461794.715586-1022375943 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 02:52:37 INFO - MultiFileLogger online at 20170915 02:52:37 in /builds/slave/test 02:52:37 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-stylo-disabled-e10s --add-option --webServer,localhost --branch-name Firefox-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-Non-PGO 02:52:37 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 02:52:37 INFO - {'append_to_log': False, 02:52:37 INFO - 'base_work_dir': '/builds/slave/test', 02:52:37 INFO - 'blob_upload_branch': 'Firefox-Non-PGO', 02:52:37 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 02:52:37 INFO - 'branch': 'Firefox-Non-PGO', 02:52:37 INFO - 'buildbot_json_path': 'buildprops.json', 02:52:37 INFO - 'code_coverage': False, 02:52:37 INFO - 'config_files': ('talos/linux_config.py',), 02:52:37 INFO - 'default_actions': ('clobber', 02:52:37 INFO - 'read-buildbot-config', 02:52:37 INFO - 'download-and-extract', 02:52:37 INFO - 'populate-webroot', 02:52:37 INFO - 'create-virtualenv', 02:52:37 INFO - 'install', 02:52:37 INFO - 'setup-mitmproxy', 02:52:37 INFO - 'run-tests'), 02:52:37 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 02:52:37 INFO - 'disable_ccov_upload': False, 02:52:37 INFO - 'disable_stylo': False, 02:52:37 INFO - 'download_minidump_stackwalk': True, 02:52:37 INFO - 'download_symbols': 'ondemand', 02:52:37 INFO - 'enable_stylo': False, 02:52:37 INFO - 'enable_webrender': False, 02:52:37 INFO - 'exes': {'tooltool.py': '/tools/tooltool.py'}, 02:52:37 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 02:52:37 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 02:52:37 INFO - 'gecko_profile': False, 02:52:37 INFO - 'gecko_profile_interval': 0, 02:52:37 INFO - 'installer_path': 'installer.exe', 02:52:37 INFO - 'log_level': 'info', 02:52:37 INFO - 'log_name': 'talos', 02:52:37 INFO - 'log_to_console': True, 02:52:37 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 02:52:37 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 02:52:37 INFO - 'opt_config_files': (), 02:52:37 INFO - 'pip_index': False, 02:52:37 INFO - 'suite': 'dromaeojs-stylo-disabled-e10s', 02:52:37 INFO - 'system_bits': '32', 02:52:37 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 02:52:37 INFO - 'title': 'talos-linux64-ix-070', 02:52:37 INFO - 'tooltool_cache': '/builds/tooltool_cache', 02:52:37 INFO - 'use_talos_json': True, 02:52:37 INFO - 'verify': 'False', 02:52:37 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 02:52:37 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 02:52:37 INFO - 'work_dir': 'build'} 02:52:37 INFO - [mozharness: 2017-09-15 09:52:37.930237Z] Running clobber step. 02:52:37 INFO - Running pre-action listener: _resource_record_pre_action 02:52:37 INFO - Running main action method: clobber 02:52:37 INFO - rmtree: /builds/slave/test/build 02:52:37 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 02:52:39 INFO - Running post-action listener: _resource_record_post_action 02:52:39 INFO - [mozharness: 2017-09-15 09:52:39.457787Z] Finished clobber step (success) 02:52:39 INFO - [mozharness: 2017-09-15 09:52:39.457883Z] Running read-buildbot-config step. 02:52:39 INFO - Running pre-action listener: _resource_record_pre_action 02:52:39 INFO - Running main action method: read_buildbot_config 02:52:39 INFO - Using buildbot properties: 02:52:39 INFO - { 02:52:39 INFO - "project": "", 02:52:39 INFO - "product": "firefox", 02:52:39 INFO - "who": "archaeopteryx@coole-files.de", 02:52:39 INFO - "installer_path": "public/build/target.tar.bz2", 02:52:39 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs-stylo-disabled-e10s", 02:52:39 INFO - "repository": "https://hg.mozilla.org/mozilla-central", 02:52:39 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central talos dromaeojs-stylo-disabled-e10s", 02:52:39 INFO - "stage_platform": "linux64", 02:52:39 INFO - "basedir": "/builds/slave/test", 02:52:39 INFO - "buildnumber": 23, 02:52:39 INFO - "platform": "ubuntu64_hw", 02:52:39 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 02:52:39 INFO - "slavebuilddir": "test", 02:52:39 INFO - "taskId": "BSvDIrjlScuNev99u33QWg", 02:52:39 INFO - "branch": "mozilla-central", 02:52:39 INFO - "script_repo_revision": "production", 02:52:39 INFO - "revision": "f36106f3f52a9bb2769860d20568c589fc2498d0", 02:52:39 INFO - "slavename": "talos-linux64-ix-070", 02:52:39 INFO - "repo_path": "mozilla-central" 02:52:39 INFO - } 02:52:39 INFO - Finding installer, test and symbols from parent task. 02:52:39 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/BSvDIrjlScuNev99u33QWg'}, attempt #1 02:52:39 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/BSvDIrjlScuNev99u33QWg'}, attempt #1 02:52:40 INFO - Task dependencies: WmwENJ0_TWeFxfcKwYDDvw 02:52:40 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/WmwENJ0_TWeFxfcKwYDDvw'}, attempt #1 02:52:40 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/WmwENJ0_TWeFxfcKwYDDvw/artifacts/public/build/target.tar.bz2 02:52:40 INFO - Set test_packages_url: https://queue.taskcluster.net/v1/task/WmwENJ0_TWeFxfcKwYDDvw/artifacts/public/build/target.test_packages.json 02:52:40 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/WmwENJ0_TWeFxfcKwYDDvw/artifacts/public/build/target.crashreporter-symbols.zip 02:52:40 INFO - Running post-action listener: _resource_record_post_action 02:52:40 INFO - [mozharness: 2017-09-15 09:52:40.917311Z] Finished read-buildbot-config step (success) 02:52:40 INFO - [mozharness: 2017-09-15 09:52:40.917569Z] Running download-and-extract step. 02:52:40 INFO - Running pre-action listener: _resource_record_pre_action 02:52:40 INFO - Running main action method: download_and_extract 02:52:40 INFO - mkdir: /builds/slave/test/build/tests 02:52:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 02:52:40 INFO - trying https://queue.taskcluster.net/v1/task/WmwENJ0_TWeFxfcKwYDDvw/artifacts/public/build/target.test_packages.json 02:52:40 INFO - Downloading https://queue.taskcluster.net/v1/task/WmwENJ0_TWeFxfcKwYDDvw/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 02:52:40 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/WmwENJ0_TWeFxfcKwYDDvw/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 02:52:41 INFO - Downloaded 989 bytes. 02:52:41 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 02:52:41 INFO - Using the following test package requirements: 02:52:41 INFO - {u'awsy': [u'target.common.tests.zip', u'target.awsy.tests.zip'], 02:52:41 INFO - u'common': [u'target.common.tests.zip'], 02:52:41 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 02:52:41 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 02:52:41 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 02:52:41 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 02:52:41 INFO - u'mozbase': [u'target.common.tests.zip'], 02:52:41 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 02:52:41 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 02:52:41 INFO - u'web-platform': [u'target.common.tests.zip', 02:52:41 INFO - u'target.web-platform.tests.tar.gz'], 02:52:41 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 02:52:41 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite categories: ['common', 'talos'] 02:52:41 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/WmwENJ0_TWeFxfcKwYDDvw/artifacts/public/build/target.common.tests.zip 02:52:41 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/WmwENJ0_TWeFxfcKwYDDvw/artifacts/public/build/target.common.tests.zip'}, attempt #1 02:52:41 INFO - Fetch https://queue.taskcluster.net/v1/task/WmwENJ0_TWeFxfcKwYDDvw/artifacts/public/build/target.common.tests.zip into memory 02:52:42 INFO - Content-Length response header: 54736915 02:52:42 INFO - Bytes received: 54736915 02:52:53 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/WmwENJ0_TWeFxfcKwYDDvw/artifacts/public/build/target.talos.tests.zip 02:52:53 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/WmwENJ0_TWeFxfcKwYDDvw/artifacts/public/build/target.talos.tests.zip'}, attempt #1 02:52:53 INFO - Fetch https://queue.taskcluster.net/v1/task/WmwENJ0_TWeFxfcKwYDDvw/artifacts/public/build/target.talos.tests.zip into memory 02:52:54 INFO - Content-Length response header: 14500356 02:52:54 INFO - Bytes received: 14500356 02:52:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 02:52:54 INFO - trying https://queue.taskcluster.net/v1/task/WmwENJ0_TWeFxfcKwYDDvw/artifacts/public/build/target.tar.bz2 02:52:54 INFO - Downloading https://queue.taskcluster.net/v1/task/WmwENJ0_TWeFxfcKwYDDvw/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 02:52:54 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/WmwENJ0_TWeFxfcKwYDDvw/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 02:52:55 INFO - Downloaded 61423088 bytes. 02:52:56 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/WmwENJ0_TWeFxfcKwYDDvw/artifacts/public/build/target.tar.bz2 02:52:56 INFO - mkdir: /builds/slave/test/properties 02:52:56 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 02:52:56 INFO - Writing to file /builds/slave/test/properties/build_url 02:52:56 INFO - Contents: 02:52:56 INFO - build_url:https://queue.taskcluster.net/v1/task/WmwENJ0_TWeFxfcKwYDDvw/artifacts/public/build/target.tar.bz2 02:52:56 INFO - Running post-action listener: _resource_record_post_action 02:52:56 INFO - Running post-action listener: find_tests_for_verification 02:52:56 INFO - Running post-action listener: set_extra_try_arguments 02:52:56 INFO - [mozharness: 2017-09-15 09:52:56.103126Z] Finished download-and-extract step (success) 02:52:56 INFO - [mozharness: 2017-09-15 09:52:56.103224Z] Running populate-webroot step. 02:52:56 INFO - Running pre-action listener: _resource_record_pre_action 02:52:56 INFO - Running main action method: populate_webroot 02:52:56 INFO - {'suites': {'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 02:52:56 INFO - 'chromez-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 02:52:56 INFO - 'tests': ['tresize', 02:52:56 INFO - 'tcanvasmark']}, 02:52:56 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 02:52:56 INFO - 'dromaeojs-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 02:52:56 INFO - 'tests': ['dromaeo_css', 02:52:56 INFO - 'kraken']}, 02:52:56 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 02:52:56 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 02:52:56 INFO - 'g1-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 02:52:56 INFO - 'talos_options': ['--disable-stylo'], 02:52:56 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 02:52:56 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 02:52:56 INFO - 'tests': ['damp', 'tps']}, 02:52:56 INFO - 'g2-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 02:52:56 INFO - 'talos_options': ['--disable-stylo'], 02:52:56 INFO - 'tests': ['damp', 'tps']}, 02:52:56 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 02:52:56 INFO - 'g3-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 02:52:56 INFO - 'tests': ['dromaeo_dom']}, 02:52:56 INFO - 'g4-e10s': {'tests': ['basic_compositor_video', 'glvideo']}, 02:52:56 INFO - 'g4-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 02:52:56 INFO - 'tests': ['basic_compositor_video', 02:52:56 INFO - 'glvideo']}, 02:52:56 INFO - 'g5-e10s': {'pagesets_name': 'tp5n.zip', 02:52:56 INFO - 'tests': ['ts_paint_webext', 'tp5o_webext']}, 02:52:56 INFO - 'g5-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 02:52:56 INFO - 'talos_options': ['--disable-stylo'], 02:52:56 INFO - 'tests': ['ts_paint_webext', 02:52:56 INFO - 'tp5o_webext']}, 02:52:56 INFO - 'other-e10s': {'tests': ['a11yr', 02:52:56 INFO - 'ts_paint', 02:52:56 INFO - 'tpaint', 02:52:56 INFO - 'sessionrestore', 02:52:56 INFO - 'sessionrestore_many_windows', 02:52:56 INFO - 'sessionrestore_no_auto_restore', 02:52:56 INFO - 'tabpaint']}, 02:52:56 INFO - 'other-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 02:52:56 INFO - 'tests': ['a11yr', 02:52:56 INFO - 'ts_paint', 02:52:56 INFO - 'tpaint', 02:52:56 INFO - 'sessionrestore', 02:52:56 INFO - 'sessionrestore_many_windows', 02:52:56 INFO - 'sessionrestore_no_auto_restore', 02:52:56 INFO - 'tabpaint']}, 02:52:56 INFO - 'perf-reftest-e10s': {'tests': ['bloom_basic']}, 02:52:56 INFO - 'perf-reftest-singletons-e10s': {'tests': ['bloom_basic_singleton']}, 02:52:56 INFO - 'perf-reftest-singletons-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 02:52:56 INFO - 'tests': ['bloom_basic_singleton']}, 02:52:56 INFO - 'perf-reftest-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 02:52:56 INFO - 'tests': ['bloom_basic']}, 02:52:56 INFO - 'svgr-e10s': {'tests': ['tsvgx', 02:52:56 INFO - 'tsvgr_opacity', 02:52:56 INFO - 'tart', 02:52:56 INFO - 'tscrollx', 02:52:56 INFO - 'tsvg_static']}, 02:52:56 INFO - 'svgr-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 02:52:56 INFO - 'tests': ['tsvgx', 02:52:56 INFO - 'tsvgr_opacity', 02:52:56 INFO - 'tart', 02:52:56 INFO - 'tscrollx', 02:52:56 INFO - 'tsvg_static']}, 02:52:56 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 02:52:56 INFO - 'tp5o-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 02:52:56 INFO - 'talos_options': ['--disable-stylo'], 02:52:56 INFO - 'tests': ['tp5o']}, 02:52:56 INFO - 'tp6-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 02:52:56 INFO - 'talos_options': ['--mitmproxy', 02:52:56 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 02:52:56 INFO - '--firstNonBlankPaint'], 02:52:56 INFO - 'tests': ['tp6_google', 02:52:56 INFO - 'tp6_youtube', 02:52:56 INFO - 'tp6_amazon', 02:52:56 INFO - 'tp6_facebook']}, 02:52:56 INFO - 'tp6-stylo-disabled-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 02:52:56 INFO - 'talos_options': ['--disable-stylo', 02:52:56 INFO - '--mitmproxy', 02:52:56 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 02:52:56 INFO - '--firstNonBlankPaint'], 02:52:56 INFO - 'tests': ['tp6_google', 02:52:56 INFO - 'tp6_youtube', 02:52:56 INFO - 'tp6_amazon', 02:52:56 INFO - 'tp6_facebook']}, 02:52:56 INFO - 'tp6-stylo-threads-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 02:52:56 INFO - 'talos_options': ['--stylo-threads=1', 02:52:56 INFO - '--mitmproxy', 02:52:56 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 02:52:56 INFO - '--firstNonBlankPaint'], 02:52:56 INFO - 'tests': ['tp6_google', 02:52:56 INFO - 'tp6_youtube', 02:52:56 INFO - 'tp6_amazon', 02:52:56 INFO - 'tp6_facebook']}, 02:52:56 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 02:52:56 INFO - 'talos_options': ['--xperf_path', 02:52:56 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 02:52:56 INFO - 'tests': ['tp5n']}, 02:52:56 INFO - 'xperf-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 02:52:56 INFO - 'talos_options': ['--disable-stylo', 02:52:56 INFO - '--xperf_path', 02:52:56 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 02:52:56 INFO - 'tests': ['tp5n']}}} 02:52:56 INFO - Running post-action listener: _resource_record_post_action 02:52:56 INFO - [mozharness: 2017-09-15 09:52:56.123915Z] Finished populate-webroot step (success) 02:52:56 INFO - [mozharness: 2017-09-15 09:52:56.124005Z] Running create-virtualenv step. 02:52:56 INFO - Running pre-action listener: _resource_record_pre_action 02:52:56 INFO - Running main action method: create_virtualenv 02:52:56 INFO - Creating virtualenv /builds/slave/test/build/venv 02:52:56 INFO - Running command: ['virtualenv', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 02:52:56 INFO - Copy/paste: virtualenv --no-site-packages --distribute /builds/slave/test/build/venv 02:52:56 INFO - Using partial env: {'VIRTUALENV_NO_DOWNLOAD': '1'} 02:52:56 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 02:52:56 INFO - New python executable in /builds/slave/test/build/venv/bin/python 02:52:56 INFO - Installing distribute.............................................................................................................................................................................................done. 02:52:57 INFO - Installing pip...............done. 02:52:57 INFO - Return code: 0 02:52:57 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 02:52:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 02:52:57 INFO - Reading from file tmpfile_stdout 02:52:57 INFO - Output received: 02:52:57 INFO - pip 1.1 from /builds/slave/test/build/venv/lib/python2.7/site-packages/pip-1.1-py2.7.egg (python 2.7) 02:52:57 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 02:52:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 02:52:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:52:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 02:52:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:52:57 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/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 0x144d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1616a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x17b9a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17bd090>, '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 0x17bdd80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x17b7f90>, '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': '2432103b8b3de4003b23cad4000001c2-1505461794.715586-1022375943', '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 02:52:57 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--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 02:52:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 02:52:57 INFO - Using env: {'DISPLAY': ':0', 02:52:57 INFO - 'HOME': '/home/cltbld', 02:52:57 INFO - 'LANG': 'en_US.UTF-8', 02:52:57 INFO - 'LANGUAGE': 'en_US:en', 02:52:57 INFO - 'LOGNAME': 'cltbld', 02:52:57 INFO - 'MAIL': '/var/mail/cltbld', 02:52:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:52:57 INFO - 'MOZ_NO_REMOTE': '1', 02:52:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:52:57 INFO - 'NO_EM_RESTART': '1', 02:52:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:52:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:52:57 INFO - 'PWD': '/builds/slave/test', 02:52:57 INFO - 'SHELL': '/bin/bash', 02:52:57 INFO - 'SHLVL': '1', 02:52:57 INFO - 'TERM': 'linux', 02:52:57 INFO - 'TMOUT': '86400', 02:52:57 INFO - 'USER': 'cltbld', 02:52:57 INFO - 'XDG_SESSION_COOKIE': '2432103b8b3de4003b23cad4000001c2-1505461794.715586-1022375943', 02:52:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:52:57 INFO - '_': '/tools/buildbot/bin/python'} 02:52:58 INFO - Ignoring indexes: http://pypi.python.org/simple/ 02:52:58 INFO - Downloading/unpacking pip>=1.5 02:52:58 INFO - Running setup.py egg_info for package pip 02:52:58 INFO - warning: no files found matching 'pip/cacert.pem' 02:52:58 INFO - warning: no files found matching '*.html' under directory 'docs' 02:52:58 INFO - warning: no previously-included files matching '*.rst' found under directory 'docs/_build' 02:52:58 INFO - no previously-included directories found matching 'docs/_build/_sources' 02:52:58 INFO - Installing collected packages: pip 02:52:58 INFO - Found existing installation: pip 1.1 02:52:58 INFO - Uninstalling pip: 02:52:58 INFO - Successfully uninstalled pip 02:52:58 INFO - Running setup.py install for pip 02:52:58 INFO - warning: no files found matching 'pip/cacert.pem' 02:52:58 INFO - warning: no files found matching '*.html' under directory 'docs' 02:52:58 INFO - warning: no previously-included files matching '*.rst' found under directory 'docs/_build' 02:52:58 INFO - no previously-included directories found matching 'docs/_build/_sources' 02:52:58 INFO - Installing pip script to /builds/slave/test/build/venv/bin 02:52:58 INFO - Installing pip2.7 script to /builds/slave/test/build/venv/bin 02:52:58 INFO - Installing pip2 script to /builds/slave/test/build/venv/bin 02:52:58 INFO - Successfully installed pip 02:52:58 INFO - Cleaning up... 02:52:58 INFO - Return code: 0 02:52:58 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 02:52:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 02:52:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:52:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 02:52:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:52: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/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 0x144d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1616a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x17b9a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17bd090>, '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 0x17bdd80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x17b7f90>, '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': '2432103b8b3de4003b23cad4000001c2-1505461794.715586-1022375943', '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 02:52:58 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--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 02:52:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 02:52:58 INFO - Using env: {'DISPLAY': ':0', 02:52:58 INFO - 'HOME': '/home/cltbld', 02:52:58 INFO - 'LANG': 'en_US.UTF-8', 02:52:58 INFO - 'LANGUAGE': 'en_US:en', 02:52:58 INFO - 'LOGNAME': 'cltbld', 02:52:58 INFO - 'MAIL': '/var/mail/cltbld', 02:52:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:52:58 INFO - 'MOZ_NO_REMOTE': '1', 02:52:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:52:58 INFO - 'NO_EM_RESTART': '1', 02:52:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:52:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:52:58 INFO - 'PWD': '/builds/slave/test', 02:52:58 INFO - 'SHELL': '/bin/bash', 02:52:58 INFO - 'SHLVL': '1', 02:52:58 INFO - 'TERM': 'linux', 02:52:58 INFO - 'TMOUT': '86400', 02:52:58 INFO - 'USER': 'cltbld', 02:52:58 INFO - 'XDG_SESSION_COOKIE': '2432103b8b3de4003b23cad4000001c2-1505461794.715586-1022375943', 02:52:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:52:58 INFO - '_': '/tools/buildbot/bin/python'} 02:52:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:52:58 INFO - Downloading/unpacking psutil>=3.1.1 02:52: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 02:52: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 02:52: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 02:52: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 02:52:59 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 02:52:59 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 02:52:59 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 02:52:59 INFO - Installing collected packages: psutil 02:52:59 INFO - Running setup.py install for psutil 02:52:59 INFO - building 'psutil._psutil_linux' extension 02:52:59 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 02:53:00 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 02:53:00 INFO - building 'psutil._psutil_posix' extension 02:53:00 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 02:53:00 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 02:53:00 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 02:53:00 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 02:53:00 INFO - Successfully installed psutil 02:53:00 INFO - Cleaning up... 02:53:00 INFO - Return code: 0 02:53:00 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 02:53:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 02:53:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:53:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 02:53:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:53:00 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/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 0x144d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1616a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x17b9a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17bd090>, '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 0x17bdd80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x17b7f90>, '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': '2432103b8b3de4003b23cad4000001c2-1505461794.715586-1022375943', '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 02:53:00 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--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 02:53:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 02:53:00 INFO - Using env: {'DISPLAY': ':0', 02:53:00 INFO - 'HOME': '/home/cltbld', 02:53:00 INFO - 'LANG': 'en_US.UTF-8', 02:53:00 INFO - 'LANGUAGE': 'en_US:en', 02:53:00 INFO - 'LOGNAME': 'cltbld', 02:53:00 INFO - 'MAIL': '/var/mail/cltbld', 02:53:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:53:00 INFO - 'MOZ_NO_REMOTE': '1', 02:53:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:53:00 INFO - 'NO_EM_RESTART': '1', 02:53:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:53:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:53:00 INFO - 'PWD': '/builds/slave/test', 02:53:00 INFO - 'SHELL': '/bin/bash', 02:53:00 INFO - 'SHLVL': '1', 02:53:00 INFO - 'TERM': 'linux', 02:53:00 INFO - 'TMOUT': '86400', 02:53:00 INFO - 'USER': 'cltbld', 02:53:00 INFO - 'XDG_SESSION_COOKIE': '2432103b8b3de4003b23cad4000001c2-1505461794.715586-1022375943', 02:53:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:53:00 INFO - '_': '/tools/buildbot/bin/python'} 02:53:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:53:00 INFO - Downloading/unpacking mozsystemmonitor==0.3 02:53: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 02:53: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 02:53: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 02:53: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 02:53:01 INFO - Downloading mozsystemmonitor-0.3.tar.gz 02:53:01 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 02:53:01 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 02:53:01 INFO - Installing collected packages: mozsystemmonitor 02:53:01 INFO - Running setup.py install for mozsystemmonitor 02:53:02 INFO - Successfully installed mozsystemmonitor 02:53:02 INFO - Cleaning up... 02:53:02 INFO - Return code: 0 02:53:03 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 02:53:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 02:53:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:53:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 02:53:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:53:03 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/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 0x144d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1616a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x17b9a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17bd090>, '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 0x17bdd80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x17b7f90>, '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': '2432103b8b3de4003b23cad4000001c2-1505461794.715586-1022375943', '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 02:53:03 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--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 02:53:03 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 02:53:03 INFO - Using env: {'DISPLAY': ':0', 02:53:03 INFO - 'HOME': '/home/cltbld', 02:53:03 INFO - 'LANG': 'en_US.UTF-8', 02:53:03 INFO - 'LANGUAGE': 'en_US:en', 02:53:03 INFO - 'LOGNAME': 'cltbld', 02:53:03 INFO - 'MAIL': '/var/mail/cltbld', 02:53:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:53:03 INFO - 'MOZ_NO_REMOTE': '1', 02:53:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:53:03 INFO - 'NO_EM_RESTART': '1', 02:53:03 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:53:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:53:03 INFO - 'PWD': '/builds/slave/test', 02:53:03 INFO - 'SHELL': '/bin/bash', 02:53:03 INFO - 'SHLVL': '1', 02:53:03 INFO - 'TERM': 'linux', 02:53:03 INFO - 'TMOUT': '86400', 02:53:03 INFO - 'USER': 'cltbld', 02:53:03 INFO - 'XDG_SESSION_COOKIE': '2432103b8b3de4003b23cad4000001c2-1505461794.715586-1022375943', 02:53:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:53:03 INFO - '_': '/tools/buildbot/bin/python'} 02:53:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:53:04 INFO - Downloading/unpacking jsonschema==2.5.1 02:53: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 02:53: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 02:53: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 02:53: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 02:53:05 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 02:53:05 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 02:53:05 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 02:53:05 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 02:53:05 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 02:53:05 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 02:53:06 INFO - Downloading functools32-3.2.3-2.tar.gz 02:53:06 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 02:53:06 INFO - warning: no files found matching '*.txt' 02:53:06 INFO - no previously-included directories found matching 'build' 02:53:06 INFO - no previously-included directories found matching 'dist' 02:53:06 INFO - no previously-included directories found matching '.git*' 02:53:06 INFO - Installing collected packages: jsonschema, functools32 02:53:06 INFO - Running setup.py install for functools32 02:53:06 INFO - warning: no files found matching '*.txt' 02:53:06 INFO - no previously-included directories found matching 'build' 02:53:06 INFO - no previously-included directories found matching 'dist' 02:53:06 INFO - no previously-included directories found matching '.git*' 02:53:06 INFO - Successfully installed jsonschema functools32 02:53:06 INFO - Cleaning up... 02:53:06 INFO - Return code: 0 02:53:06 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 02:53:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 02:53:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:53:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 02:53:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:53:06 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/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 0x144d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1616a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x17b9a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17bd090>, '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 0x17bdd80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x17b7f90>, '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': '2432103b8b3de4003b23cad4000001c2-1505461794.715586-1022375943', '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 02:53:06 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--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 02:53:06 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 02:53:06 INFO - Using env: {'DISPLAY': ':0', 02:53:06 INFO - 'HOME': '/home/cltbld', 02:53:06 INFO - 'LANG': 'en_US.UTF-8', 02:53:06 INFO - 'LANGUAGE': 'en_US:en', 02:53:06 INFO - 'LOGNAME': 'cltbld', 02:53:06 INFO - 'MAIL': '/var/mail/cltbld', 02:53:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:53:06 INFO - 'MOZ_NO_REMOTE': '1', 02:53:06 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:53:06 INFO - 'NO_EM_RESTART': '1', 02:53:06 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:53:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:53:06 INFO - 'PWD': '/builds/slave/test', 02:53:06 INFO - 'SHELL': '/bin/bash', 02:53:06 INFO - 'SHLVL': '1', 02:53:06 INFO - 'TERM': 'linux', 02:53:06 INFO - 'TMOUT': '86400', 02:53:06 INFO - 'USER': 'cltbld', 02:53:06 INFO - 'XDG_SESSION_COOKIE': '2432103b8b3de4003b23cad4000001c2-1505461794.715586-1022375943', 02:53:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:53:06 INFO - '_': '/tools/buildbot/bin/python'} 02:53:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:53:06 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 02:53:06 INFO - Cleaning up... 02:53:06 INFO - Return code: 0 02:53:06 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 02:53:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 02:53:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:53:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 02:53:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:53:06 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/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 0x144d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1616a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x17b9a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17bd090>, '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 0x17bdd80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x17b7f90>, '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': '2432103b8b3de4003b23cad4000001c2-1505461794.715586-1022375943', '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 02:53:06 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--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 02:53:06 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 02:53:06 INFO - Using env: {'DISPLAY': ':0', 02:53:06 INFO - 'HOME': '/home/cltbld', 02:53:06 INFO - 'LANG': 'en_US.UTF-8', 02:53:06 INFO - 'LANGUAGE': 'en_US:en', 02:53:06 INFO - 'LOGNAME': 'cltbld', 02:53:06 INFO - 'MAIL': '/var/mail/cltbld', 02:53:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:53:06 INFO - 'MOZ_NO_REMOTE': '1', 02:53:06 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:53:06 INFO - 'NO_EM_RESTART': '1', 02:53:06 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:53:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:53:06 INFO - 'PWD': '/builds/slave/test', 02:53:06 INFO - 'SHELL': '/bin/bash', 02:53:06 INFO - 'SHLVL': '1', 02:53:06 INFO - 'TERM': 'linux', 02:53:06 INFO - 'TMOUT': '86400', 02:53:06 INFO - 'USER': 'cltbld', 02:53:06 INFO - 'XDG_SESSION_COOKIE': '2432103b8b3de4003b23cad4000001c2-1505461794.715586-1022375943', 02:53:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:53:06 INFO - '_': '/tools/buildbot/bin/python'} 02:53:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:53:06 INFO - Downloading/unpacking blobuploader==1.2.4 02:53:06 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:53:06 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:53:06 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:53:06 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:53:07 INFO - Downloading blobuploader-1.2.4.tar.gz 02:53:07 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 02:53:07 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 02:53:07 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 02:53:07 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 02:53:07 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 02:53:07 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 02:53:08 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 02:53:08 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 02:53:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:53:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:53:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:53:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:53:08 INFO - Downloading docopt-0.6.1.tar.gz 02:53:08 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 02:53:08 INFO - Installing collected packages: blobuploader, requests, docopt 02:53:08 INFO - Running setup.py install for blobuploader 02:53:08 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 02:53:08 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 02:53:08 INFO - Running setup.py install for requests 02:53:08 INFO - Running setup.py install for docopt 02:53:09 INFO - Successfully installed blobuploader requests docopt 02:53:09 INFO - Cleaning up... 02:53:09 INFO - Return code: 0 02:53:09 INFO - Installing None into virtualenv /builds/slave/test/build/venv 02:53:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 02:53:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:53:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 02:53:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:53:09 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/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 0x144d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1616a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x17b9a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17bd090>, '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 0x17bdd80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x17b7f90>, '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': '2432103b8b3de4003b23cad4000001c2-1505461794.715586-1022375943', '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 02:53:09 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/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 02:53:09 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/pub --find-links http://pypi.pub.build.mozilla.org/pub 02:53:09 INFO - Using env: {'DISPLAY': ':0', 02:53:09 INFO - 'HOME': '/home/cltbld', 02:53:09 INFO - 'LANG': 'en_US.UTF-8', 02:53:09 INFO - 'LANGUAGE': 'en_US:en', 02:53:09 INFO - 'LOGNAME': 'cltbld', 02:53:09 INFO - 'MAIL': '/var/mail/cltbld', 02:53:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:53:09 INFO - 'MOZ_NO_REMOTE': '1', 02:53:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:53:09 INFO - 'NO_EM_RESTART': '1', 02:53:09 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:53:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:53:09 INFO - 'PWD': '/builds/slave/test', 02:53:09 INFO - 'SHELL': '/bin/bash', 02:53:09 INFO - 'SHLVL': '1', 02:53:09 INFO - 'TERM': 'linux', 02:53:09 INFO - 'TMOUT': '86400', 02:53:09 INFO - 'USER': 'cltbld', 02:53:09 INFO - 'XDG_SESSION_COOKIE': '2432103b8b3de4003b23cad4000001c2-1505461794.715586-1022375943', 02:53:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:53:09 INFO - '_': '/tools/buildbot/bin/python'} 02:53:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:53:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 02:53:09 INFO - Running setup.py (path:/tmp/pip-ZcGMgQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 02:53:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 02:53:09 INFO - Running setup.py (path:/tmp/pip-0rHqi3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 02:53:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 02:53:09 INFO - Running setup.py (path:/tmp/pip-GG0RpT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 02:53:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 02:53:09 INFO - Running setup.py (path:/tmp/pip-LpiokJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 02:53:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 02:53:09 INFO - Running setup.py (path:/tmp/pip-pjGgCP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 02:53:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 02:53:09 INFO - Running setup.py (path:/tmp/pip-FyFfsE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 02:53:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 02:53:09 INFO - Running setup.py (path:/tmp/pip-Jykqlk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 02:53:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 02:53:09 INFO - Running setup.py (path:/tmp/pip-nrs_eb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 02:53:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 02:53:09 INFO - Running setup.py (path:/tmp/pip-PQkRXD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 02:53:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 02:53:09 INFO - Running setup.py (path:/tmp/pip-DBji8n-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 02:53:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 02:53:09 INFO - Running setup.py (path:/tmp/pip-b_Uder-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 02:53:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 02:53:10 INFO - Running setup.py (path:/tmp/pip-WdDbhf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 02:53:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 02:53:10 INFO - Running setup.py (path:/tmp/pip-ztr1KT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 02:53:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 02:53:10 INFO - Running setup.py (path:/tmp/pip-6dFo1N-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 02:53:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 02:53:10 INFO - Running setup.py (path:/tmp/pip-o27GWU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 02:53:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 02:53:10 INFO - Running setup.py (path:/tmp/pip-rQX2Ic-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 02:53:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 02:53:10 INFO - Running setup.py (path:/tmp/pip-5_vgsI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 02:53:10 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 02:53:10 INFO - Running setup.py install for manifestparser 02:53:10 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 02:53:10 INFO - Running setup.py install for mozcrash 02:53:10 INFO - Running setup.py install for mozdebug 02:53:10 INFO - Running setup.py install for mozdevice 02:53:10 INFO - Installing dm script to /builds/slave/test/build/venv/bin 02:53:10 INFO - Running setup.py install for mozfile 02:53:10 INFO - Running setup.py install for mozhttpd 02:53:11 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 02:53:11 INFO - Running setup.py install for mozinfo 02:53:11 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 02:53:11 INFO - Running setup.py install for mozInstall 02:53:11 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 02:53:11 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 02:53:11 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 02:53:11 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 02:53:11 INFO - Running setup.py install for mozleak 02:53:11 INFO - Running setup.py install for mozlog 02:53:11 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 02:53:11 INFO - Running setup.py install for moznetwork 02:53:11 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 02:53:11 INFO - Running setup.py install for mozprocess 02:53:11 INFO - Running setup.py install for mozprofile 02:53:11 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 02:53:11 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 02:53:11 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 02:53:11 INFO - Running setup.py install for mozrunner 02:53:11 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 02:53:11 INFO - Running setup.py install for mozscreenshot 02:53:12 INFO - Running setup.py install for moztest 02:53:12 INFO - Running setup.py install for mozversion 02:53:12 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 02:53:12 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 02:53:12 INFO - Cleaning up... 02:53:12 INFO - Return code: 0 02:53:12 INFO - Installing None into virtualenv /builds/slave/test/build/venv 02:53:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 02:53:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:53:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 02:53:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:53:12 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/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 0x144d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1616a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x17b9a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17bd090>, '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 0x17bdd80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x17b7f90>, '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': '2432103b8b3de4003b23cad4000001c2-1505461794.715586-1022375943', '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 02:53:12 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/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 02:53:12 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/pub --find-links http://pypi.pub.build.mozilla.org/pub 02:53:12 INFO - Using env: {'DISPLAY': ':0', 02:53:12 INFO - 'HOME': '/home/cltbld', 02:53:12 INFO - 'LANG': 'en_US.UTF-8', 02:53:12 INFO - 'LANGUAGE': 'en_US:en', 02:53:12 INFO - 'LOGNAME': 'cltbld', 02:53:12 INFO - 'MAIL': '/var/mail/cltbld', 02:53:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:53:12 INFO - 'MOZ_NO_REMOTE': '1', 02:53:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:53:12 INFO - 'NO_EM_RESTART': '1', 02:53:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:53:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:53:12 INFO - 'PWD': '/builds/slave/test', 02:53:12 INFO - 'SHELL': '/bin/bash', 02:53:12 INFO - 'SHLVL': '1', 02:53:12 INFO - 'TERM': 'linux', 02:53:12 INFO - 'TMOUT': '86400', 02:53:12 INFO - 'USER': 'cltbld', 02:53:12 INFO - 'XDG_SESSION_COOKIE': '2432103b8b3de4003b23cad4000001c2-1505461794.715586-1022375943', 02:53:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:53:12 INFO - '_': '/tools/buildbot/bin/python'} 02:53:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:53:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 02:53:12 INFO - Running setup.py (path:/tmp/pip-uY2SrH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 02:53:12 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)) 02:53:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 02:53:12 INFO - Running setup.py (path:/tmp/pip-RQmGt1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 02:53:12 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)) 02:53:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 02:53:12 INFO - Running setup.py (path:/tmp/pip-qzCq4P-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 02:53:12 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)) 02:53:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 02:53:12 INFO - Running setup.py (path:/tmp/pip-sh3X5U-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 02:53:12 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.51 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)) 02:53:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 02:53:12 INFO - Running setup.py (path:/tmp/pip-fZPN7N-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 02:53:12 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)) 02:53:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 02:53:12 INFO - Running setup.py (path:/tmp/pip-F0Dt4y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 02:53:12 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)) 02:53:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 02:53:12 INFO - Running setup.py (path:/tmp/pip-cc_bUZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 02:53:12 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.10 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)) 02:53:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 02:53:12 INFO - Running setup.py (path:/tmp/pip-wBth_I-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 02:53:13 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.13 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)) 02:53:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 02:53:13 INFO - Running setup.py (path:/tmp/pip-iwn1bH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 02:53:13 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)) 02:53:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 02:53:13 INFO - Running setup.py (path:/tmp/pip-u3RaKU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 02:53:13 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.5 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)) 02:53:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 02:53:13 INFO - Running setup.py (path:/tmp/pip-vKv9w9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 02:53:13 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)) 02:53:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 02:53:13 INFO - Running setup.py (path:/tmp/pip-eRbhNR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 02:53:13 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)) 02:53:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 02:53:13 INFO - Running setup.py (path:/tmp/pip-kFb8sS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 02:53:13 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)) 02:53:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 02:53:13 INFO - Running setup.py (path:/tmp/pip-FRsfKA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 02:53:13 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)) 02:53:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 02:53:13 INFO - Running setup.py (path:/tmp/pip-IiguMB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 02:53:13 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)) 02:53:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 02:53:13 INFO - Running setup.py (path:/tmp/pip-dGhkhn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 02:53:13 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)) 02:53:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 02:53:13 INFO - Running setup.py (path:/tmp/pip-PLxWQL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 02:53:13 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)) 02:53:13 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)) 02:53:13 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)) 02:53:13 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)) 02:53:13 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.51->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 02:53:13 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.51->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 02:53:13 INFO - Requirement already satisfied (use --upgrade to upgrade): requests in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozInstall==1.13->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 02:53:13 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.5->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 02:53:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:53:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:53:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:53:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:53:14 INFO - Downloading blessings-1.6.tar.gz 02:53:14 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 02:53:15 INFO - Installing collected packages: blessings 02:53:15 INFO - Running setup.py install for blessings 02:53:15 INFO - Successfully installed blessings 02:53:15 INFO - Cleaning up... 02:53:15 INFO - Return code: 0 02:53:15 INFO - Done creating virtualenv /builds/slave/test/build/venv. 02:53:15 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 02:53:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 02:53:15 INFO - Reading from file tmpfile_stdout 02:53:15 INFO - Current package versions: 02:53:15 INFO - argparse == 1.2.1 02:53:15 INFO - blessings == 1.6 02:53:15 INFO - blobuploader == 1.2.4 02:53:15 INFO - docopt == 0.6.1 02:53:15 INFO - functools32 == 3.2.3-2 02:53:15 INFO - jsonschema == 2.5.1 02:53:15 INFO - manifestparser == 1.1 02:53:15 INFO - mozInstall == 1.13 02:53:15 INFO - mozcrash == 1.0 02:53:15 INFO - mozdebug == 0.1 02:53:15 INFO - mozdevice == 0.51 02:53:15 INFO - mozfile == 1.2 02:53:15 INFO - mozhttpd == 0.7 02:53:15 INFO - mozinfo == 0.10 02:53:15 INFO - mozleak == 0.1 02:53:15 INFO - mozlog == 3.5 02:53:15 INFO - moznetwork == 0.27 02:53:15 INFO - mozprocess == 0.25 02:53:15 INFO - mozprofile == 0.28 02:53:15 INFO - mozrunner == 6.13 02:53:15 INFO - mozscreenshot == 0.1 02:53:15 INFO - mozsystemmonitor == 0.3 02:53:15 INFO - moztest == 0.8 02:53:15 INFO - mozversion == 1.4 02:53:15 INFO - psutil == 3.1.1 02:53:15 INFO - requests == 1.2.3 02:53:15 INFO - wsgiref == 0.1.2 02:53:15 INFO - Installing None into virtualenv /builds/slave/test/build/venv 02:53:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 02:53:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:53:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 02:53:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:53:15 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/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 0x144d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1616a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x17b9a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17bd090>, '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 0x17bdd80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x17b7f90>, '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': '2432103b8b3de4003b23cad4000001c2-1505461794.715586-1022375943', '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 02:53:15 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/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 02:53:15 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/pub --find-links http://pypi.pub.build.mozilla.org/pub 02:53:15 INFO - Using env: {'DISPLAY': ':0', 02:53:15 INFO - 'HOME': '/home/cltbld', 02:53:15 INFO - 'LANG': 'en_US.UTF-8', 02:53:15 INFO - 'LANGUAGE': 'en_US:en', 02:53:15 INFO - 'LOGNAME': 'cltbld', 02:53:15 INFO - 'MAIL': '/var/mail/cltbld', 02:53:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:53:15 INFO - 'MOZ_NO_REMOTE': '1', 02:53:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:53:15 INFO - 'NO_EM_RESTART': '1', 02:53:15 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:53:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:53:15 INFO - 'PWD': '/builds/slave/test', 02:53:15 INFO - 'SHELL': '/bin/bash', 02:53:15 INFO - 'SHLVL': '1', 02:53:15 INFO - 'TERM': 'linux', 02:53:15 INFO - 'TMOUT': '86400', 02:53:15 INFO - 'USER': 'cltbld', 02:53:15 INFO - 'XDG_SESSION_COOKIE': '2432103b8b3de4003b23cad4000001c2-1505461794.715586-1022375943', 02:53:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:53:15 INFO - '_': '/tools/buildbot/bin/python'} 02:53:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:53:15 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)) 02:53:15 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)) 02:53:15 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)) 02:53:15 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)) 02:53:15 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)) 02:53:15 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)) 02:53:15 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)) 02:53:15 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)) 02:53:15 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)) 02:53:15 INFO - Downloading/unpacking simplejson>=2.1.1 (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 10)) 02:53:15 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 02:53:15 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 02:53:15 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 02:53:15 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 02:53:16 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/simplejson/setup.py) egg_info for package simplejson 02:53:16 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)) 02:53:16 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)) 02:53:16 INFO - Installing collected packages: simplejson 02:53:16 INFO - Running setup.py install for simplejson 02:53:16 INFO - building 'simplejson._speedups' extension 02:53:16 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c simplejson/_speedups.c -o build/temp.linux-x86_64-2.7/simplejson/_speedups.o 02:53:17 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/simplejson/_speedups.o -o build/lib.linux-x86_64-2.7/simplejson/_speedups.so 02:53:17 INFO - Successfully installed simplejson 02:53:17 INFO - Cleaning up... 02:53:17 INFO - Return code: 0 02:53:17 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 02:53:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 02:53:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:53:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 02:53:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:53:17 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/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 0x144d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1616a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x17b9a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17bd090>, '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 0x17bdd80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x17b7f90>, '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': '2432103b8b3de4003b23cad4000001c2-1505461794.715586-1022375943', '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 02:53:17 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 02:53:17 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 02:53:17 INFO - Using env: {'DISPLAY': ':0', 02:53:17 INFO - 'HOME': '/home/cltbld', 02:53:17 INFO - 'LANG': 'en_US.UTF-8', 02:53:17 INFO - 'LANGUAGE': 'en_US:en', 02:53:17 INFO - 'LOGNAME': 'cltbld', 02:53:17 INFO - 'MAIL': '/var/mail/cltbld', 02:53:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:53:17 INFO - 'MOZ_NO_REMOTE': '1', 02:53:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:53:17 INFO - 'NO_EM_RESTART': '1', 02:53:17 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:53:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:53:17 INFO - 'PWD': '/builds/slave/test', 02:53:17 INFO - 'SHELL': '/bin/bash', 02:53:17 INFO - 'SHLVL': '1', 02:53:17 INFO - 'TERM': 'linux', 02:53:17 INFO - 'TMOUT': '86400', 02:53:17 INFO - 'USER': 'cltbld', 02:53:17 INFO - 'XDG_SESSION_COOKIE': '2432103b8b3de4003b23cad4000001c2-1505461794.715586-1022375943', 02:53:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:53:17 INFO - '_': '/tools/buildbot/bin/python'} 02:53:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:53:18 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 02:53:18 INFO - Cleaning up... 02:53:18 INFO - Return code: 0 02:53:18 INFO - Running post-action listener: _resource_record_post_action 02:53:18 INFO - Running post-action listener: _start_resource_monitoring 02:53:18 INFO - Starting resource monitoring. 02:53:18 INFO - [mozharness: 2017-09-15 09:53:18.103032Z] Finished create-virtualenv step (success) 02:53:18 INFO - [mozharness: 2017-09-15 09:53:18.103553Z] Running install step. 02:53:18 INFO - Running pre-action listener: _resource_record_pre_action 02:53:18 INFO - Running main action method: install 02:53:18 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 02:53:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 02:53:18 INFO - Reading from file tmpfile_stdout 02:53:18 INFO - Detecting whether we're running mozinstall >=1.0... 02:53:18 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 02:53:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 02:53:18 INFO - Reading from file tmpfile_stdout 02:53:18 INFO - Output received: 02:53:18 INFO - Usage: mozinstall [options] installer 02:53:18 INFO - Options: 02:53:18 INFO - -h, --help show this help message and exit 02:53:18 INFO - -d DEST, --destination=DEST 02:53:18 INFO - Directory to install application into. [default: 02:53:18 INFO - "/builds/slave/test"] 02:53:18 INFO - --app=APP Application being installed. [default: firefox] 02:53:18 INFO - mkdir: /builds/slave/test/build/application 02:53:18 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'] 02:53:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 02:53:36 INFO - Reading from file tmpfile_stdout 02:53:36 INFO - Output received: 02:53:36 INFO - /builds/slave/test/build/application/firefox/firefox 02:53:36 INFO - Running post-action listener: _resource_record_post_action 02:53:36 INFO - [mozharness: 2017-09-15 09:53:36.189135Z] Finished install step (success) 02:53:36 INFO - [mozharness: 2017-09-15 09:53:36.189385Z] Running setup-mitmproxy step. 02:53:36 INFO - Running pre-action listener: _resource_record_pre_action 02:53:36 INFO - Running main action method: setup_mitmproxy 02:53:36 INFO - Skipping: mitmproxy is not required 02:53:36 INFO - Running post-action listener: _resource_record_post_action 02:53:36 INFO - [mozharness: 2017-09-15 09:53:36.190594Z] Finished setup-mitmproxy step (success) 02:53:36 INFO - [mozharness: 2017-09-15 09:53:36.190813Z] Running run-tests step. 02:53:36 INFO - Running pre-action listener: _resource_record_pre_action 02:53:36 INFO - Running pre-action listener: _set_gcov_prefix 02:53:36 INFO - Running main action method: run_tests 02:53:36 WARNING - Try message not found. 02:53:36 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 02:53:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 02:53:36 INFO - Python 2.7.3 02:53:36 INFO - Return code: 0 02:53:36 INFO - grabbing minidump binary from tooltool 02:53:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 02:53:36 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://tooltool.mozilla-releng.net/', '--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 0x17bd090>, '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 0x17bdd80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x17b7f90>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 02:53:36 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://tooltool.mozilla-releng.net/', '--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 02:53:36 INFO - Copy/paste: /tools/tooltool.py --url https://tooltool.mozilla-releng.net/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 02:53:36 INFO - Calling ['/tools/tooltool.py', '--url', 'https://tooltool.mozilla-releng.net/', '--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 02:53:36 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 02:53:36 INFO - Return code: 0 02:53:36 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 02:53:36 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 02:53:36 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 02:53:36 INFO - ENV: RUST_BACKTRACE is now full 02:53:36 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 02:53:36 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 02:53:36 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs-stylo-disabled-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/WmwENJ0_TWeFxfcKwYDDvw/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-070', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-stylo-disabled-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-stylo-disabled-e10s_raw.log'] in /builds/slave/test/build 02:53:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox-Non-PGO --suite dromaeojs-stylo-disabled-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/WmwENJ0_TWeFxfcKwYDDvw/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-070 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-stylo-disabled-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-stylo-disabled-e10s_raw.log 02:53:36 INFO - Using env: {'DISPLAY': ':0', 02:53:36 INFO - 'HOME': '/home/cltbld', 02:53:36 INFO - 'LANG': 'en_US.UTF-8', 02:53:36 INFO - 'LANGUAGE': 'en_US:en', 02:53:36 INFO - 'LOGNAME': 'cltbld', 02:53:36 INFO - 'MAIL': '/var/mail/cltbld', 02:53:36 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 02:53:36 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 02:53:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:53:36 INFO - 'MOZ_NO_REMOTE': '1', 02:53:36 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 02:53:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:53:36 INFO - 'NO_EM_RESTART': '1', 02:53:36 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:53:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:53:36 INFO - 'PWD': '/builds/slave/test', 02:53:36 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 02:53:36 INFO - 'RUST_BACKTRACE': 'full', 02:53:36 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 02:53:36 INFO - 'SHELL': '/bin/bash', 02:53:36 INFO - 'SHLVL': '1', 02:53:36 INFO - 'TERM': 'linux', 02:53:36 INFO - 'TMOUT': '86400', 02:53:36 INFO - 'USER': 'cltbld', 02:53:36 INFO - 'XDG_SESSION_COOKIE': '2432103b8b3de4003b23cad4000001c2-1505461794.715586-1022375943', 02:53:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:53:36 INFO - '_': '/tools/buildbot/bin/python'} 02:53:36 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs-stylo-disabled-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/WmwENJ0_TWeFxfcKwYDDvw/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-070', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-stylo-disabled-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-stylo-disabled-e10s_raw.log'] with output_timeout 3600 02:53:36 INFO - mozversion application_buildid: 20170915090318 02:53:36 INFO - mozversion application_changeset: f36106f3f52a9bb2769860d20568c589fc2498d0 02:53:36 INFO - mozversion application_display_name: Nightly 02:53:36 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 02:53:36 INFO - mozversion application_name: Firefox 02:53:36 INFO - mozversion application_remotingname: firefox 02:53:36 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 02:53:36 INFO - mozversion application_vendor: Mozilla 02:53:36 INFO - mozversion application_version: 57.0a1 02:53:36 INFO - mozversion platform_buildid: 20170915090318 02:53:36 INFO - mozversion platform_changeset: f36106f3f52a9bb2769860d20568c589fc2498d0 02:53:36 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 02:53:36 INFO - mozversion platform_version: 57.0a1 02:53:36 INFO - using testdate: 1505469216 02:53:36 INFO - actual date: 1505469216 02:53:36 INFO - starting webserver on 'localhost:39935' 02:53:36 INFO - SUITE-START | Running 2 tests 02:53:36 INFO - TEST-START | dromaeo_css 02:53:36 INFO - Initialising browser for dromaeo_css test... 02:53:36 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:39935/getInfo.html -profile /tmp/tmph8Z5kf/profile 02:53:36 INFO - TEST-INFO | started process 9705 (/builds/slave/test/build/application/firefox/firefox http://localhost:39935/getInfo.html) 02:53:41 INFO - TEST-INFO | 9705: exit 0 02:53:41 INFO - Browser initialized. 02:53:41 INFO - Running cycle 1/1 for dromaeo_css test... 02:53:41 INFO - Using env: {'DISPLAY': ':0', 02:53:41 INFO - 'HOME': '/home/cltbld', 02:53:41 INFO - 'JSGC_DISABLE_POISONING': '1', 02:53:41 INFO - 'LANG': 'en_US.UTF-8', 02:53:41 INFO - 'LANGUAGE': 'en_US:en', 02:53:41 INFO - 'LD_LIBRARY_PATH': '/builds/slave/test/build/application/firefox', 02:53:41 INFO - 'LOGNAME': 'cltbld', 02:53:41 INFO - 'MAIL': '/var/mail/cltbld', 02:53:41 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 02:53:41 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 02:53:41 INFO - 'MOZ_CRASHREPORTER': '1', 02:53:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:53:41 INFO - 'MOZ_DISABLE_NONLOCAL_CONNECTIONS': '1', 02:53:41 INFO - 'MOZ_NO_REMOTE': '1', 02:53:41 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 02:53:41 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:53:41 INFO - 'NO_EM_RESTART': '1', 02:53:41 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:53:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:53:41 INFO - 'PWD': '/builds/slave/test', 02:53:41 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 02:53:41 INFO - 'RUST_BACKTRACE': 'full', 02:53:41 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 02:53:41 INFO - 'SHELL': '/bin/bash', 02:53:41 INFO - 'SHLVL': '1', 02:53:41 INFO - 'STYLO_FORCE_DISABLED': '1', 02:53:41 INFO - 'TERM': 'linux', 02:53:41 INFO - 'TMOUT': '86400', 02:53:41 INFO - 'USER': 'cltbld', 02:53:41 INFO - 'XDG_SESSION_COOKIE': '2432103b8b3de4003b23cad4000001c2-1505461794.715586-1022375943', 02:53:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:53:41 INFO - '_': '/tools/buildbot/bin/python'} 02:53:41 INFO - TEST-INFO | started process 9935 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmph8Z5kf/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 02:53:42 INFO - PID 9935 | 02:53:42 INFO - PID 9935 | (/builds/slave/test/build/application/firefox/firefox:9985): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 02:53:42 INFO - PID 9935 | 02:53:53 INFO - PID 9935 | RSS: Main: 173502464 02:53:53 INFO - PID 9935 | 02:56:50 INFO - PID 9935 | Cycle 1(1): loaded http://localhost:39935/tests/dromaeo/cssquery-dojo.html (next: http://localhost:39935/tests/dromaeo/cssquery-ext.html) 02:56:52 INFO - PID 9935 | RSS: Main: 175747072 02:56:52 INFO - PID 9935 | 02:59:54 INFO - PID 9935 | Cycle 1(1): loaded http://localhost:39935/tests/dromaeo/cssquery-ext.html (next: http://localhost:39935/tests/dromaeo/cssquery-jquery.html) 02:59:54 INFO - PID 9935 | RSS: Main: 170430464 02:59:54 INFO - PID 9935 | 03:02:56 INFO - PID 9935 | Cycle 1(1): loaded http://localhost:39935/tests/dromaeo/cssquery-jquery.html (next: http://localhost:39935/tests/dromaeo/cssquery-mootools.html) 03:02:57 INFO - PID 9935 | RSS: Main: 173199360 03:02:57 INFO - PID 9935 | 03:05:58 INFO - PID 9935 | Cycle 1(1): loaded http://localhost:39935/tests/dromaeo/cssquery-mootools.html (next: http://localhost:39935/tests/dromaeo/cssquery-prototype.html) 03:05:59 INFO - PID 9935 | RSS: Main: 173023232 03:05:59 INFO - PID 9935 | 03:09:02 INFO - PID 9935 | Cycle 1(1): loaded http://localhost:39935/tests/dromaeo/cssquery-prototype.html (next: http://localhost:39935/tests/dromaeo/cssquery-yui.html) 03:09:03 INFO - PID 9935 | RSS: Main: 174686208 03:09:03 INFO - PID 9935 | 03:12:05 INFO - PID 9935 | Cycle 1(1): loaded http://localhost:39935/tests/dromaeo/cssquery-yui.html (next: http://localhost:39935/tests/dromaeo/cssquery-dojo.html) 03:12:05 INFO - PID 9935 | RSS: Main: 176271360 03:12:05 INFO - PID 9935 | 03:12:05 INFO - PID 9935 | __start_tp_report 03:12:05 INFO - PID 9935 | _x_x_mozilla_page_load 03:12:05 INFO - PID 9935 | _x_x_mozilla_page_load_details 03:12:05 INFO - PID 9935 | |i|pagename|runs| 03:12:05 INFO - PID 9935 | |0;dojo.html;3133.1853718033312;3163.414768267871;3220.8389580520966;3226.1934516370893;3235.3529294141176;6198.256209254896;6341.302456729762;6412.070249813774;6412.230532336121;6462.256840463342;6290.748370065192;6296.150019747332;6420.678966051702;6426.164598602187;6490.415862572368;5831.737571809279;5880.617759845596;5882.823515294537;5902.291724992985;5939.703014849262;5788.392218817026;5862.765489380419;5865.266841644794;5918.526517878581;5972.163897054415;5830.970845145789;5862.765489380398;5916.615419997686;5969;6009.87980240395;5695.829125126212;5779.653220806723;5873.618214816023;5880.294364676266;5883.823485295448;5779.595428320019;5824.708764561755;5832.912506312408;5860;5884.0585506318785;6307.590006649553;6348.079528468393;6363.554551181419;6404.391582799627;6450.225972883237;6807.795766127024;6826.556273842184;6833.6241506717115;6834.589924604539;6929.1684997800585;6884.65576721167;6897.965510172417;6908.101946746941;6992.265812089709;7000.054992575988;6229.9065514016875;6322.241331040304;6409.647469389181;6463.870722585522;6480.837979050514;6936;6969.6166710830375;6974.372306492339;6974.581525108409;6975.476839237078;6626.105475760807;6682.131322927989;6824.965875170592;6826.897596536056;6830.146231721035;6884.931150688529;6892.689828957709;6905.585664860125;6988.615626140611;6992.895106573405;6612.4710023198995;6816.625085620339;6884.380405763505;6956.686949087303;6960.095187625576;6744.696488658022;6808.795736127924;6903.965480172667;6929.341712537301;6963.8607227855155;5330.573554115662;5343.3587969443915;5387.353517577916;5402.162664786964;5407.78368865241;4643.767811609474;4646.186917289461;4679.415073115861;4709.1994360958715;4717.080169366941;5698.943010569924;5761;5793.594448388657;5903.203067585907;5913.733881975321;6784.762533311409;6808.353206445379;6808.829779255559;6809.625470599165;6811.4210292124735;5811.360750317462;5828.562857785683;5882.264716910387;5890.234269545017;5897.174395584621;5846.386129456431;5848.590598658053;5879.000569903127;5922.141289512996;5959.582829201914;6576.934230657728;6585.9012114818315;6652.467802575782;6654.6672666366485;6655.23464801554;6692.665366731741;6729.327067293231;6824.965875170791;6859.108315918898;6982.371586557234;6524.67376631176;6632.767853125118;6645.468362531083;6665.166854143232;6665.3001434850585;6742.292059333699;6752.696128674123;6832.145981752281;6842.726290948505;6869.519133660796;6907.585544867324;6923.792286231421;6985.777488939314;7017.578945263301;7040.542364746275;6453.838654033687;6532.608043517404;6562.278149403657;6658.167729033871;6758.42553382968;6612.107365505595;6638.336166383323;6640.435562977201;6644.7009884554345;6649.069130321662;6472.190976127984;6516.57642253252;6609.504287178384;6631.071649969104;6639.6680165992475;6715.395614394728;6765.627890465875;6811.591304521745;6829.965850170717;6838.076859624086;6304.306526282197;6457.225132983884;6459.483241340776;6549.377809108127;6558.80323590293 03:12:05 INFO - PID 9935 | |1;ext.html;856.2807241916789;883.6642076011115;883.9337049721271;885.7652722028668;886.5212785096048;37899.99999999996;41570.37644435336;41624;41747.58252417475;41825.37261941074;37620;37862.621373786256;37898.62101378985;37970;38102;7021.75423860165;7107.502474826764;7115.359617634412;7116.893246601279;7118.216996130422;7004.299570043006;7131.4651401144865;7133.714651413938;7134.036905017834;7135;7112.2176560578555;7117.644117794115;7119.85760284794;7125.7149714011375;7126.251743566929;7648.426368022393;7846.686132554691;7849.882251766228;7856.489328193707;7856.842863142734;7657.310842024244;7735.651895664652;7739.1873853245725;7739.380849532024;7741.419393545507;36495.63504364949;37108.44337334942;38451.230975380335;39030.609693903265;39045.60954390448;3524.1365865362895;3562.8218589070702;3569.660882216185;3571;3575.3564358415474;31613.36773264522;31711.20721981946;31722.841385792923;31835.52246716301;31932;5254.474552544753;5265.552428043621;5275.683458992435;5288.180332048539;5290.444503327134;179818;181191;182057.0897145519;182156.0892195544;182263;41626.58373416288;42277.57722422798;46974;47084.293735593994;49271.260931086064;51650.74174629178;51771.48228517742;51789.223161652604;51803.48196518062;51901.22148167781;16075.115868627105;16312.75530867038;16329.510114696579;16341.346346146258;16367.91816040936;13345.799813002814;13359.866401336056;13379.397927093305;13392.330383480787;13518.797218041736;14203.289835508183;14270.143791372344;14312.212828294543;14342.426302947973;14400.927995359956;5955.957707401188;6003.429674180946;6017;6036.185115009505;6042.184305118841;993.2897977945803;996.5864166371019;1011.8026984737905;1015.2588610314511;1030.3457304611625;22787.544249114926;22828.771712282996;22895.542089158123;23082;23346;1101.7686285880054;1104.5195340027115;1108.5842808946645;1108.8835672254459;1118.072000239799;12212.633620991384;12258.81611775824;12300.446479908247;12301.446434910451;12338.81491777624;225052;225553;225555;225900;225946;51001.23498147531;51065.74467127641;51124.74437627788;51144.488555113974;51351.229731554056;1410.3485447359105;1453.8037364955808;1473.462186301992;1475.468831220781;1495.1402943307642;22374.328770136923;22691.319260422213;22831.707207409712;22975.195868144536;23413.648795268426;36380.27239455249;36649.45025824561;36655.08362290964;36682.63317366792;36718.26563468662;185424;185779.0711046436;186150;187299;187401;33704.83147584344;34507.06689931384;35270.29459410746;35334;35367;43924;45029.54970450253;45296.773516132205;45440.31839522476;45440.77279613581;32738.34523309473;33066.5040024395;33223;33281.66718332786;33342.16644583905;32616.184595384355;32817.34365312633;32955;33332.833335833166;33992;36894;37562.24875502529;37587.436188457745;37744.24511509809;38065.809670951465;32188.839055804572;32303.676963230067;32364.190895227806;32616.673833262314;33314;23488;23745.64381534313;23849;23921.52156956886;24422.26733198007 03:12:05 INFO - PID 9935 | |2;jquery.html;551.8151419274543;556.2573963758382;574.1875246526166;574.5834270154139;585.2801054702717;21699.240526581572;22369.664455033188;22421.55156896861;22453.326400207978;22483.66274505884;22339.553208935853;24085.879570602166;24407.511849762996;24506.3873403165;24589.38526536833;6401.775937842165;6568.507361947849;6578.440832529241;6584.078229047937;6589.439897608685;4418.536053714346;4465;6507.51193660475;6590.439812615933;6599.10912026875;4447.888802779924;4459.554044595547;4462.1075784843;4472.686911916167;4539.954600453986;4459.464864216315;4460.576245256695;4461.843835465776;4482.23801953667;4547.272436410159;4236.809343579546;4239.385289133089;5748.683822389767;5953.702314884238;5969.253843269591;27707.445851083066;28105.85947070272;28110.718892811015;28305.43389132206;28339.57490637642;2058.6294466995937;2075.294399904025;2077.9376618701463;2082.6147162774937;2082.781307962657;18369.63260734778;18817.059147042593;19138;19161.61676766471;19337.033148342667;2482.2429159106464;2493.4514406830467;2525.936851578707;2530.7975361971;2543.313305407548;117075;123233;123558.38220808929;129624.7037529622;130902;14315.816172238583;14621.7406264181;14626.634334141732;14694.412223511154;14786.334614942354;22388.10447582111;22434.775652243596;22441.214557490737;22591.09635614557;22624.321270361914;9932.857721362136;10108.595656173818;10202.897971020344;10230.130438912776;10386.11718003978;9461.858072128924;9493.810123797624;9555.808883822285;9592.08875156859;9673.9032609673;8830.86753698695;8982.820343593092;9066.365354425126;9125.133112354315;9140.634374625073;2609.2824473269625;2623.698274698434;2638.670166229221;2664.467106578692;2712.7287271272717;943.2077055273465;965.5613136426674;974.5906719177963;979.1334668818147;983.2281658897731;17936.9103154486;18397.632047359246;18770.906145469184;18772.155253013647;19030.238790448504;1003.844404117363;1027.0961553832578;1048.7063622185801;1051.164324362134;1052.6841947415744;10056.296059275926;10221.437820919771;10375.896241037644;10423.322484038514;10491.055804977588;441155;448119;448490;454582;456267;104762;105831.47084264683;106062;113166.43416783027;114177;1158.7103224193952;1188.3464094747853;1192.582596091361;1193.2303664136584;1194.790911590468;16947.406840760515;17211.56971075683;17297.827021729623;17314.961102333902;17419.3903213392;51353;53433.46566534285;54435.18347224874;56412.71793641005;58033.70983145057;69751;70102.29897700957;70355.29644703692;71728.64135679288;71818.28181718325;13674.111182773087;13765.655858603215;14011.789823152458;14013.089149205269;14022.509212177525;21657.891710541346;21900.12399504002;21909.342719718436;21983.780162198815;22011.559768804855;17545.298188072844;17594.91202543979;17678.46964591064;17713.822861771216;17817;14997.400103995718;16002.359905603646;16125.274362653474;16305.59236019109;16357;16832.747508787623;17657.381991630744;17697.38059167923;17799.911000444914;17906.55233619118;13459.3943272551;13613.387397566936;13632;13682.589522314347;13701;17012.574685632957;17342.566435839206;17363.47909562715;17410;17476.650466990843 03:12:05 INFO - PID 9935 | |3;mootools.html;1225.7916154253776;1321.273299685173;1326.655069681883;1338.4177882621061;1353.925534095625;14518.927405362972;15111.62220944477;15154;15158.84841151588;15176.468823591176;14864.405423783035;14906.329215185315;14967.401303947829;14975.400983960655;14987.550373488786;2773.4314465534517;2799.076304819405;2832.7167283271715;2842.07632519431;2849.4443583501225;2789.4002789400274;2823.8729257183477;2858.11398466475;2865.8423786691724;2867.928301792451;2769.9446011079767;2785.6935737068907;2908.8691008904652;2921.0944607171737;2924.605178300934;2785.679646840619;2794.0360575601385;2821.9717802821915;2822.957655635167;2825.872835722397;2724.278066312429;2739.904103356393;2742.465219282241;2766.9308267293277;2774.7780177585746;14473.710525789425;14673.266336683124;14696.485623003251;14739.92630036843;14753;7256.746013889541;7525.360344370735;7529.397648188132;7541.62291885409;7553.055868016498;5418.322709661293;5590.608657393984;5626;5735.9388513125205;5758.395368486291;1928.5082304012528;1932.594155227404;1936.8160024797621;1962.1170473286936;1968.0848405491515;25308.240752777445;25662;25846.353841154123;25883.870580646977;25944.8702756485;6707.899381509281;6842.4868134890085;6857.657117144223;7019.543729657556;7075.540089894141;16677.24952377146;16677.749833752503;16691.248893799566;16694.4156954506;16708.74936875948;7766.650500727481;8206.83586328282;8462.830743385099;8502.702405415781;8525.531095789791;7404.740834070782;7555.16893141754;7572.39420846342;7617.581033043125;7618.657160427794;4979.253112033151;5153.098207813692;5157.484251574812;5196.68819870809;5214.556762675139;1431.5991522373752;1436.6408397900525;1446.096189881324;1463.4219483304034;1486.160319419546;717.8707832590184;882.9823403531893;894.3784070071368;898.4968417686117;904.0778406025948;8575.056743758181;8619.569021548898;8699.608517616722;8900.332475064266;8903.287736981027;979.603260679426;997.8303688372994;1019.1591936652292;1027.085893554737;1036.8496567997597;5247.1866860636665;5301.946980530222;5361.437049109865;5374.3013408256675;5483.095289277305;20656.380308590768;20657.793422065886;21330.466738331666;21869.453263668216;21882.343529694135;21155.8942205288;21272.042758075924;21363.14547418117;21396;21572.352829415144;10163.542640581192;11274.605388811353;11330.433478326051;11434.714132146762;11543.249688770204;8225.917740822515;8361.498310101413;8417.70538031166;8419.494830310201;8468.110848360833;18059.367922122663;18529.258829646664;18602.534936626693;18768.906155469136;18790.53023674419;18472.261109555468;18676.81323186751;18765.71851422257;18838.811611883706;19308.806911931264;10369.118624916966;10507.47462626881;10526;10529.789404212026;10557.683269501927;13260.204387736767;13571.728565428439;13704.314784260947;13715.519956801463;13734.65663358424;10564.471776411303;11373.601923932623;11396.829047564459;11553.884461155281;11678.357690327113;10283.537240824331;10384.896151038392;10462;10485.475726213812;10601.734956626146;9999.35004224723;10144.49277536135;10151;10158.034986676254;10166.339187952759;7194.892076618959;7207.099112610924;7237.674304656198;7275.236100209402;7301.926980730124;6720.932790672031;6761.52669313163;6806.285340039422;6826.351496607815;6827.214870289781 03:12:05 INFO - PID 9935 | |4;prototype.html;466.75961879631996;469.1180580508643;517.2241637543684;518.2666526864487;525.0758664750041;6281.685915704219;6378.043293505976;6408.45528130109;6434.678266086688;6435.967820160892;6284.685765711719;6303.14907487489;6348.428641422271;6366.554341196118;6391.776287829927;5139.511746384088;5169.250458683498;5179.213171455842;5220.321358223426;5228.764705588258;4902.7058376497525;5143.894062776502;5162.406323272815;5220.321358223426;5227.581793456515;4997.825076122336;5017.071841709296;5034.144195486776;5038.521340472667;5049.570786483135;5011.423686276088;5020.021095886304;5032.9748351258195;5043.142665746832;5061.19020956647;4375.6937014409;4440.378347031418;4445.73325600465;4446.7109637873755;4459.487158976727;6133.0987393908035;6133.417325354084;6149.969250153766;6160.2915664698685;6225.470834979033;5718.25662663851;5732.3121225453215;5732.770689172428;5749.712514374264;5772.393898640625;6614.536982411233;6628.900566491507;6634;6661.2006559213205;6692.966535167342;4858.757062146914;4868.367112275417;4898;4901.019796040806;4917.5574198321965;6725.5203855151785;6841.555298905605;6841.863162736767;6903.170659775164;6955.860882782316;5035.77339019745;5052.696838189647;5053.494650534917;5060.165072763027;5085.237214417867;5116.107040395078;5136.717480538607;5142.357205349332;5158.613104017214;5185.896282074337;5816.41835816415;5832.533397328289;5834.387389324144;5839.824805255849;5851.853703657357;6562;6677.632730199788;6690.799276021728;6709.731610735614;6873.965630171817;1733.5926057376507;1744.816794236587;1752.579380948563;1757.5430388099187;1760.119940029985;1175.2478413815165;1196.7187710887933;1201.7501798130022;1230.2741382584318;1238.1456794811731;5662.943370566324;5745.85635359111;5746.977116018804;5755.740991655385;5818.389069147764;6831.726730930806;6847.1783385994;6857.451403887677;6867.519273650896;6913;5837.47462728348;5837.766489340379;5853.5317174625925;5855.531557475477;5861.794837180678;3629.564452265692;3629.7459177857822;3635.219371853243;3643.5809881863397;3650;6533.901991470132;6545.4436372907885;6548.541602087808;6566.4418524425;6579.769708060195;7079.973403856515;7138.179109402485;7140.5358651687475;7177.210506844243;7200.963995179991;6399.616023038632;6465.256495502983;6553.967230163818;6564.442022428051;6605.636689982001;6779.72881084751;6789.422899053636;6832.726690932307;6861.897071543831;6887.862242755217;6769.93230067693;6803.4756886671785;6820.215675197416;6839.692213850488;6843.144606924135;6524.184476940382;6530.738770449128;6561.671916404065;6620.933790662224;6675.299093595297;4989.326440930428;5025.195968644999;5025.773840177128;5032.345795046621;5035.5719763819025;6643.335666433318;6681.465482761465;6747.730090796314;6977.930220697931;7005.404540613901;6469.45009674183;6583.242927063449;6595.076689263603;6659.733610655713;6737.629430381376;6622.90065649006;6640.207144071171;6644.235912870082;6655.134832471747;6668.799936001928;6367.936320636734;6385.648789316632;6395.360463953567;6409;6532.869342613026;6542.560636659927;6622.90065649006;6629.834254143685;6710.563813352116;6777.475068109636;6396.968015159894;6425.421712045938;6493.967530162319;6531.052997315458;6537.70580323877 03:12:05 INFO - PID 9935 | |5;yui.html;893.2005854759985;898.0839543665458;906.5059542549311;908.3641450984309;933.3793027636624;18621.813781862176;18771.4368568943;19359.516012099706;19363.322283720056;19385.515362115955;17400;17744.911275443606;18031.549211269725;18105.7284140738;18152.273909043655;942.8868535775682;946.7207173883721;948.5968463403026;949.5489642419865;953.7520244736384;956.4930586789013;961.2310151878504;962.9229661627053;980.5979548385163;991.6925753016552;1043.7390652336917;1052.5158427123495;1052.55792567122;1053.16799728215;1055.4406164732666;969.7187815533487;1018.7300365403174;1024.6772266735954;1033.369644516848;1045.681067274481;738.2285511640349;738.9002484664555;741.3587247031332;744.6537360127512;747.4506237915128;19256.326028589072;19403;19443.319483818;19476.318328858422;19485.610287794163;20595.691064634044;21804.781952180434;21924.671129933064;21983.450413739785;22081;16987.83012169875;17150.77039984794;17413.738793918103;17477.38829140974;17495.825041749547;3681.208540163878;3683.244934788362;3697.796621185834;3717.5353080864893;3728.2170744143764;131285;132200.33899830535;135889;138182.3090884539;141252.29373853168;16926.830731692524;17148.142592870558;17176.742348864776;17301.394451194148;17330.39343622967;27026.729732702814;29829.552556711667;29981.700182998327;30011.549826752616;30042.39915201684;8558.315334773204;8629.741107766777;8695.608697608623;8705.608247628745;8709.564521773886;4116.897077573085;4149.688773342012;4183.6653067754505;4218.0720241546815;4222.113356195172;5012.548870601663;5105.846824595268;5109.156989096758;5124.718140502234;5126.410462796752;942.40157499988;971.455984648599;973.3964941736169;976.1409959235828;984.5864736810556;672.143017652497;688.9242183359827;690.7927621713466;700.4361489001301;707.5400989356959;11727.061835053175;12040.277583345027;12067.758644827054;12105.939470302768;12134.393280336124;690.2648679156682;693.9375456208966;697.4385619576188;704.3907020427293;713.3793599568409;5362;5376.78492860289;5511.3937466878615;5566.165075238666;5640.520555752725;120223;122548;122645.38677306556;123828.38085809513;125275.3736231313;102524;105822;106009.46995264974;111719.44140279246;112148.43925780318;90270;93119;96344.51827740816;97109;98434.5078274604;10552.947235264082;10586.629467968583;10642.89357106419;10690.83963740529;10705.839412408664;42726.35910461408;42774.14451710886;42909.57090429056;43589.56410435855;43902;53840.46159538511;54034.45965540294;54734.726326368116;54858.45141548693;56549.71725141348;15182.164980926154;15280.847191527942;15285.235738213267;15341;15391.153486558347;17082.145892705066;17094.743578846577;17101.48695539136;17118.48644540666;17314.480565583053;15848.366065357257;16241.593960150618;16276.267567959707;16396.75404868952;16427.09650969208;16188.109653969144;16282.348706051625;16301.184940752677;16481.752773708165;16566.50300490987;15353.666450357001;15510.612234694223;15606.297716602554;15670.451534196249;15680.529584112495;10022.275044475433;10141.138003269509;10266.897331026594;10397.532111055172;10426.374417534973;9795.755106122404;9893.604255829687;9974.351667141613;9979.301448898508;10211.489425528842 03:12:05 INFO - PID 9935 | __end_tp_report 03:12:05 INFO - PID 9935 | __start_cc_report 03:12:05 INFO - PID 9935 | _x_x_mozilla_cycle_collect,367 03:12:05 INFO - PID 9935 | __end_cc_report 03:12:05 INFO - PID 9935 | __startTimestamp1505470325306__endTimestamp 03:12:05 INFO - PID 9935 | 03:12:05 INFO - PID 9935 | ------- Summary: start ------- 03:12:05 INFO - PID 9935 | Number of tests: 6 03:12:05 INFO - PID 9935 | 03:12:05 INFO - PID 9935 | [#0] dojo.html Cycles:165 Average:6289.18 Median:6532.61 stddev:764.74 (11.7%) stddev-sans-first:725.90 03:12:05 INFO - PID 9935 | Values: 3133.2 3163.4 3220.8 3226.2 3235.4 6198.3 6341.3 6412.1 6412.2 6462.3 6290.7 6296.2 6420.7 6426.2 6490.4 5831.7 5880.6 5882.8 5902.3 5939.7 5788.4 5862.8 5865.3 5918.5 5972.2 5831.0 5862.8 5916.6 5969.0 6009.9 5695.8 5779.7 5873.6 5880.3 5883.8 5779.6 5824.7 5832.9 5860.0 5884.1 6307.6 6348.1 6363.6 6404.4 6450.2 6807.8 6826.6 6833.6 6834.6 6929.2 6884.7 6898.0 6908.1 6992.3 7000.1 6229.9 6322.2 6409.6 6463.9 6480.8 6936.0 6969.6 6974.4 6974.6 6975.5 6626.1 6682.1 6825.0 6826.9 6830.1 6884.9 6892.7 6905.6 6988.6 6992.9 6612.5 6816.6 6884.4 6956.7 6960.1 6744.7 6808.8 6904.0 6929.3 6963.9 5330.6 5343.4 5387.4 5402.2 5407.8 4643.8 4646.2 4679.4 4709.2 4717.1 5698.9 5761.0 5793.6 5903.2 5913.7 6784.8 6808.4 6808.8 6809.6 6811.4 5811.4 5828.6 5882.3 5890.2 5897.2 5846.4 5848.6 5879.0 5922.1 5959.6 6576.9 6585.9 6652.5 6654.7 6655.2 6692.7 6729.3 6825.0 6859.1 6982.4 6524.7 6632.8 6645.5 6665.2 6665.3 6742.3 6752.7 6832.1 6842.7 6869.5 6907.6 6923.8 6985.8 7017.6 7040.5 6453.8 6532.6 6562.3 6658.2 6758.4 6612.1 6638.3 6640.4 6644.7 6649.1 6472.2 6516.6 6609.5 6631.1 6639.7 6715.4 6765.6 6811.6 6830.0 6838.1 6304.3 6457.2 6459.5 6549.4 6558.8 03:12:05 INFO - PID 9935 | 03:12:05 INFO - PID 9935 | [#1] ext.html Cycles:180 Average:36820.49 Median:3570.33 stddev:51444.97 (1440.9%) stddev-sans-first:51518.41 03:12:05 INFO - PID 9935 | Values: 856.3 883.7 883.9 885.8 886.5 37900.0 41570.4 41624.0 41747.6 41825.4 37620.0 37862.6 37898.6 37970.0 38102.0 7021.8 7107.5 7115.4 7116.9 7118.2 7004.3 7131.5 7133.7 7134.0 7135.0 7112.2 7117.6 7119.9 7125.7 7126.3 7648.4 7846.7 7849.9 7856.5 7856.8 7657.3 7735.7 7739.2 7739.4 7741.4 36495.6 37108.4 38451.2 39030.6 39045.6 3524.1 3562.8 3569.7 3571.0 3575.4 31613.4 31711.2 31722.8 31835.5 31932.0 5254.5 5265.6 5275.7 5288.2 5290.4 179818.0 181191.0 182057.1 182156.1 182263.0 41626.6 42277.6 46974.0 47084.3 49271.3 51650.7 51771.5 51789.2 51803.5 51901.2 16075.1 16312.8 16329.5 16341.3 16367.9 13345.8 13359.9 13379.4 13392.3 13518.8 14203.3 14270.1 14312.2 14342.4 14400.9 5956.0 6003.4 6017.0 6036.2 6042.2 993.3 996.6 1011.8 1015.3 1030.3 22787.5 22828.8 22895.5 23082.0 23346.0 1101.8 1104.5 1108.6 1108.9 1118.1 12212.6 12258.8 12300.4 12301.4 12338.8 225052.0 225553.0 225555.0 225900.0 225946.0 51001.2 51065.7 51124.7 51144.5 51351.2 1410.3 1453.8 1473.5 1475.5 1495.1 22374.3 22691.3 22831.7 22975.2 23413.6 36380.3 36649.5 36655.1 36682.6 36718.3 185424.0 185779.1 186150.0 187299.0 187401.0 33704.8 34507.1 35270.3 35334.0 35367.0 43924.0 45029.5 45296.8 45440.3 45440.8 32738.3 33066.5 33223.0 33281.7 33342.2 32616.2 32817.3 32955.0 33332.8 33992.0 36894.0 37562.2 37587.4 37744.2 38065.8 32188.8 32303.7 32364.2 32616.7 33314.0 23488.0 23745.6 23849.0 23921.5 24422.3 03:12:05 INFO - PID 9935 | 03:12:05 INFO - PID 9935 | [#2] jquery.html Cycles:180 Average:32489.29 Median:22354.61 stddev:75843.13 (339.3%) stddev-sans-first:76017.99 03:12:05 INFO - PID 9935 | Values: 551.8 556.3 574.2 574.6 585.3 21699.2 22369.7 22421.6 22453.3 22483.7 22339.6 24085.9 24407.5 24506.4 24589.4 6401.8 6568.5 6578.4 6584.1 6589.4 4418.5 4465.0 6507.5 6590.4 6599.1 4447.9 4459.6 4462.1 4472.7 4540.0 4459.5 4460.6 4461.8 4482.2 4547.3 4236.8 4239.4 5748.7 5953.7 5969.3 27707.4 28105.9 28110.7 28305.4 28339.6 2058.6 2075.3 2077.9 2082.6 2082.8 18369.6 18817.1 19138.0 19161.6 19337.0 2482.2 2493.5 2525.9 2530.8 2543.3 117075.0 123233.0 123558.4 129624.7 130902.0 14315.8 14621.7 14626.6 14694.4 14786.3 22388.1 22434.8 22441.2 22591.1 22624.3 9932.9 10108.6 10202.9 10230.1 10386.1 9461.9 9493.8 9555.8 9592.1 9673.9 8830.9 8982.8 9066.4 9125.1 9140.6 2609.3 2623.7 2638.7 2664.5 2712.7 943.2 965.6 974.6 979.1 983.2 17936.9 18397.6 18770.9 18772.2 19030.2 1003.8 1027.1 1048.7 1051.2 1052.7 10056.3 10221.4 10375.9 10423.3 10491.1 441155.0 448119.0 448490.0 454582.0 456267.0 104762.0 105831.5 106062.0 113166.4 114177.0 1158.7 1188.3 1192.6 1193.2 1194.8 16947.4 17211.6 17297.8 17315.0 17419.4 51353.0 53433.5 54435.2 56412.7 58033.7 69751.0 70102.3 70355.3 71728.6 71818.3 13674.1 13765.7 14011.8 14013.1 14022.5 21657.9 21900.1 21909.3 21983.8 22011.6 17545.3 17594.9 17678.5 17713.8 17817.0 14997.4 16002.4 16125.3 16305.6 16357.0 16832.7 17657.4 17697.4 17799.9 17906.6 13459.4 13613.4 13632.0 13682.6 13701.0 17012.6 17342.6 17363.5 17410.0 17476.7 03:12:05 INFO - PID 9935 | 03:12:05 INFO - PID 9935 | [#3] mootools.html Cycles:180 Average:9231.48 Median:25914.37 stddev:6502.96 (25.1%) stddev-sans-first:6493.38 03:12:05 INFO - PID 9935 | Values: 1225.8 1321.3 1326.7 1338.4 1353.9 14518.9 15111.6 15154.0 15158.8 15176.5 14864.4 14906.3 14967.4 14975.4 14987.6 2773.4 2799.1 2832.7 2842.1 2849.4 2789.4 2823.9 2858.1 2865.8 2867.9 2769.9 2785.7 2908.9 2921.1 2924.6 2785.7 2794.0 2822.0 2823.0 2825.9 2724.3 2739.9 2742.5 2766.9 2774.8 14473.7 14673.3 14696.5 14739.9 14753.0 7256.7 7525.4 7529.4 7541.6 7553.1 5418.3 5590.6 5626.0 5735.9 5758.4 1928.5 1932.6 1936.8 1962.1 1968.1 25308.2 25662.0 25846.4 25883.9 25944.9 6707.9 6842.5 6857.7 7019.5 7075.5 16677.2 16677.7 16691.2 16694.4 16708.7 7766.7 8206.8 8462.8 8502.7 8525.5 7404.7 7555.2 7572.4 7617.6 7618.7 4979.3 5153.1 5157.5 5196.7 5214.6 1431.6 1436.6 1446.1 1463.4 1486.2 717.9 883.0 894.4 898.5 904.1 8575.1 8619.6 8699.6 8900.3 8903.3 979.6 997.8 1019.2 1027.1 1036.8 5247.2 5301.9 5361.4 5374.3 5483.1 20656.4 20657.8 21330.5 21869.5 21882.3 21155.9 21272.0 21363.1 21396.0 21572.4 10163.5 11274.6 11330.4 11434.7 11543.2 8225.9 8361.5 8417.7 8419.5 8468.1 18059.4 18529.3 18602.5 18768.9 18790.5 18472.3 18676.8 18765.7 18838.8 19308.8 10369.1 10507.5 10526.0 10529.8 10557.7 13260.2 13571.7 13704.3 13715.5 13734.7 10564.5 11373.6 11396.8 11553.9 11678.4 10283.5 10384.9 10462.0 10485.5 10601.7 9999.4 10144.5 10151.0 10158.0 10166.3 7194.9 7207.1 7237.7 7275.2 7301.9 6720.9 6761.5 6806.3 6826.4 6827.2 03:12:05 INFO - PID 9935 | 03:12:05 INFO - PID 9935 | [#4] prototype.html Cycles:180 Average:5589.32 Median:6283.19 stddev:1578.25 (25.1%) stddev-sans-first:1535.13 03:12:05 INFO - PID 9935 | Values: 466.8 469.1 517.2 518.3 525.1 6281.7 6378.0 6408.5 6434.7 6436.0 6284.7 6303.1 6348.4 6366.6 6391.8 5139.5 5169.3 5179.2 5220.3 5228.8 4902.7 5143.9 5162.4 5220.3 5227.6 4997.8 5017.1 5034.1 5038.5 5049.6 5011.4 5020.0 5033.0 5043.1 5061.2 4375.7 4440.4 4445.7 4446.7 4459.5 6133.1 6133.4 6150.0 6160.3 6225.5 5718.3 5732.3 5732.8 5749.7 5772.4 6614.5 6628.9 6634.0 6661.2 6693.0 4858.8 4868.4 4898.0 4901.0 4917.6 6725.5 6841.6 6841.9 6903.2 6955.9 5035.8 5052.7 5053.5 5060.2 5085.2 5116.1 5136.7 5142.4 5158.6 5185.9 5816.4 5832.5 5834.4 5839.8 5851.9 6562.0 6677.6 6690.8 6709.7 6874.0 1733.6 1744.8 1752.6 1757.5 1760.1 1175.2 1196.7 1201.8 1230.3 1238.1 5662.9 5745.9 5747.0 5755.7 5818.4 6831.7 6847.2 6857.5 6867.5 6913.0 5837.5 5837.8 5853.5 5855.5 5861.8 3629.6 3629.7 3635.2 3643.6 3650.0 6533.9 6545.4 6548.5 6566.4 6579.8 7080.0 7138.2 7140.5 7177.2 7201.0 6399.6 6465.3 6554.0 6564.4 6605.6 6779.7 6789.4 6832.7 6861.9 6887.9 6769.9 6803.5 6820.2 6839.7 6843.1 6524.2 6530.7 6561.7 6620.9 6675.3 4989.3 5025.2 5025.8 5032.3 5035.6 6643.3 6681.5 6747.7 6977.9 7005.4 6469.5 6583.2 6595.1 6659.7 6737.6 6622.9 6640.2 6644.2 6655.1 6668.8 6367.9 6385.6 6395.4 6409.0 6532.9 6542.6 6622.9 6629.8 6710.6 6777.5 6397.0 6425.4 6494.0 6531.1 6537.7 03:12:05 INFO - PID 9935 | 03:12:05 INFO - PID 9935 | [#5] yui.html Cycles:180 Average:23885.89 Median:21200.24 stddev:34839.15 (164.3%) stddev-sans-first:34894.11 03:12:05 INFO - PID 9935 | Values: 893.2 898.1 906.5 908.4 933.4 18621.8 18771.4 19359.5 19363.3 19385.5 17400.0 17744.9 18031.5 18105.7 18152.3 942.9 946.7 948.6 949.5 953.8 956.5 961.2 962.9 980.6 991.7 1043.7 1052.5 1052.6 1053.2 1055.4 969.7 1018.7 1024.7 1033.4 1045.7 738.2 738.9 741.4 744.7 747.5 19256.3 19403.0 19443.3 19476.3 19485.6 20595.7 21804.8 21924.7 21983.5 22081.0 16987.8 17150.8 17413.7 17477.4 17495.8 3681.2 3683.2 3697.8 3717.5 3728.2 131285.0 132200.3 135889.0 138182.3 141252.3 16926.8 17148.1 17176.7 17301.4 17330.4 27026.7 29829.6 29981.7 30011.5 30042.4 8558.3 8629.7 8695.6 8705.6 8709.6 4116.9 4149.7 4183.7 4218.1 4222.1 5012.5 5105.8 5109.2 5124.7 5126.4 942.4 971.5 973.4 976.1 984.6 672.1 688.9 690.8 700.4 707.5 11727.1 12040.3 12067.8 12105.9 12134.4 690.3 693.9 697.4 704.4 713.4 5362.0 5376.8 5511.4 5566.2 5640.5 120223.0 122548.0 122645.4 123828.4 125275.4 102524.0 105822.0 106009.5 111719.4 112148.4 90270.0 93119.0 96344.5 97109.0 98434.5 10552.9 10586.6 10642.9 10690.8 10705.8 42726.4 42774.1 42909.6 43589.6 43902.0 53840.5 54034.5 54734.7 54858.5 56549.7 15182.2 15280.8 15285.2 15341.0 15391.2 17082.1 17094.7 17101.5 17118.5 17314.5 15848.4 16241.6 16276.3 16396.8 16427.1 16188.1 16282.3 16301.2 16481.8 16566.5 15353.7 15510.6 15606.3 15670.5 15680.5 10022.3 10141.1 10266.9 10397.5 10426.4 9795.8 9893.6 9974.4 9979.3 10211.5 03:12:05 INFO - PID 9935 | -------- Summary: end -------- 03:12:05 INFO - PID 9935 | 03:12:06 INFO - TEST-INFO | 9935: exit 0 03:12:06 INFO - TEST-OK | dromaeo_css | took 1109504ms 03:12:06 INFO - TEST-START | kraken 03:12:06 INFO - Initialising browser for kraken test... 03:12:06 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:39935/getInfo.html -profile /tmp/tmpbcxtK3/profile 03:12:06 INFO - TEST-INFO | started process 10293 (/builds/slave/test/build/application/firefox/firefox http://localhost:39935/getInfo.html) 03:12:11 INFO - TEST-INFO | 10293: exit 0 03:12:11 INFO - Browser initialized. 03:12:11 INFO - Running cycle 1/1 for kraken test... 03:12:11 INFO - Using env: {'DISPLAY': ':0', 03:12:11 INFO - 'HOME': '/home/cltbld', 03:12:11 INFO - 'JSGC_DISABLE_POISONING': '1', 03:12:11 INFO - 'LANG': 'en_US.UTF-8', 03:12:11 INFO - 'LANGUAGE': 'en_US:en', 03:12:11 INFO - 'LD_LIBRARY_PATH': '/builds/slave/test/build/application/firefox', 03:12:11 INFO - 'LOGNAME': 'cltbld', 03:12:11 INFO - 'MAIL': '/var/mail/cltbld', 03:12:11 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 03:12:11 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 03:12:11 INFO - 'MOZ_CRASHREPORTER': '1', 03:12:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:12:11 INFO - 'MOZ_DISABLE_NONLOCAL_CONNECTIONS': '1', 03:12:11 INFO - 'MOZ_NO_REMOTE': '1', 03:12:11 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 03:12:11 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:12:11 INFO - 'NO_EM_RESTART': '1', 03:12:11 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:12:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:12:11 INFO - 'PWD': '/builds/slave/test', 03:12:11 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 03:12:11 INFO - 'RUST_BACKTRACE': 'full', 03:12:11 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 03:12:11 INFO - 'SHELL': '/bin/bash', 03:12:11 INFO - 'SHLVL': '1', 03:12:11 INFO - 'STYLO_FORCE_DISABLED': '1', 03:12:11 INFO - 'TERM': 'linux', 03:12:11 INFO - 'TMOUT': '86400', 03:12:11 INFO - 'USER': 'cltbld', 03:12:11 INFO - 'XDG_SESSION_COOKIE': '2432103b8b3de4003b23cad4000001c2-1505461794.715586-1022375943', 03:12:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:12:11 INFO - '_': '/tools/buildbot/bin/python'} 03:12:11 INFO - TEST-INFO | started process 10523 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpbcxtK3/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 03:12:12 INFO - PID 10523 | 03:12:12 INFO - PID 10523 | (/builds/slave/test/build/application/firefox/firefox:10572): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 03:12:12 INFO - PID 10523 | 03:12:22 INFO - PID 10523 | RSS: Main: 173379584 03:12:22 INFO - PID 10523 | 03:12:25 INFO - PID 10523 | Cycle 1(1): loaded http://localhost:39935/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:39935/tests/kraken/driver.html?testName=audio-beat-detection) 03:12:26 INFO - PID 10523 | RSS: Main: 177930240 03:12:26 INFO - PID 10523 | 03:12:28 INFO - PID 10523 | Cycle 1(1): loaded http://localhost:39935/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:39935/tests/kraken/driver.html?testName=audio-dft) 03:12:29 INFO - PID 10523 | RSS: Main: 178843648 03:12:29 INFO - PID 10523 | 03:12:32 INFO - PID 10523 | Cycle 1(1): loaded http://localhost:39935/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:39935/tests/kraken/driver.html?testName=audio-fft) 03:12:32 INFO - PID 10523 | RSS: Main: 174153728 03:12:32 INFO - PID 10523 | 03:12:34 INFO - PID 10523 | Cycle 1(1): loaded http://localhost:39935/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:39935/tests/kraken/driver.html?testName=audio-oscillator) 03:12:35 INFO - PID 10523 | RSS: Main: 174723072 03:12:35 INFO - PID 10523 | 03:12:37 INFO - PID 10523 | Cycle 1(1): loaded http://localhost:39935/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:39935/tests/kraken/driver.html?testName=imaging-gaussian-blur) 03:12:38 INFO - PID 10523 | RSS: Main: 175149056 03:12:38 INFO - PID 10523 | 03:12:41 INFO - PID 10523 | Cycle 1(1): loaded http://localhost:39935/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:39935/tests/kraken/driver.html?testName=imaging-darkroom) 03:12:42 INFO - PID 10523 | RSS: Main: 177528832 03:12:42 INFO - PID 10523 | 03:12:45 INFO - PID 10523 | Cycle 1(1): loaded http://localhost:39935/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:39935/tests/kraken/driver.html?testName=imaging-desaturate) 03:12:46 INFO - PID 10523 | RSS: Main: 177704960 03:12:46 INFO - PID 10523 | 03:12:49 INFO - PID 10523 | Cycle 1(1): loaded http://localhost:39935/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:39935/tests/kraken/driver.html?testName=json-parse-financial) 03:12:50 INFO - PID 10523 | RSS: Main: 177946624 03:12:50 INFO - PID 10523 | 03:12:51 INFO - PID 10523 | Cycle 1(1): loaded http://localhost:39935/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:39935/tests/kraken/driver.html?testName=json-stringify-tinderbox) 03:12:52 INFO - PID 10523 | RSS: Main: 178462720 03:12:52 INFO - PID 10523 | 03:12:53 INFO - PID 10523 | Cycle 1(1): loaded http://localhost:39935/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:39935/tests/kraken/driver.html?testName=stanford-crypto-aes) 03:12:54 INFO - PID 10523 | RSS: Main: 177930240 03:12:54 INFO - PID 10523 | 03:12:56 INFO - PID 10523 | Cycle 1(1): loaded http://localhost:39935/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:39935/tests/kraken/driver.html?testName=stanford-crypto-ccm) 03:12:57 INFO - PID 10523 | RSS: Main: 174796800 03:12:57 INFO - PID 10523 | 03:12:59 INFO - PID 10523 | Cycle 1(1): loaded http://localhost:39935/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:39935/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 03:13:00 INFO - PID 10523 | RSS: Main: 174911488 03:13:00 INFO - PID 10523 | 03:13:03 INFO - PID 10523 | Cycle 1(1): loaded http://localhost:39935/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:39935/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 03:13:04 INFO - PID 10523 | RSS: Main: 175251456 03:13:04 INFO - PID 10523 | 03:13:05 INFO - PID 10523 | Cycle 1(1): loaded http://localhost:39935/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:39935/tests/kraken/driver.html?testName=ai-astar) 03:13:06 INFO - PID 10523 | RSS: Main: 176521216 03:13:06 INFO - PID 10523 | 03:13:06 INFO - PID 10523 | __start_tp_report 03:13:06 INFO - PID 10523 | _x_x_mozilla_page_load 03:13:06 INFO - PID 10523 | _x_x_mozilla_page_load_details 03:13:06 INFO - PID 10523 | |i|pagename|runs| 03:13:06 INFO - PID 10523 | |0;ai-astar;109;107;107;107;107;108;110;108;109;109 03:13:06 INFO - PID 10523 | |1;audio-beat-detection;119;117;118;117;116;124;118;119;117;117 03:13:06 INFO - PID 10523 | |2;audio-dft;163;163;163;163;165;162;171;168;163;166 03:13:06 INFO - PID 10523 | |3;audio-fft;74;74;77;75;75;74;73;76;74;76 03:13:06 INFO - PID 10523 | |4;audio-oscillator;79;80;80;80;80;79;79;80;79;79 03:13:06 INFO - PID 10523 | |5;imaging-gaussian-blur;112;109;114;117;114;118;113;115;113;116 03:13:06 INFO - PID 10523 | |6;imaging-darkroom;149;148;148;148;149;149;148;148;148;148 03:13:06 INFO - PID 10523 | |7;imaging-desaturate;99;93;93;94;95;97;95;100;93;94 03:13:06 INFO - PID 10523 | |8;json-parse-financial;55;53;53;54;54;58;55;57;55;54 03:13:06 INFO - PID 10523 | |9;json-stringify-tinderbox;39;38;38;38;38;45;42;41;39;39 03:13:06 INFO - PID 10523 | |10;stanford-crypto-aes;77;75;75;76;76;79;74;76;75;74 03:13:06 INFO - PID 10523 | |11;stanford-crypto-ccm;114;110;113;113;126;110;116;109;117;115 03:13:06 INFO - PID 10523 | |12;stanford-crypto-pbkdf2;176;173;165;175;167;167;173;168;186;167 03:13:06 INFO - PID 10523 | |13;stanford-crypto-sha256-iterative;73;66;69;65;67;63;70;66;61;74 03:13:06 INFO - PID 10523 | __end_tp_report 03:13:06 INFO - PID 10523 | __start_cc_report 03:13:06 INFO - PID 10523 | _x_x_mozilla_cycle_collect,944 03:13:06 INFO - PID 10523 | __end_cc_report 03:13:06 INFO - PID 10523 | __startTimestamp1505470386211__endTimestamp 03:13:06 INFO - PID 10523 | 03:13:06 INFO - PID 10523 | ------- Summary: start ------- 03:13:06 INFO - PID 10523 | Number of tests: 14 03:13:06 INFO - PID 10523 | 03:13:06 INFO - PID 10523 | [#0] ai-astar Cycles:10 Average:108.10 Median:108.50 stddev:1.10 (1.0%) stddev-sans-first:1.12 03:13:06 INFO - PID 10523 | Values: 109.0 107.0 107.0 107.0 107.0 108.0 110.0 108.0 109.0 109.0 03:13:06 INFO - PID 10523 | 03:13:06 INFO - PID 10523 | [#1] audio-beat-detection Cycles:10 Average:118.20 Median:118.00 stddev:2.25 (1.9%) stddev-sans-first:2.37 03:13:06 INFO - PID 10523 | Values: 119.0 117.0 118.0 117.0 116.0 124.0 118.0 119.0 117.0 117.0 03:13:06 INFO - PID 10523 | 03:13:06 INFO - PID 10523 | [#2] audio-dft Cycles:10 Average:164.70 Median:164.00 stddev:2.87 (1.7%) stddev-sans-first:2.98 03:13:06 INFO - PID 10523 | Values: 163.0 163.0 163.0 163.0 165.0 162.0 171.0 168.0 163.0 166.0 03:13:06 INFO - PID 10523 | 03:13:06 INFO - PID 10523 | [#3] audio-fft Cycles:10 Average:74.80 Median:75.00 stddev:1.23 (1.6%) stddev-sans-first:1.27 03:13:06 INFO - PID 10523 | Values: 74.0 74.0 77.0 75.0 75.0 74.0 73.0 76.0 74.0 76.0 03:13:06 INFO - PID 10523 | 03:13:06 INFO - PID 10523 | [#4] audio-oscillator Cycles:10 Average:79.50 Median:80.00 stddev:0.53 (0.7%) stddev-sans-first:0.53 03:13:06 INFO - PID 10523 | Values: 79.0 80.0 80.0 80.0 80.0 79.0 79.0 80.0 79.0 79.0 03:13:06 INFO - PID 10523 | 03:13:06 INFO - PID 10523 | [#5] imaging-gaussian-blur Cycles:10 Average:114.10 Median:114.50 stddev:2.60 (2.3%) stddev-sans-first:2.65 03:13:06 INFO - PID 10523 | Values: 112.0 109.0 114.0 117.0 114.0 118.0 113.0 115.0 113.0 116.0 03:13:06 INFO - PID 10523 | 03:13:06 INFO - PID 10523 | [#6] imaging-darkroom Cycles:10 Average:148.30 Median:148.00 stddev:0.48 (0.3%) stddev-sans-first:0.44 03:13:06 INFO - PID 10523 | Values: 149.0 148.0 148.0 148.0 149.0 149.0 148.0 148.0 148.0 148.0 03:13:06 INFO - PID 10523 | 03:13:06 INFO - PID 10523 | [#7] imaging-desaturate Cycles:10 Average:95.30 Median:94.50 stddev:2.54 (2.7%) stddev-sans-first:2.32 03:13:06 INFO - PID 10523 | Values: 99.0 93.0 93.0 94.0 95.0 97.0 95.0 100.0 93.0 94.0 03:13:06 INFO - PID 10523 | 03:13:06 INFO - PID 10523 | [#8] json-parse-financial Cycles:10 Average:54.80 Median:55.00 stddev:1.62 (2.9%) stddev-sans-first:1.72 03:13:06 INFO - PID 10523 | Values: 55.0 53.0 53.0 54.0 54.0 58.0 55.0 57.0 55.0 54.0 03:13:06 INFO - PID 10523 | 03:13:06 INFO - PID 10523 | [#9] json-stringify-tinderbox Cycles:10 Average:39.70 Median:39.00 stddev:2.31 (5.9%) stddev-sans-first:2.44 03:13:06 INFO - PID 10523 | Values: 39.0 38.0 38.0 38.0 38.0 45.0 42.0 41.0 39.0 39.0 03:13:06 INFO - PID 10523 | 03:13:06 INFO - PID 10523 | [#10] stanford-crypto-aes Cycles:10 Average:75.70 Median:76.00 stddev:1.49 (2.0%) stddev-sans-first:1.51 03:13:06 INFO - PID 10523 | Values: 77.0 75.0 75.0 76.0 76.0 79.0 74.0 76.0 75.0 74.0 03:13:06 INFO - PID 10523 | 03:13:06 INFO - PID 10523 | [#11] stanford-crypto-ccm Cycles:10 Average:114.30 Median:114.50 stddev:4.90 (4.3%) stddev-sans-first:5.20 03:13:06 INFO - PID 10523 | Values: 114.0 110.0 113.0 113.0 126.0 110.0 116.0 109.0 117.0 115.0 03:13:06 INFO - PID 10523 | 03:13:06 INFO - PID 10523 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:171.70 Median:173.00 stddev:6.34 (3.7%) stddev-sans-first:6.53 03:13:06 INFO - PID 10523 | Values: 176.0 173.0 165.0 175.0 167.0 167.0 173.0 168.0 186.0 167.0 03:13:06 INFO - PID 10523 | 03:13:06 INFO - PID 10523 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:67.40 Median:68.00 stddev:4.14 (6.1%) stddev-sans-first:3.87 03:13:06 INFO - PID 10523 | Values: 73.0 66.0 69.0 65.0 67.0 63.0 70.0 66.0 61.0 74.0 03:13:06 INFO - PID 10523 | -------- Summary: end -------- 03:13:06 INFO - PID 10523 | 03:13:06 INFO - PID 10523 | *** UTM:SVC TimerManager:registerTimer called after profile-before-change notification. Ignoring timer registration for id: telemetry_modules_ping 03:13:06 INFO - TEST-INFO | 10523: exit 0 03:13:06 INFO - TEST-OK | kraken | took 60875ms 03:13:06 INFO - SUITE-END | took 1170s 03:13:07 INFO - Completed test suite (00:19:30) 03:13:07 INFO - javascript benchmark 03:13:07 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s", "stylo_disabled"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 8430.130164738932, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3133.1853718033312, 3163.414768267871, 3220.8389580520966, 3226.1934516370893, 3235.3529294141176, 6198.256209254896, 6341.302456729762, 6412.070249813774, 6412.230532336121, 6462.256840463342, 6290.748370065192, 6296.150019747332, 6420.678966051702, 6426.164598602187, 6490.415862572368, 5831.737571809279, 5880.617759845596, 5882.823515294537, 5902.291724992985, 5939.703014849262, 5788.392218817026, 5862.765489380419, 5865.266841644794, 5918.526517878581, 5972.163897054415, 5830.970845145789, 5862.765489380398, 5916.615419997686, 5969.0, 6009.87980240395, 5695.829125126212, 5779.653220806723, 5873.618214816023, 5880.294364676266, 5883.823485295448, 5779.595428320019, 5824.708764561755, 5832.912506312408, 5860.0, 5884.0585506318785, 6307.590006649553, 6348.079528468393, 6363.554551181419, 6404.391582799627, 6450.225972883237, 6807.795766127024, 6826.556273842184, 6833.6241506717115, 6834.589924604539, 6929.1684997800585, 6884.65576721167, 6897.965510172417, 6908.101946746941, 6992.265812089709, 7000.054992575988, 6229.9065514016875, 6322.241331040304, 6409.647469389181, 6463.870722585522, 6480.837979050514, 6936.0, 6969.6166710830375, 6974.372306492339, 6974.581525108409, 6975.476839237078, 6626.105475760807, 6682.131322927989, 6824.965875170592, 6826.897596536056, 6830.146231721035, 6884.931150688529, 6892.689828957709, 6905.585664860125, 6988.615626140611, 6992.895106573405, 6612.4710023198995, 6816.625085620339, 6884.380405763505, 6956.686949087303, 6960.095187625576, 6744.696488658022, 6808.795736127924, 6903.965480172667, 6929.341712537301, 6963.8607227855155, 5330.573554115662, 5343.3587969443915, 5387.353517577916, 5402.162664786964, 5407.78368865241, 4643.767811609474, 4646.186917289461, 4679.415073115861, 4709.1994360958715, 4717.080169366941, 5698.943010569924, 5761.0, 5793.594448388657, 5903.203067585907, 5913.733881975321, 6784.762533311409, 6808.353206445379, 6808.829779255559, 6809.625470599165, 6811.4210292124735, 5811.360750317462, 5828.562857785683, 5882.264716910387, 5890.234269545017, 5897.174395584621, 5846.386129456431, 5848.590598658053, 5879.000569903127, 5922.141289512996, 5959.582829201914, 6576.934230657728, 6585.9012114818315, 6652.467802575782, 6654.6672666366485, 6655.23464801554, 6692.665366731741, 6729.327067293231, 6824.965875170791, 6859.108315918898, 6982.371586557234, 6524.67376631176, 6632.767853125118, 6645.468362531083, 6665.166854143232, 6665.3001434850585, 6742.292059333699, 6752.696128674123, 6832.145981752281, 6842.726290948505, 6869.519133660796, 6907.585544867324, 6923.792286231421, 6985.777488939314, 7017.578945263301, 7040.542364746275, 6453.838654033687, 6532.608043517404, 6562.278149403657, 6658.167729033871, 6758.42553382968, 6612.107365505595, 6638.336166383323, 6640.435562977201, 6644.7009884554345, 6649.069130321662, 6472.190976127984, 6516.57642253252, 6609.504287178384, 6631.071649969104, 6639.6680165992475, 6715.395614394728, 6765.627890465875, 6811.591304521745, 6829.965850170717, 6838.076859624086, 6304.306526282197, 6457.225132983884, 6459.483241340776, 6549.377809108127, 6558.80323590293], "value": 6230.2564604691115, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [856.2807241916789, 883.6642076011115, 883.9337049721271, 885.7652722028668, 886.5212785096048, 37899.99999999996, 41570.37644435336, 41624.0, 41747.58252417475, 41825.37261941074, 37620.0, 37862.621373786256, 37898.62101378985, 37970.0, 38102.0, 7021.75423860165, 7107.502474826764, 7115.359617634412, 7116.893246601279, 7118.216996130422, 7004.299570043006, 7131.4651401144865, 7133.714651413938, 7134.036905017834, 7135.0, 7112.2176560578555, 7117.644117794115, 7119.85760284794, 7125.7149714011375, 7126.251743566929, 7648.426368022393, 7846.686132554691, 7849.882251766228, 7856.489328193707, 7856.842863142734, 7657.310842024244, 7735.651895664652, 7739.1873853245725, 7739.380849532024, 7741.419393545507, 36495.63504364949, 37108.44337334942, 38451.230975380335, 39030.609693903265, 39045.60954390448, 3524.1365865362895, 3562.8218589070702, 3569.660882216185, 3571.0, 3575.3564358415474, 31613.36773264522, 31711.20721981946, 31722.841385792923, 31835.52246716301, 31932.0, 5254.474552544753, 5265.552428043621, 5275.683458992435, 5288.180332048539, 5290.444503327134, 179818.0, 181191.0, 182057.0897145519, 182156.0892195544, 182263.0, 41626.58373416288, 42277.57722422798, 46974.0, 47084.293735593994, 49271.260931086064, 51650.74174629178, 51771.48228517742, 51789.223161652604, 51803.48196518062, 51901.22148167781, 16075.115868627105, 16312.75530867038, 16329.510114696579, 16341.346346146258, 16367.91816040936, 13345.799813002814, 13359.866401336056, 13379.397927093305, 13392.330383480787, 13518.797218041736, 14203.289835508183, 14270.143791372344, 14312.212828294543, 14342.426302947973, 14400.927995359956, 5955.957707401188, 6003.429674180946, 6017.0, 6036.185115009505, 6042.184305118841, 993.2897977945803, 996.5864166371019, 1011.8026984737905, 1015.2588610314511, 1030.3457304611625, 22787.544249114926, 22828.771712282996, 22895.542089158123, 23082.0, 23346.0, 1101.7686285880054, 1104.5195340027115, 1108.5842808946645, 1108.8835672254459, 1118.072000239799, 12212.633620991384, 12258.81611775824, 12300.446479908247, 12301.446434910451, 12338.81491777624, 225052.0, 225553.0, 225555.0, 225900.0, 225946.0, 51001.23498147531, 51065.74467127641, 51124.74437627788, 51144.488555113974, 51351.229731554056, 1410.3485447359105, 1453.8037364955808, 1473.462186301992, 1475.468831220781, 1495.1402943307642, 22374.328770136923, 22691.319260422213, 22831.707207409712, 22975.195868144536, 23413.648795268426, 36380.27239455249, 36649.45025824561, 36655.08362290964, 36682.63317366792, 36718.26563468662, 185424.0, 185779.0711046436, 186150.0, 187299.0, 187401.0, 33704.83147584344, 34507.06689931384, 35270.29459410746, 35334.0, 35367.0, 43924.0, 45029.54970450253, 45296.773516132205, 45440.31839522476, 45440.77279613581, 32738.34523309473, 33066.5040024395, 33223.0, 33281.66718332786, 33342.16644583905, 32616.184595384355, 32817.34365312633, 32955.0, 33332.833335833166, 33992.0, 36894.0, 37562.24875502529, 37587.436188457745, 37744.24511509809, 38065.809670951465, 32188.839055804572, 32303.676963230067, 32364.190895227806, 32616.673833262314, 33314.0, 23488.0, 23745.64381534313, 23849.0, 23921.52156956886, 24422.26733198007], "value": 17062.037566735766, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [551.8151419274543, 556.2573963758382, 574.1875246526166, 574.5834270154139, 585.2801054702717, 21699.240526581572, 22369.664455033188, 22421.55156896861, 22453.326400207978, 22483.66274505884, 22339.553208935853, 24085.879570602166, 24407.511849762996, 24506.3873403165, 24589.38526536833, 6401.775937842165, 6568.507361947849, 6578.440832529241, 6584.078229047937, 6589.439897608685, 4418.536053714346, 4465.0, 6507.51193660475, 6590.439812615933, 6599.10912026875, 4447.888802779924, 4459.554044595547, 4462.1075784843, 4472.686911916167, 4539.954600453986, 4459.464864216315, 4460.576245256695, 4461.843835465776, 4482.23801953667, 4547.272436410159, 4236.809343579546, 4239.385289133089, 5748.683822389767, 5953.702314884238, 5969.253843269591, 27707.445851083066, 28105.85947070272, 28110.718892811015, 28305.43389132206, 28339.57490637642, 2058.6294466995937, 2075.294399904025, 2077.9376618701463, 2082.6147162774937, 2082.781307962657, 18369.63260734778, 18817.059147042593, 19138.0, 19161.61676766471, 19337.033148342667, 2482.2429159106464, 2493.4514406830467, 2525.936851578707, 2530.7975361971, 2543.313305407548, 117075.0, 123233.0, 123558.38220808929, 129624.7037529622, 130902.0, 14315.816172238583, 14621.7406264181, 14626.634334141732, 14694.412223511154, 14786.334614942354, 22388.10447582111, 22434.775652243596, 22441.214557490737, 22591.09635614557, 22624.321270361914, 9932.857721362136, 10108.595656173818, 10202.897971020344, 10230.130438912776, 10386.11718003978, 9461.858072128924, 9493.810123797624, 9555.808883822285, 9592.08875156859, 9673.9032609673, 8830.86753698695, 8982.820343593092, 9066.365354425126, 9125.133112354315, 9140.634374625073, 2609.2824473269625, 2623.698274698434, 2638.670166229221, 2664.467106578692, 2712.7287271272717, 943.2077055273465, 965.5613136426674, 974.5906719177963, 979.1334668818147, 983.2281658897731, 17936.9103154486, 18397.632047359246, 18770.906145469184, 18772.155253013647, 19030.238790448504, 1003.844404117363, 1027.0961553832578, 1048.7063622185801, 1051.164324362134, 1052.6841947415744, 10056.296059275926, 10221.437820919771, 10375.896241037644, 10423.322484038514, 10491.055804977588, 441155.0, 448119.0, 448490.0, 454582.0, 456267.0, 104762.0, 105831.47084264683, 106062.0, 113166.43416783027, 114177.0, 1158.7103224193952, 1188.3464094747853, 1192.582596091361, 1193.2303664136584, 1194.790911590468, 16947.406840760515, 17211.56971075683, 17297.827021729623, 17314.961102333902, 17419.3903213392, 51353.0, 53433.46566534285, 54435.18347224874, 56412.71793641005, 58033.70983145057, 69751.0, 70102.29897700957, 70355.29644703692, 71728.64135679288, 71818.28181718325, 13674.111182773087, 13765.655858603215, 14011.789823152458, 14013.089149205269, 14022.509212177525, 21657.891710541346, 21900.12399504002, 21909.342719718436, 21983.780162198815, 22011.559768804855, 17545.298188072844, 17594.91202543979, 17678.46964591064, 17713.822861771216, 17817.0, 14997.400103995718, 16002.359905603646, 16125.274362653474, 16305.59236019109, 16357.0, 16832.747508787623, 17657.381991630744, 17697.38059167923, 17799.911000444914, 17906.55233619118, 13459.3943272551, 13613.387397566936, 13632.0, 13682.589522314347, 13701.0, 17012.574685632957, 17342.566435839206, 17363.47909562715, 17410.0, 17476.650466990843], "value": 11311.35544477858, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1225.7916154253776, 1321.273299685173, 1326.655069681883, 1338.4177882621061, 1353.925534095625, 14518.927405362972, 15111.62220944477, 15154.0, 15158.84841151588, 15176.468823591176, 14864.405423783035, 14906.329215185315, 14967.401303947829, 14975.400983960655, 14987.550373488786, 2773.4314465534517, 2799.076304819405, 2832.7167283271715, 2842.07632519431, 2849.4443583501225, 2789.4002789400274, 2823.8729257183477, 2858.11398466475, 2865.8423786691724, 2867.928301792451, 2769.9446011079767, 2785.6935737068907, 2908.8691008904652, 2921.0944607171737, 2924.605178300934, 2785.679646840619, 2794.0360575601385, 2821.9717802821915, 2822.957655635167, 2825.872835722397, 2724.278066312429, 2739.904103356393, 2742.465219282241, 2766.9308267293277, 2774.7780177585746, 14473.710525789425, 14673.266336683124, 14696.485623003251, 14739.92630036843, 14753.0, 7256.746013889541, 7525.360344370735, 7529.397648188132, 7541.62291885409, 7553.055868016498, 5418.322709661293, 5590.608657393984, 5626.0, 5735.9388513125205, 5758.395368486291, 1928.5082304012528, 1932.594155227404, 1936.8160024797621, 1962.1170473286936, 1968.0848405491515, 25308.240752777445, 25662.0, 25846.353841154123, 25883.870580646977, 25944.8702756485, 6707.899381509281, 6842.4868134890085, 6857.657117144223, 7019.543729657556, 7075.540089894141, 16677.24952377146, 16677.749833752503, 16691.248893799566, 16694.4156954506, 16708.74936875948, 7766.650500727481, 8206.83586328282, 8462.830743385099, 8502.702405415781, 8525.531095789791, 7404.740834070782, 7555.16893141754, 7572.39420846342, 7617.581033043125, 7618.657160427794, 4979.253112033151, 5153.098207813692, 5157.484251574812, 5196.68819870809, 5214.556762675139, 1431.5991522373752, 1436.6408397900525, 1446.096189881324, 1463.4219483304034, 1486.160319419546, 717.8707832590184, 882.9823403531893, 894.3784070071368, 898.4968417686117, 904.0778406025948, 8575.056743758181, 8619.569021548898, 8699.608517616722, 8900.332475064266, 8903.287736981027, 979.603260679426, 997.8303688372994, 1019.1591936652292, 1027.085893554737, 1036.8496567997597, 5247.1866860636665, 5301.946980530222, 5361.437049109865, 5374.3013408256675, 5483.095289277305, 20656.380308590768, 20657.793422065886, 21330.466738331666, 21869.453263668216, 21882.343529694135, 21155.8942205288, 21272.042758075924, 21363.14547418117, 21396.0, 21572.352829415144, 10163.542640581192, 11274.605388811353, 11330.433478326051, 11434.714132146762, 11543.249688770204, 8225.917740822515, 8361.498310101413, 8417.70538031166, 8419.494830310201, 8468.110848360833, 18059.367922122663, 18529.258829646664, 18602.534936626693, 18768.906155469136, 18790.53023674419, 18472.261109555468, 18676.81323186751, 18765.71851422257, 18838.811611883706, 19308.806911931264, 10369.118624916966, 10507.47462626881, 10526.0, 10529.789404212026, 10557.683269501927, 13260.204387736767, 13571.728565428439, 13704.314784260947, 13715.519956801463, 13734.65663358424, 10564.471776411303, 11373.601923932623, 11396.829047564459, 11553.884461155281, 11678.357690327113, 10283.537240824331, 10384.896151038392, 10462.0, 10485.475726213812, 10601.734956626146, 9999.35004224723, 10144.49277536135, 10151.0, 10158.034986676254, 10166.339187952759, 7194.892076618959, 7207.099112610924, 7237.674304656198, 7275.236100209402, 7301.926980730124, 6720.932790672031, 6761.52669313163, 6806.285340039422, 6826.351496607815, 6827.214870289781], "value": 6659.895596315119, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [466.75961879631996, 469.1180580508643, 517.2241637543684, 518.2666526864487, 525.0758664750041, 6281.685915704219, 6378.043293505976, 6408.45528130109, 6434.678266086688, 6435.967820160892, 6284.685765711719, 6303.14907487489, 6348.428641422271, 6366.554341196118, 6391.776287829927, 5139.511746384088, 5169.250458683498, 5179.213171455842, 5220.321358223426, 5228.764705588258, 4902.7058376497525, 5143.894062776502, 5162.406323272815, 5220.321358223426, 5227.581793456515, 4997.825076122336, 5017.071841709296, 5034.144195486776, 5038.521340472667, 5049.570786483135, 5011.423686276088, 5020.021095886304, 5032.9748351258195, 5043.142665746832, 5061.19020956647, 4375.6937014409, 4440.378347031418, 4445.73325600465, 4446.7109637873755, 4459.487158976727, 6133.0987393908035, 6133.417325354084, 6149.969250153766, 6160.2915664698685, 6225.470834979033, 5718.25662663851, 5732.3121225453215, 5732.770689172428, 5749.712514374264, 5772.393898640625, 6614.536982411233, 6628.900566491507, 6634.0, 6661.2006559213205, 6692.966535167342, 4858.757062146914, 4868.367112275417, 4898.0, 4901.019796040806, 4917.5574198321965, 6725.5203855151785, 6841.555298905605, 6841.863162736767, 6903.170659775164, 6955.860882782316, 5035.77339019745, 5052.696838189647, 5053.494650534917, 5060.165072763027, 5085.237214417867, 5116.107040395078, 5136.717480538607, 5142.357205349332, 5158.613104017214, 5185.896282074337, 5816.41835816415, 5832.533397328289, 5834.387389324144, 5839.824805255849, 5851.853703657357, 6562.0, 6677.632730199788, 6690.799276021728, 6709.731610735614, 6873.965630171817, 1733.5926057376507, 1744.816794236587, 1752.579380948563, 1757.5430388099187, 1760.119940029985, 1175.2478413815165, 1196.7187710887933, 1201.7501798130022, 1230.2741382584318, 1238.1456794811731, 5662.943370566324, 5745.85635359111, 5746.977116018804, 5755.740991655385, 5818.389069147764, 6831.726730930806, 6847.1783385994, 6857.451403887677, 6867.519273650896, 6913.0, 5837.47462728348, 5837.766489340379, 5853.5317174625925, 5855.531557475477, 5861.794837180678, 3629.564452265692, 3629.7459177857822, 3635.219371853243, 3643.5809881863397, 3650.0, 6533.901991470132, 6545.4436372907885, 6548.541602087808, 6566.4418524425, 6579.769708060195, 7079.973403856515, 7138.179109402485, 7140.5358651687475, 7177.210506844243, 7200.963995179991, 6399.616023038632, 6465.256495502983, 6553.967230163818, 6564.442022428051, 6605.636689982001, 6779.72881084751, 6789.422899053636, 6832.726690932307, 6861.897071543831, 6887.862242755217, 6769.93230067693, 6803.4756886671785, 6820.215675197416, 6839.692213850488, 6843.144606924135, 6524.184476940382, 6530.738770449128, 6561.671916404065, 6620.933790662224, 6675.299093595297, 4989.326440930428, 5025.195968644999, 5025.773840177128, 5032.345795046621, 5035.5719763819025, 6643.335666433318, 6681.465482761465, 6747.730090796314, 6977.930220697931, 7005.404540613901, 6469.45009674183, 6583.242927063449, 6595.076689263603, 6659.733610655713, 6737.629430381376, 6622.90065649006, 6640.207144071171, 6644.235912870082, 6655.134832471747, 6668.799936001928, 6367.936320636734, 6385.648789316632, 6395.360463953567, 6409.0, 6532.869342613026, 6542.560636659927, 6622.90065649006, 6629.834254143685, 6710.563813352116, 6777.475068109636, 6396.968015159894, 6425.421712045938, 6493.967530162319, 6531.052997315458, 6537.70580323877], "value": 5117.11215084555, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [893.2005854759985, 898.0839543665458, 906.5059542549311, 908.3641450984309, 933.3793027636624, 18621.813781862176, 18771.4368568943, 19359.516012099706, 19363.322283720056, 19385.515362115955, 17400.0, 17744.911275443606, 18031.549211269725, 18105.7284140738, 18152.273909043655, 942.8868535775682, 946.7207173883721, 948.5968463403026, 949.5489642419865, 953.7520244736384, 956.4930586789013, 961.2310151878504, 962.9229661627053, 980.5979548385163, 991.6925753016552, 1043.7390652336917, 1052.5158427123495, 1052.55792567122, 1053.16799728215, 1055.4406164732666, 969.7187815533487, 1018.7300365403174, 1024.6772266735954, 1033.369644516848, 1045.681067274481, 738.2285511640349, 738.9002484664555, 741.3587247031332, 744.6537360127512, 747.4506237915128, 19256.326028589072, 19403.0, 19443.319483818, 19476.318328858422, 19485.610287794163, 20595.691064634044, 21804.781952180434, 21924.671129933064, 21983.450413739785, 22081.0, 16987.83012169875, 17150.77039984794, 17413.738793918103, 17477.38829140974, 17495.825041749547, 3681.208540163878, 3683.244934788362, 3697.796621185834, 3717.5353080864893, 3728.2170744143764, 131285.0, 132200.33899830535, 135889.0, 138182.3090884539, 141252.29373853168, 16926.830731692524, 17148.142592870558, 17176.742348864776, 17301.394451194148, 17330.39343622967, 27026.729732702814, 29829.552556711667, 29981.700182998327, 30011.549826752616, 30042.39915201684, 8558.315334773204, 8629.741107766777, 8695.608697608623, 8705.608247628745, 8709.564521773886, 4116.897077573085, 4149.688773342012, 4183.6653067754505, 4218.0720241546815, 4222.113356195172, 5012.548870601663, 5105.846824595268, 5109.156989096758, 5124.718140502234, 5126.410462796752, 942.40157499988, 971.455984648599, 973.3964941736169, 976.1409959235828, 984.5864736810556, 672.143017652497, 688.9242183359827, 690.7927621713466, 700.4361489001301, 707.5400989356959, 11727.061835053175, 12040.277583345027, 12067.758644827054, 12105.939470302768, 12134.393280336124, 690.2648679156682, 693.9375456208966, 697.4385619576188, 704.3907020427293, 713.3793599568409, 5362.0, 5376.78492860289, 5511.3937466878615, 5566.165075238666, 5640.520555752725, 120223.0, 122548.0, 122645.38677306556, 123828.38085809513, 125275.3736231313, 102524.0, 105822.0, 106009.46995264974, 111719.44140279246, 112148.43925780318, 90270.0, 93119.0, 96344.51827740816, 97109.0, 98434.5078274604, 10552.947235264082, 10586.629467968583, 10642.89357106419, 10690.83963740529, 10705.839412408664, 42726.35910461408, 42774.14451710886, 42909.57090429056, 43589.56410435855, 43902.0, 53840.46159538511, 54034.45965540294, 54734.726326368116, 54858.45141548693, 56549.71725141348, 15182.164980926154, 15280.847191527942, 15285.235738213267, 15341.0, 15391.153486558347, 17082.145892705066, 17094.743578846577, 17101.48695539136, 17118.48644540666, 17314.480565583053, 15848.366065357257, 16241.593960150618, 16276.267567959707, 16396.75404868952, 16427.09650969208, 16188.109653969144, 16282.348706051625, 16301.184940752677, 16481.752773708165, 16566.50300490987, 15353.666450357001, 15510.612234694223, 15606.297716602554, 15670.451534196249, 15680.529584112495, 10022.275044475433, 10141.138003269509, 10266.897331026594, 10397.532111055172, 10426.374417534973, 9795.755106122404, 9893.604255829687, 9974.351667141613, 9979.301448898508, 10211.489425528842], "value": 8758.661526226446, "unit": "score"}]}, {"extraOptions": ["e10s", "stylo_disabled"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1426.6000000000001, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [109.0, 107.0, 107.0, 107.0, 107.0, 108.0, 110.0, 108.0, 109.0, 109.0], "value": 108.1, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [119.0, 117.0, 118.0, 117.0, 116.0, 124.0, 118.0, 119.0, 117.0, 117.0], "value": 118.2, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 163.0, 163.0, 163.0, 165.0, 162.0, 171.0, 168.0, 163.0, 166.0], "value": 164.7, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [74.0, 74.0, 77.0, 75.0, 75.0, 74.0, 73.0, 76.0, 74.0, 76.0], "value": 74.8, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [79.0, 80.0, 80.0, 80.0, 80.0, 79.0, 79.0, 80.0, 79.0, 79.0], "value": 79.5, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [112.0, 109.0, 114.0, 117.0, 114.0, 118.0, 113.0, 115.0, 113.0, 116.0], "value": 114.1, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [149.0, 148.0, 148.0, 148.0, 149.0, 149.0, 148.0, 148.0, 148.0, 148.0], "value": 148.3, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [99.0, 93.0, 93.0, 94.0, 95.0, 97.0, 95.0, 100.0, 93.0, 94.0], "value": 95.3, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [55.0, 53.0, 53.0, 54.0, 54.0, 58.0, 55.0, 57.0, 55.0, 54.0], "value": 54.8, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [39.0, 38.0, 38.0, 38.0, 38.0, 45.0, 42.0, 41.0, 39.0, 39.0], "value": 39.7, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [77.0, 75.0, 75.0, 76.0, 76.0, 79.0, 74.0, 76.0, 75.0, 74.0], "value": 75.7, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [114.0, 110.0, 113.0, 113.0, 126.0, 110.0, 116.0, 109.0, 117.0, 115.0], "value": 114.3, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [176.0, 173.0, 165.0, 175.0, 167.0, 167.0, 173.0, 168.0, 186.0, 167.0], "value": 171.7, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [73.0, 66.0, 69.0, 65.0, 67.0, 63.0, 70.0, 66.0, 61.0, 74.0], "value": 67.4, "unit": "score"}]}]} 03:13:07 INFO - Return code: 0 03:13:07 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 03:13:07 INFO - # TBPL SUCCESS # 03:13:07 INFO - Running post-action listener: _package_coverage_data 03:13:07 INFO - Running post-action listener: _resource_record_post_action 03:13:07 INFO - [mozharness: 2017-09-15 10:13:07.474520Z] Finished run-tests step (success) 03:13:07 INFO - Running post-run listener: _resource_record_post_run 03:13:07 INFO - Total resource usage - Wall time: 1189s; CPU: 13.0%; Read bytes: 4096; Write bytes: 335314944; Read time: 16; Write time: 167068 03:13:07 INFO - TinderboxPrint: CPU usage
13.1% 03:13:07 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 16 03:13:07 INFO - TinderboxPrint: I/O write bytes / time
335,314,944 / 167,068 03:13:07 INFO - TinderboxPrint: CPU idle
8,235.1 (86.9%) 03:13:07 INFO - TinderboxPrint: CPU user
1,194.4 (12.6%) 03:13:07 INFO - TinderboxPrint: Swap in / out
0 / 0 03:13:07 INFO - install - Wall time: 18s; CPU: 13.0%; Read bytes: 0; Write bytes: 13094912; Read time: 0; Write time: 2640 03:13:07 INFO - setup-mitmproxy - Wall time: 0s; CPU: Can't collect data; Read bytes: 0; Write bytes: 0; Read time: 0; Write time: 0 03:13:07 INFO - run-tests - Wall time: 1171s; CPU: 13.0%; Read bytes: 0; Write bytes: 322220032; Read time: 0; Write time: 164428 03:13:08 INFO - Running post-run listener: _upload_blobber_files 03:13:08 INFO - Blob upload gear active. 03:13:08 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 03:13:08 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 03:13:08 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-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 03:13:08 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-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 03:13:08 INFO - (blobuploader) - INFO - Open directory for files ... 03:13:08 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 03:13:08 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 03:13:08 INFO - (blobuploader) - INFO - Uploading, attempt #1. 03:13:09 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 03:13:09 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 03:13:09 INFO - (blobuploader) - INFO - Done attempting. 03:13:09 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 03:13:09 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 03:13:09 INFO - (blobuploader) - INFO - Uploading, attempt #1. 03:13:16 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 03:13:16 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 03:13:16 INFO - (blobuploader) - INFO - Done attempting. 03:13:16 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-stylo-disabled-e10s_errorsummary.log ... 03:13:16 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 03:13:16 INFO - (blobuploader) - INFO - Uploading, attempt #1. 03:13:17 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-stylo-disabled-e10s_errorsummary.log: uploaded 03:13:17 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 03:13:17 INFO - (blobuploader) - INFO - Done attempting. 03:13:17 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-stylo-disabled-e10s_raw.log ... 03:13:17 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 03:13:17 INFO - (blobuploader) - INFO - Uploading, attempt #1. 03:13:18 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-stylo-disabled-e10s_raw.log: uploaded 03:13:18 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 03:13:18 INFO - (blobuploader) - INFO - Done attempting. 03:13:18 INFO - (blobuploader) - INFO - Iteration through files over. 03:13:18 INFO - Return code: 0 03:13:18 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 03:13:18 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 03:13:18 INFO - Setting buildbot property blobber_files to {"perfherder-data.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/67d59a576f8631d874e3650a46815b8d456f48a596fc24f0ce814c1b80d02f4483a45d2eddb91f8ef78b3ec9d99f000bae83d0e1edc48e9ba7a201c07a1a5b0b", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/a81179c123b4024aa34c30c1a76affb355d3b94cf40ecb65982a63add7b0cad01c73fead7135a593a798774f4987228b5d38cae4b45c982e101b374630df6bdb", "dromaeojs-stylo-disabled-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/6e406ecb6e077901d9d1c81b39bc6adbeffdaf00f50564ac33879b30edc1acbd6c4b52193b9eb39321723a6e17c3ff0911e45b9fbe2ac0393cad69a87f5583df", "dromaeojs-stylo-disabled-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/e497e155da456d605a60cc290385f907895bcb328f3096490ce1982e2c39287722b868b1bdf3fedb7de9a70399173c037df93276f44f5009c5cfc145bfa670e7"} 03:13:18 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 03:13:18 INFO - Writing to file /builds/slave/test/properties/blobber_files 03:13:18 INFO - Contents: 03:13:18 INFO - blobber_files:{"perfherder-data.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/67d59a576f8631d874e3650a46815b8d456f48a596fc24f0ce814c1b80d02f4483a45d2eddb91f8ef78b3ec9d99f000bae83d0e1edc48e9ba7a201c07a1a5b0b", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/a81179c123b4024aa34c30c1a76affb355d3b94cf40ecb65982a63add7b0cad01c73fead7135a593a798774f4987228b5d38cae4b45c982e101b374630df6bdb", "dromaeojs-stylo-disabled-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/6e406ecb6e077901d9d1c81b39bc6adbeffdaf00f50564ac33879b30edc1acbd6c4b52193b9eb39321723a6e17c3ff0911e45b9fbe2ac0393cad69a87f5583df", "dromaeojs-stylo-disabled-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/e497e155da456d605a60cc290385f907895bcb328f3096490ce1982e2c39287722b868b1bdf3fedb7de9a70399173c037df93276f44f5009c5cfc145bfa670e7"} 03:13:18 INFO - Running post-run listener: copy_logs_to_upload_dir 03:13:18 INFO - Copying logs to upload dir... 03:13:18 INFO - mkdir: /builds/slave/test/build/upload/logs 03:13:18 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1240.991375 ========= master_lag: 0.25 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 41 secs) (at 2017-09-15 03:13:19.241824) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-09-15 03:13:19.249300) ========= 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=2432103b8b3de4003b23cad4000001c2-1505461794.715586-1022375943 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"perfherder-data.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/67d59a576f8631d874e3650a46815b8d456f48a596fc24f0ce814c1b80d02f4483a45d2eddb91f8ef78b3ec9d99f000bae83d0e1edc48e9ba7a201c07a1a5b0b", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/a81179c123b4024aa34c30c1a76affb355d3b94cf40ecb65982a63add7b0cad01c73fead7135a593a798774f4987228b5d38cae4b45c982e101b374630df6bdb", "dromaeojs-stylo-disabled-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/6e406ecb6e077901d9d1c81b39bc6adbeffdaf00f50564ac33879b30edc1acbd6c4b52193b9eb39321723a6e17c3ff0911e45b9fbe2ac0393cad69a87f5583df", "dromaeojs-stylo-disabled-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/e497e155da456d605a60cc290385f907895bcb328f3096490ce1982e2c39287722b868b1bdf3fedb7de9a70399173c037df93276f44f5009c5cfc145bfa670e7"} build_url:https://queue.taskcluster.net/v1/task/WmwENJ0_TWeFxfcKwYDDvw/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011412 build_url: 'https://queue.taskcluster.net/v1/task/WmwENJ0_TWeFxfcKwYDDvw/artifacts/public/build/target.tar.bz2' blobber_files: '{"perfherder-data.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/67d59a576f8631d874e3650a46815b8d456f48a596fc24f0ce814c1b80d02f4483a45d2eddb91f8ef78b3ec9d99f000bae83d0e1edc48e9ba7a201c07a1a5b0b", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/a81179c123b4024aa34c30c1a76affb355d3b94cf40ecb65982a63add7b0cad01c73fead7135a593a798774f4987228b5d38cae4b45c982e101b374630df6bdb", "dromaeojs-stylo-disabled-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/6e406ecb6e077901d9d1c81b39bc6adbeffdaf00f50564ac33879b30edc1acbd6c4b52193b9eb39321723a6e17c3ff0911e45b9fbe2ac0393cad69a87f5583df", "dromaeojs-stylo-disabled-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/e497e155da456d605a60cc290385f907895bcb328f3096490ce1982e2c39287722b868b1bdf3fedb7de9a70399173c037df93276f44f5009c5cfc145bfa670e7"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-09-15 03:13:19.280756) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-09-15 03:13:19.281099) ========= 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=2432103b8b3de4003b23cad4000001c2-1505461794.715586-1022375943 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004604 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-09-15 03:13:19.366955) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-09-15 03:13:19.367281) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-09-15 03:13:19.367603) ========= ========= Total master_lag: 0.45 =========