builder: mozilla-central_ubuntu64_hw_test-dromaeojs-stylo-disabled-e10s slave: talos-linux64-ix-043 starttime: 1505621010.64 results: success (0) revision: 015f852e93fe8887e666ee5a1ff246d3d4e8063b ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-09-16 21:03:30.636745) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-09-16 21:03:30.637418) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-09-16 21:03:30.637734) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-09-16 21:03:30.756337) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-09-16 21:03:30.756888) ========= 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=d2a8c569965ab8367867b893000001a1-1505601877.89358-444046738 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-09-16 21:03:30-- 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% 224M=0s 2017-09-16 21:03:30 (224 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.118233 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-09-16 21:03:30.899278) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-09-16 21:03:30.899607) ========= 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=d2a8c569965ab8367867b893000001a1-1505601877.89358-444046738 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.022802 ========= master_lag: 0.06 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-09-16 21:03:30.981418) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-09-16 21:03:30.981742) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 015f852e93fe8887e666ee5a1ff246d3d4e8063b --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 015f852e93fe8887e666ee5a1ff246d3d4e8063b --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=d2a8c569965ab8367867b893000001a1-1505601877.89358-444046738 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-09-16 21:03:31,037 truncating revision to first 12 chars 2017-09-16 21:03:31,037 Setting DEBUG logging. 2017-09-16 21:03:31,037 attempt 1/10 2017-09-16 21:03:31,037 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/015f852e93fe?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-09-16 21:03:31,862 unpacking tar archive at: mozilla-central-015f852e93fe/testing/mozharness/ program finished with exit code 0 elapsedTime=1.108464 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-09-16 21:03:32.107102) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-09-16 21:03:32.107467) ========= script_repo_revision: 015f852e93fe8887e666ee5a1ff246d3d4e8063b ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-09-16 21:03:32.107898) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-09-16 21:03:32.108173) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-09-16 21:03:32.122197) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 41 secs) (at 2017-09-16 21:03:32.122649) ========= /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=d2a8c569965ab8367867b893000001a1-1505601877.89358-444046738 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 21:03:32 INFO - MultiFileLogger online at 20170916 21:03:32 in /builds/slave/test 21:03:32 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 21:03:32 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 21:03:32 INFO - {'append_to_log': False, 21:03:32 INFO - 'base_work_dir': '/builds/slave/test', 21:03:32 INFO - 'blob_upload_branch': 'Firefox-Non-PGO', 21:03:32 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 21:03:32 INFO - 'branch': 'Firefox-Non-PGO', 21:03:32 INFO - 'buildbot_json_path': 'buildprops.json', 21:03:32 INFO - 'code_coverage': False, 21:03:32 INFO - 'config_files': ('talos/linux_config.py',), 21:03:32 INFO - 'default_actions': ('clobber', 21:03:32 INFO - 'read-buildbot-config', 21:03:32 INFO - 'download-and-extract', 21:03:32 INFO - 'populate-webroot', 21:03:32 INFO - 'create-virtualenv', 21:03:32 INFO - 'install', 21:03:32 INFO - 'setup-mitmproxy', 21:03:32 INFO - 'run-tests'), 21:03:32 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 21:03:32 INFO - 'disable_ccov_upload': False, 21:03:32 INFO - 'disable_stylo': False, 21:03:32 INFO - 'download_minidump_stackwalk': True, 21:03:32 INFO - 'download_symbols': 'ondemand', 21:03:32 INFO - 'enable_stylo': False, 21:03:32 INFO - 'enable_webrender': False, 21:03:32 INFO - 'exes': {'tooltool.py': '/tools/tooltool.py'}, 21:03:32 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 21:03:32 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 21:03:32 INFO - 'gecko_profile': False, 21:03:32 INFO - 'gecko_profile_interval': 0, 21:03:32 INFO - 'installer_path': 'installer.exe', 21:03:32 INFO - 'log_level': 'info', 21:03:32 INFO - 'log_name': 'talos', 21:03:32 INFO - 'log_to_console': True, 21:03:32 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 21:03:32 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 21:03:32 INFO - 'opt_config_files': (), 21:03:32 INFO - 'pip_index': False, 21:03:32 INFO - 'suite': 'dromaeojs-stylo-disabled-e10s', 21:03:32 INFO - 'system_bits': '32', 21:03:32 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 21:03:32 INFO - 'title': 'talos-linux64-ix-043', 21:03:32 INFO - 'tooltool_cache': '/builds/tooltool_cache', 21:03:32 INFO - 'use_talos_json': True, 21:03:32 INFO - 'verify': 'False', 21:03:32 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 21:03:32 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 21:03:32 INFO - 'work_dir': 'build'} 21:03:32 INFO - [mozharness: 2017-09-17 04:03:32.325765Z] Running clobber step. 21:03:32 INFO - Running pre-action listener: _resource_record_pre_action 21:03:32 INFO - Running main action method: clobber 21:03:32 INFO - rmtree: /builds/slave/test/build 21:03:32 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 21:03:33 INFO - Running post-action listener: _resource_record_post_action 21:03:33 INFO - [mozharness: 2017-09-17 04:03:33.314836Z] Finished clobber step (success) 21:03:33 INFO - [mozharness: 2017-09-17 04:03:33.314934Z] Running read-buildbot-config step. 21:03:33 INFO - Running pre-action listener: _resource_record_pre_action 21:03:33 INFO - Running main action method: read_buildbot_config 21:03:33 INFO - Using buildbot properties: 21:03:33 INFO - { 21:03:33 INFO - "project": "", 21:03:33 INFO - "product": "firefox", 21:03:33 INFO - "who": "ryanvm@gmail.com", 21:03:33 INFO - "installer_path": "public/build/target.tar.bz2", 21:03:33 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs-stylo-disabled-e10s", 21:03:33 INFO - "repository": "https://hg.mozilla.org/mozilla-central", 21:03:33 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central talos dromaeojs-stylo-disabled-e10s", 21:03:33 INFO - "stage_platform": "linux64", 21:03:33 INFO - "basedir": "/builds/slave/test", 21:03:33 INFO - "buildnumber": 28, 21:03:33 INFO - "platform": "ubuntu64_hw", 21:03:33 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 21:03:33 INFO - "slavebuilddir": "test", 21:03:33 INFO - "taskId": "c3JaUxjgT2uhsWV_PDC7FA", 21:03:33 INFO - "branch": "mozilla-central", 21:03:33 INFO - "script_repo_revision": "production", 21:03:33 INFO - "revision": "015f852e93fe8887e666ee5a1ff246d3d4e8063b", 21:03:33 INFO - "slavename": "talos-linux64-ix-043", 21:03:33 INFO - "repo_path": "mozilla-central" 21:03:33 INFO - } 21:03:33 INFO - Finding installer, test and symbols from parent task. 21:03:33 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/c3JaUxjgT2uhsWV_PDC7FA'}, attempt #1 21:03:33 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/c3JaUxjgT2uhsWV_PDC7FA'}, attempt #1 21:03:34 INFO - Task dependencies: HL4DSwsdQYWbDYpmGciB1w 21:03:34 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/HL4DSwsdQYWbDYpmGciB1w'}, attempt #1 21:03:34 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/HL4DSwsdQYWbDYpmGciB1w/artifacts/public/build/target.tar.bz2 21:03:34 INFO - Set test_packages_url: https://queue.taskcluster.net/v1/task/HL4DSwsdQYWbDYpmGciB1w/artifacts/public/build/target.test_packages.json 21:03:34 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/HL4DSwsdQYWbDYpmGciB1w/artifacts/public/build/target.crashreporter-symbols.zip 21:03:34 INFO - Running post-action listener: _resource_record_post_action 21:03:34 INFO - [mozharness: 2017-09-17 04:03:34.665756Z] Finished read-buildbot-config step (success) 21:03:34 INFO - [mozharness: 2017-09-17 04:03:34.665975Z] Running download-and-extract step. 21:03:34 INFO - Running pre-action listener: _resource_record_pre_action 21:03:34 INFO - Running main action method: download_and_extract 21:03:34 INFO - mkdir: /builds/slave/test/build/tests 21:03:34 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')]} 21:03:34 INFO - trying https://queue.taskcluster.net/v1/task/HL4DSwsdQYWbDYpmGciB1w/artifacts/public/build/target.test_packages.json 21:03:34 INFO - Downloading https://queue.taskcluster.net/v1/task/HL4DSwsdQYWbDYpmGciB1w/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 21:03:34 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/HL4DSwsdQYWbDYpmGciB1w/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 21:03:35 INFO - Downloaded 989 bytes. 21:03:35 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 21:03:35 INFO - Using the following test package requirements: 21:03:35 INFO - {u'awsy': [u'target.common.tests.zip', u'target.awsy.tests.zip'], 21:03:35 INFO - u'common': [u'target.common.tests.zip'], 21:03:35 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 21:03:35 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 21:03:35 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 21:03:35 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 21:03:35 INFO - u'mozbase': [u'target.common.tests.zip'], 21:03:35 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 21:03:35 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 21:03:35 INFO - u'web-platform': [u'target.common.tests.zip', 21:03:35 INFO - u'target.web-platform.tests.tar.gz'], 21:03:35 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 21:03:35 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite categories: ['common', 'talos'] 21:03:35 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/HL4DSwsdQYWbDYpmGciB1w/artifacts/public/build/target.common.tests.zip 21:03:35 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/HL4DSwsdQYWbDYpmGciB1w/artifacts/public/build/target.common.tests.zip'}, attempt #1 21:03:35 INFO - Fetch https://queue.taskcluster.net/v1/task/HL4DSwsdQYWbDYpmGciB1w/artifacts/public/build/target.common.tests.zip into memory 21:03:38 INFO - Content-Length response header: 54731171 21:03:38 INFO - Bytes received: 54731171 21:03:48 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/HL4DSwsdQYWbDYpmGciB1w/artifacts/public/build/target.talos.tests.zip 21:03:48 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/HL4DSwsdQYWbDYpmGciB1w/artifacts/public/build/target.talos.tests.zip'}, attempt #1 21:03:48 INFO - Fetch https://queue.taskcluster.net/v1/task/HL4DSwsdQYWbDYpmGciB1w/artifacts/public/build/target.talos.tests.zip into memory 21:03:50 INFO - Content-Length response header: 14508748 21:03:50 INFO - Bytes received: 14508748 21:03:50 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')]} 21:03:50 INFO - trying https://queue.taskcluster.net/v1/task/HL4DSwsdQYWbDYpmGciB1w/artifacts/public/build/target.tar.bz2 21:03:50 INFO - Downloading https://queue.taskcluster.net/v1/task/HL4DSwsdQYWbDYpmGciB1w/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 21:03:50 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/HL4DSwsdQYWbDYpmGciB1w/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 21:03:54 INFO - Downloaded 61424265 bytes. 21:03:54 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/HL4DSwsdQYWbDYpmGciB1w/artifacts/public/build/target.tar.bz2 21:03:54 INFO - mkdir: /builds/slave/test/properties 21:03:54 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 21:03:54 INFO - Writing to file /builds/slave/test/properties/build_url 21:03:54 INFO - Contents: 21:03:54 INFO - build_url:https://queue.taskcluster.net/v1/task/HL4DSwsdQYWbDYpmGciB1w/artifacts/public/build/target.tar.bz2 21:03:54 INFO - Running post-action listener: _resource_record_post_action 21:03:54 INFO - Running post-action listener: find_tests_for_verification 21:03:54 INFO - Running post-action listener: set_extra_try_arguments 21:03:54 INFO - [mozharness: 2017-09-17 04:03:54.914506Z] Finished download-and-extract step (success) 21:03:54 INFO - [mozharness: 2017-09-17 04:03:54.914731Z] Running populate-webroot step. 21:03:54 INFO - Running pre-action listener: _resource_record_pre_action 21:03:54 INFO - Running main action method: populate_webroot 21:03:54 INFO - {'suites': {'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 21:03:54 INFO - 'chromez-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 21:03:54 INFO - 'tests': ['tresize', 21:03:54 INFO - 'tcanvasmark']}, 21:03:54 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 21:03:54 INFO - 'dromaeojs-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 21:03:54 INFO - 'tests': ['dromaeo_css', 21:03:54 INFO - 'kraken']}, 21:03:54 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 21:03:54 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 21:03:54 INFO - 'g1-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 21:03:54 INFO - 'talos_options': ['--disable-stylo'], 21:03:54 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 21:03:54 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 21:03:54 INFO - 'tests': ['damp', 'tps']}, 21:03:54 INFO - 'g2-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 21:03:54 INFO - 'talos_options': ['--disable-stylo'], 21:03:54 INFO - 'tests': ['damp', 'tps']}, 21:03:54 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 21:03:54 INFO - 'g3-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 21:03:54 INFO - 'tests': ['dromaeo_dom']}, 21:03:54 INFO - 'g4-e10s': {'tests': ['basic_compositor_video', 'glvideo']}, 21:03:54 INFO - 'g4-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 21:03:54 INFO - 'tests': ['basic_compositor_video', 21:03:54 INFO - 'glvideo']}, 21:03:54 INFO - 'g5-e10s': {'pagesets_name': 'tp5n.zip', 21:03:54 INFO - 'tests': ['ts_paint_webext', 'tp5o_webext']}, 21:03:54 INFO - 'g5-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 21:03:54 INFO - 'talos_options': ['--disable-stylo'], 21:03:54 INFO - 'tests': ['ts_paint_webext', 21:03:54 INFO - 'tp5o_webext']}, 21:03:54 INFO - 'other-e10s': {'tests': ['a11yr', 21:03:54 INFO - 'ts_paint', 21:03:54 INFO - 'tpaint', 21:03:54 INFO - 'sessionrestore', 21:03:54 INFO - 'sessionrestore_many_windows', 21:03:54 INFO - 'sessionrestore_no_auto_restore', 21:03:54 INFO - 'tabpaint']}, 21:03:54 INFO - 'other-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 21:03:54 INFO - 'tests': ['a11yr', 21:03:54 INFO - 'ts_paint', 21:03:54 INFO - 'tpaint', 21:03:54 INFO - 'sessionrestore', 21:03:54 INFO - 'sessionrestore_many_windows', 21:03:54 INFO - 'sessionrestore_no_auto_restore', 21:03:54 INFO - 'tabpaint']}, 21:03:54 INFO - 'perf-reftest-e10s': {'tests': ['bloom_basic']}, 21:03:54 INFO - 'perf-reftest-singletons-e10s': {'tests': ['perf_reftest_singletons']}, 21:03:54 INFO - 'perf-reftest-singletons-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 21:03:54 INFO - 'tests': ['perf_reftest_singletons']}, 21:03:54 INFO - 'perf-reftest-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 21:03:54 INFO - 'tests': ['bloom_basic']}, 21:03:54 INFO - 'svgr-e10s': {'tests': ['tsvgx', 21:03:54 INFO - 'tsvgr_opacity', 21:03:54 INFO - 'tart', 21:03:54 INFO - 'tscrollx', 21:03:54 INFO - 'tsvg_static']}, 21:03:54 INFO - 'svgr-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 21:03:54 INFO - 'tests': ['tsvgx', 21:03:54 INFO - 'tsvgr_opacity', 21:03:54 INFO - 'tart', 21:03:54 INFO - 'tscrollx', 21:03:54 INFO - 'tsvg_static']}, 21:03:54 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 21:03:54 INFO - 'tp5o-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 21:03:54 INFO - 'talos_options': ['--disable-stylo'], 21:03:54 INFO - 'tests': ['tp5o']}, 21:03:54 INFO - 'tp6-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 21:03:54 INFO - 'talos_options': ['--mitmproxy', 21:03:54 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 21:03:54 INFO - '--firstNonBlankPaint'], 21:03:54 INFO - 'tests': ['tp6_google', 21:03:54 INFO - 'tp6_youtube', 21:03:54 INFO - 'tp6_amazon', 21:03:54 INFO - 'tp6_facebook']}, 21:03:54 INFO - 'tp6-stylo-disabled-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 21:03:54 INFO - 'talos_options': ['--disable-stylo', 21:03:54 INFO - '--mitmproxy', 21:03:54 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 21:03:54 INFO - '--firstNonBlankPaint'], 21:03:54 INFO - 'tests': ['tp6_google', 21:03:54 INFO - 'tp6_youtube', 21:03:54 INFO - 'tp6_amazon', 21:03:54 INFO - 'tp6_facebook']}, 21:03:54 INFO - 'tp6-stylo-threads-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 21:03:54 INFO - 'talos_options': ['--stylo-threads=1', 21:03:54 INFO - '--mitmproxy', 21:03:54 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 21:03:54 INFO - '--firstNonBlankPaint'], 21:03:54 INFO - 'tests': ['tp6_google', 21:03:54 INFO - 'tp6_youtube', 21:03:54 INFO - 'tp6_amazon', 21:03:54 INFO - 'tp6_facebook']}, 21:03:54 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 21:03:54 INFO - 'talos_options': ['--xperf_path', 21:03:54 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 21:03:54 INFO - 'tests': ['tp5n']}, 21:03:54 INFO - 'xperf-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 21:03:54 INFO - 'talos_options': ['--disable-stylo', 21:03:54 INFO - '--xperf_path', 21:03:54 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 21:03:54 INFO - 'tests': ['tp5n']}}} 21:03:54 INFO - Running post-action listener: _resource_record_post_action 21:03:54 INFO - [mozharness: 2017-09-17 04:03:54.940353Z] Finished populate-webroot step (success) 21:03:54 INFO - [mozharness: 2017-09-17 04:03:54.940443Z] Running create-virtualenv step. 21:03:54 INFO - Running pre-action listener: _resource_record_pre_action 21:03:54 INFO - Running main action method: create_virtualenv 21:03:54 INFO - Creating virtualenv /builds/slave/test/build/venv 21:03:54 INFO - Running command: ['virtualenv', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 21:03:54 INFO - Copy/paste: virtualenv --no-site-packages --distribute /builds/slave/test/build/venv 21:03:54 INFO - Using partial env: {'VIRTUALENV_NO_DOWNLOAD': '1'} 21:03:55 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 21:03:55 INFO - New python executable in /builds/slave/test/build/venv/bin/python 21:03:56 INFO - Installing distribute.............................................................................................................................................................................................done. 21:03:56 INFO - Installing pip...............done. 21:03:56 INFO - Return code: 0 21:03:56 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 21:03:56 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 21:03:56 INFO - Reading from file tmpfile_stdout 21:03:56 INFO - Output received: 21:03:56 INFO - pip 1.1 from /builds/slave/test/build/venv/lib/python2.7/site-packages/pip-1.1-py2.7.egg (python 2.7) 21:03:56 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 21:03:56 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')]} 21:03:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 21:03:56 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')]} 21:03:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 21:03:56 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/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 0x1c021f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dcba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f6ea60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f72090>, '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 0x1f72d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f6cf90>, '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': 'd2a8c569965ab8367867b893000001a1-1505601877.89358-444046738', '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 21:03:56 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 21:03:56 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 21:03:56 INFO - Using env: {'DISPLAY': ':0', 21:03:56 INFO - 'HOME': '/home/cltbld', 21:03:56 INFO - 'LANG': 'en_US.UTF-8', 21:03:56 INFO - 'LANGUAGE': 'en_US:en', 21:03:56 INFO - 'LOGNAME': 'cltbld', 21:03:56 INFO - 'MAIL': '/var/mail/cltbld', 21:03:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 21:03:56 INFO - 'MOZ_NO_REMOTE': '1', 21:03:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 21:03:56 INFO - 'NO_EM_RESTART': '1', 21:03:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 21:03:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 21:03:56 INFO - 'PWD': '/builds/slave/test', 21:03:56 INFO - 'SHELL': '/bin/bash', 21:03:56 INFO - 'SHLVL': '1', 21:03:56 INFO - 'TERM': 'linux', 21:03:56 INFO - 'TMOUT': '86400', 21:03:56 INFO - 'USER': 'cltbld', 21:03:56 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1505601877.89358-444046738', 21:03:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 21:03:56 INFO - '_': '/tools/buildbot/bin/python'} 21:03:57 INFO - Ignoring indexes: http://pypi.python.org/simple/ 21:03:57 INFO - Downloading/unpacking pip>=1.5 21:03:57 INFO - Running setup.py egg_info for package pip 21:03:57 INFO - warning: no files found matching 'pip/cacert.pem' 21:03:57 INFO - warning: no files found matching '*.html' under directory 'docs' 21:03:57 INFO - warning: no previously-included files matching '*.rst' found under directory 'docs/_build' 21:03:57 INFO - no previously-included directories found matching 'docs/_build/_sources' 21:03:57 INFO - Installing collected packages: pip 21:03:57 INFO - Found existing installation: pip 1.1 21:03:57 INFO - Uninstalling pip: 21:03:57 INFO - Successfully uninstalled pip 21:03:57 INFO - Running setup.py install for pip 21:03:57 INFO - warning: no files found matching 'pip/cacert.pem' 21:03:57 INFO - warning: no files found matching '*.html' under directory 'docs' 21:03:57 INFO - warning: no previously-included files matching '*.rst' found under directory 'docs/_build' 21:03:57 INFO - no previously-included directories found matching 'docs/_build/_sources' 21:03:57 INFO - Installing pip script to /builds/slave/test/build/venv/bin 21:03:57 INFO - Installing pip2.7 script to /builds/slave/test/build/venv/bin 21:03:57 INFO - Installing pip2 script to /builds/slave/test/build/venv/bin 21:03:57 INFO - Successfully installed pip 21:03:57 INFO - Cleaning up... 21:03:57 INFO - Return code: 0 21:03:57 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 21:03: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')]} 21:03:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 21:03: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')]} 21:03:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 21:03: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', '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 0x1c021f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dcba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f6ea60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f72090>, '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 0x1f72d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f6cf90>, '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': 'd2a8c569965ab8367867b893000001a1-1505601877.89358-444046738', '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 21:03: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', 'psutil>=3.1.1'] in /builds/slave/test/build 21:03: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 psutil>=3.1.1 21:03:57 INFO - Using env: {'DISPLAY': ':0', 21:03:57 INFO - 'HOME': '/home/cltbld', 21:03:57 INFO - 'LANG': 'en_US.UTF-8', 21:03:57 INFO - 'LANGUAGE': 'en_US:en', 21:03:57 INFO - 'LOGNAME': 'cltbld', 21:03:57 INFO - 'MAIL': '/var/mail/cltbld', 21:03:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 21:03:57 INFO - 'MOZ_NO_REMOTE': '1', 21:03:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 21:03:57 INFO - 'NO_EM_RESTART': '1', 21:03:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 21:03:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 21:03:57 INFO - 'PWD': '/builds/slave/test', 21:03:57 INFO - 'SHELL': '/bin/bash', 21:03:57 INFO - 'SHLVL': '1', 21:03:57 INFO - 'TERM': 'linux', 21:03:57 INFO - 'TMOUT': '86400', 21:03:57 INFO - 'USER': 'cltbld', 21:03:57 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1505601877.89358-444046738', 21:03:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 21:03:57 INFO - '_': '/tools/buildbot/bin/python'} 21:03:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 21:03:57 INFO - Downloading/unpacking psutil>=3.1.1 21:03:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 21:03:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 21:03:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 21:03:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 21:03:58 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 21:03:59 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 21:03:59 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 21:03:59 INFO - Installing collected packages: psutil 21:03:59 INFO - Running setup.py install for psutil 21:03:59 INFO - building 'psutil._psutil_linux' extension 21:03: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 21:03:59 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 21:03:59 INFO - building 'psutil._psutil_posix' extension 21:03:59 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 21:03:59 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 21:03:59 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 21:03:59 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 21:03:59 INFO - Successfully installed psutil 21:03:59 INFO - Cleaning up... 21:03:59 INFO - Return code: 0 21:03:59 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 21:03:59 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')]} 21:03:59 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 21:03:59 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')]} 21:03:59 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 21:03:59 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/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 0x1c021f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dcba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f6ea60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f72090>, '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 0x1f72d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f6cf90>, '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': 'd2a8c569965ab8367867b893000001a1-1505601877.89358-444046738', '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 21:03:59 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 21:03:59 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 21:03:59 INFO - Using env: {'DISPLAY': ':0', 21:03:59 INFO - 'HOME': '/home/cltbld', 21:03:59 INFO - 'LANG': 'en_US.UTF-8', 21:03:59 INFO - 'LANGUAGE': 'en_US:en', 21:03:59 INFO - 'LOGNAME': 'cltbld', 21:03:59 INFO - 'MAIL': '/var/mail/cltbld', 21:03:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 21:03:59 INFO - 'MOZ_NO_REMOTE': '1', 21:03:59 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 21:03:59 INFO - 'NO_EM_RESTART': '1', 21:03:59 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 21:03:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 21:03:59 INFO - 'PWD': '/builds/slave/test', 21:03:59 INFO - 'SHELL': '/bin/bash', 21:03:59 INFO - 'SHLVL': '1', 21:03:59 INFO - 'TERM': 'linux', 21:03:59 INFO - 'TMOUT': '86400', 21:03:59 INFO - 'USER': 'cltbld', 21:03:59 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1505601877.89358-444046738', 21:03:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 21:03:59 INFO - '_': '/tools/buildbot/bin/python'} 21:03:59 INFO - Ignoring indexes: https://pypi.python.org/simple/ 21:03:59 INFO - Downloading/unpacking mozsystemmonitor==0.3 21:03:59 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 21:03:59 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 21:03:59 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 21:03:59 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 21:04:00 INFO - Downloading mozsystemmonitor-0.3.tar.gz 21:04:00 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 21:04:00 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 21:04:00 INFO - Installing collected packages: mozsystemmonitor 21:04:00 INFO - Running setup.py install for mozsystemmonitor 21:04:01 INFO - Successfully installed mozsystemmonitor 21:04:01 INFO - Cleaning up... 21:04:02 INFO - Return code: 0 21:04:02 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 21:04:02 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')]} 21:04:02 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 21:04:02 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')]} 21:04:02 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 21:04:02 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 0x1c021f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dcba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f6ea60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f72090>, '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 0x1f72d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f6cf90>, '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': 'd2a8c569965ab8367867b893000001a1-1505601877.89358-444046738', '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 21:04:02 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 21:04:02 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 21:04:02 INFO - Using env: {'DISPLAY': ':0', 21:04:02 INFO - 'HOME': '/home/cltbld', 21:04:02 INFO - 'LANG': 'en_US.UTF-8', 21:04:02 INFO - 'LANGUAGE': 'en_US:en', 21:04:02 INFO - 'LOGNAME': 'cltbld', 21:04:02 INFO - 'MAIL': '/var/mail/cltbld', 21:04:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 21:04:02 INFO - 'MOZ_NO_REMOTE': '1', 21:04:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 21:04:02 INFO - 'NO_EM_RESTART': '1', 21:04:02 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 21:04:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 21:04:02 INFO - 'PWD': '/builds/slave/test', 21:04:02 INFO - 'SHELL': '/bin/bash', 21:04:02 INFO - 'SHLVL': '1', 21:04:02 INFO - 'TERM': 'linux', 21:04:02 INFO - 'TMOUT': '86400', 21:04:02 INFO - 'USER': 'cltbld', 21:04:02 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1505601877.89358-444046738', 21:04:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 21:04:02 INFO - '_': '/tools/buildbot/bin/python'} 21:04:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 21:04:02 INFO - Downloading/unpacking jsonschema==2.5.1 21:04:02 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 21:04:02 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 21:04:02 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 21:04:02 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 21:04:03 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 21:04:03 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 21:04:03 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 21:04:03 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 21:04:03 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 21:04:03 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 21:04:03 INFO - Downloading functools32-3.2.3-2.tar.gz 21:04:04 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 21:04:04 INFO - warning: no files found matching '*.txt' 21:04:04 INFO - no previously-included directories found matching 'build' 21:04:04 INFO - no previously-included directories found matching 'dist' 21:04:04 INFO - no previously-included directories found matching '.git*' 21:04:04 INFO - Installing collected packages: jsonschema, functools32 21:04:04 INFO - Running setup.py install for functools32 21:04:04 INFO - warning: no files found matching '*.txt' 21:04:04 INFO - no previously-included directories found matching 'build' 21:04:04 INFO - no previously-included directories found matching 'dist' 21:04:04 INFO - no previously-included directories found matching '.git*' 21:04:04 INFO - Successfully installed jsonschema functools32 21:04:04 INFO - Cleaning up... 21:04:04 INFO - Return code: 0 21:04:04 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 21:04:04 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')]} 21:04:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 21:04:04 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')]} 21:04:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 21:04:04 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 0x1c021f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dcba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f6ea60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f72090>, '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 0x1f72d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f6cf90>, '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': 'd2a8c569965ab8367867b893000001a1-1505601877.89358-444046738', '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 21:04:04 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 21:04:04 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 21:04:04 INFO - Using env: {'DISPLAY': ':0', 21:04:04 INFO - 'HOME': '/home/cltbld', 21:04:04 INFO - 'LANG': 'en_US.UTF-8', 21:04:04 INFO - 'LANGUAGE': 'en_US:en', 21:04:04 INFO - 'LOGNAME': 'cltbld', 21:04:04 INFO - 'MAIL': '/var/mail/cltbld', 21:04:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 21:04:04 INFO - 'MOZ_NO_REMOTE': '1', 21:04:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 21:04:04 INFO - 'NO_EM_RESTART': '1', 21:04:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 21:04:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 21:04:04 INFO - 'PWD': '/builds/slave/test', 21:04:04 INFO - 'SHELL': '/bin/bash', 21:04:04 INFO - 'SHLVL': '1', 21:04:04 INFO - 'TERM': 'linux', 21:04:04 INFO - 'TMOUT': '86400', 21:04:04 INFO - 'USER': 'cltbld', 21:04:04 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1505601877.89358-444046738', 21:04:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 21:04:04 INFO - '_': '/tools/buildbot/bin/python'} 21:04:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 21:04:04 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 21:04:04 INFO - Cleaning up... 21:04:04 INFO - Return code: 0 21:04:04 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 21:04:04 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')]} 21:04:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 21:04:04 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')]} 21:04:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 21:04:04 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 0x1c021f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dcba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f6ea60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f72090>, '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 0x1f72d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f6cf90>, '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': 'd2a8c569965ab8367867b893000001a1-1505601877.89358-444046738', '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 21:04:04 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 21:04:04 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 21:04:04 INFO - Using env: {'DISPLAY': ':0', 21:04:04 INFO - 'HOME': '/home/cltbld', 21:04:04 INFO - 'LANG': 'en_US.UTF-8', 21:04:04 INFO - 'LANGUAGE': 'en_US:en', 21:04:04 INFO - 'LOGNAME': 'cltbld', 21:04:04 INFO - 'MAIL': '/var/mail/cltbld', 21:04:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 21:04:04 INFO - 'MOZ_NO_REMOTE': '1', 21:04:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 21:04:04 INFO - 'NO_EM_RESTART': '1', 21:04:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 21:04:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 21:04:04 INFO - 'PWD': '/builds/slave/test', 21:04:04 INFO - 'SHELL': '/bin/bash', 21:04:04 INFO - 'SHLVL': '1', 21:04:04 INFO - 'TERM': 'linux', 21:04:04 INFO - 'TMOUT': '86400', 21:04:04 INFO - 'USER': 'cltbld', 21:04:04 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1505601877.89358-444046738', 21:04:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 21:04:04 INFO - '_': '/tools/buildbot/bin/python'} 21:04:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 21:04:04 INFO - Downloading/unpacking blobuploader==1.2.4 21:04: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 21:04: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 21:04: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 21:04: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 21:04:05 INFO - Downloading blobuploader-1.2.4.tar.gz 21:04:05 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 21:04:05 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 21:04: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 21:04: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 21:04: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 21:04: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 21:04:06 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 21:04:06 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 21:04: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 21:04: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 21:04: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 21:04: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 21:04:06 INFO - Downloading docopt-0.6.1.tar.gz 21:04:06 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 21:04:06 INFO - Installing collected packages: blobuploader, requests, docopt 21:04:06 INFO - Running setup.py install for blobuploader 21:04:06 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 21:04:06 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 21:04:06 INFO - Running setup.py install for requests 21:04:06 INFO - Running setup.py install for docopt 21:04:07 INFO - Successfully installed blobuploader requests docopt 21:04:07 INFO - Cleaning up... 21:04:07 INFO - Return code: 0 21:04:07 INFO - Installing None into virtualenv /builds/slave/test/build/venv 21:04:07 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')]} 21:04:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 21:04:07 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')]} 21:04:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 21:04:07 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 0x1c021f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dcba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f6ea60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f72090>, '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 0x1f72d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f6cf90>, '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': 'd2a8c569965ab8367867b893000001a1-1505601877.89358-444046738', '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 21:04:07 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 21:04:07 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 21:04:07 INFO - Using env: {'DISPLAY': ':0', 21:04:07 INFO - 'HOME': '/home/cltbld', 21:04:07 INFO - 'LANG': 'en_US.UTF-8', 21:04:07 INFO - 'LANGUAGE': 'en_US:en', 21:04:07 INFO - 'LOGNAME': 'cltbld', 21:04:07 INFO - 'MAIL': '/var/mail/cltbld', 21:04:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 21:04:07 INFO - 'MOZ_NO_REMOTE': '1', 21:04:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 21:04:07 INFO - 'NO_EM_RESTART': '1', 21:04:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 21:04:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 21:04:07 INFO - 'PWD': '/builds/slave/test', 21:04:07 INFO - 'SHELL': '/bin/bash', 21:04:07 INFO - 'SHLVL': '1', 21:04:07 INFO - 'TERM': 'linux', 21:04:07 INFO - 'TMOUT': '86400', 21:04:07 INFO - 'USER': 'cltbld', 21:04:07 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1505601877.89358-444046738', 21:04:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 21:04:07 INFO - '_': '/tools/buildbot/bin/python'} 21:04:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 21:04:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 21:04:07 INFO - Running setup.py (path:/tmp/pip-J__EV7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 21:04:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 21:04:07 INFO - Running setup.py (path:/tmp/pip-mLq8GK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 21:04:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 21:04:07 INFO - Running setup.py (path:/tmp/pip-OzV2ki-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 21:04:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 21:04:07 INFO - Running setup.py (path:/tmp/pip-TVITsA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 21:04:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 21:04:07 INFO - Running setup.py (path:/tmp/pip-82BBmm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 21:04:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 21:04:07 INFO - Running setup.py (path:/tmp/pip-2ZwGd8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 21:04:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 21:04:07 INFO - Running setup.py (path:/tmp/pip-gP2yAy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 21:04:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 21:04:07 INFO - Running setup.py (path:/tmp/pip-QaiYty-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 21:04:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 21:04:07 INFO - Running setup.py (path:/tmp/pip-xLBMZc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 21:04:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 21:04:07 INFO - Running setup.py (path:/tmp/pip-tjRxYq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 21:04:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 21:04:08 INFO - Running setup.py (path:/tmp/pip-nTJ0qC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 21:04:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 21:04:08 INFO - Running setup.py (path:/tmp/pip-0wRBFF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 21:04:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 21:04:08 INFO - Running setup.py (path:/tmp/pip-4emi41-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 21:04:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 21:04:08 INFO - Running setup.py (path:/tmp/pip-yRURk4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 21:04:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 21:04:08 INFO - Running setup.py (path:/tmp/pip-wam9s5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 21:04:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 21:04:08 INFO - Running setup.py (path:/tmp/pip-mptzAe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 21:04:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 21:04:08 INFO - Running setup.py (path:/tmp/pip-YpVY9O-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 21:04:08 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 21:04:08 INFO - Running setup.py install for manifestparser 21:04:08 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 21:04:08 INFO - Running setup.py install for mozcrash 21:04:08 INFO - Running setup.py install for mozdebug 21:04:08 INFO - Running setup.py install for mozdevice 21:04:08 INFO - Installing dm script to /builds/slave/test/build/venv/bin 21:04:08 INFO - Running setup.py install for mozfile 21:04:09 INFO - Running setup.py install for mozhttpd 21:04:09 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 21:04:09 INFO - Running setup.py install for mozinfo 21:04:09 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 21:04:09 INFO - Running setup.py install for mozInstall 21:04:09 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 21:04:09 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 21:04:09 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 21:04:09 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 21:04:09 INFO - Running setup.py install for mozleak 21:04:09 INFO - Running setup.py install for mozlog 21:04:09 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 21:04:09 INFO - Running setup.py install for moznetwork 21:04:09 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 21:04:09 INFO - Running setup.py install for mozprocess 21:04:09 INFO - Running setup.py install for mozprofile 21:04:09 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 21:04:09 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 21:04:09 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 21:04:09 INFO - Running setup.py install for mozrunner 21:04:09 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 21:04:09 INFO - Running setup.py install for mozscreenshot 21:04:10 INFO - Running setup.py install for moztest 21:04:10 INFO - Running setup.py install for mozversion 21:04:10 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 21:04:10 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 21:04:10 INFO - Cleaning up... 21:04:10 INFO - Return code: 0 21:04:10 INFO - Installing None into virtualenv /builds/slave/test/build/venv 21:04:10 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')]} 21:04:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 21:04:10 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')]} 21:04:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 21:04:10 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 0x1c021f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dcba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f6ea60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f72090>, '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 0x1f72d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f6cf90>, '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': 'd2a8c569965ab8367867b893000001a1-1505601877.89358-444046738', '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 21:04:10 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 21:04:10 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 21:04:10 INFO - Using env: {'DISPLAY': ':0', 21:04:10 INFO - 'HOME': '/home/cltbld', 21:04:10 INFO - 'LANG': 'en_US.UTF-8', 21:04:10 INFO - 'LANGUAGE': 'en_US:en', 21:04:10 INFO - 'LOGNAME': 'cltbld', 21:04:10 INFO - 'MAIL': '/var/mail/cltbld', 21:04:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 21:04:10 INFO - 'MOZ_NO_REMOTE': '1', 21:04:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 21:04:10 INFO - 'NO_EM_RESTART': '1', 21:04:10 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 21:04:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 21:04:10 INFO - 'PWD': '/builds/slave/test', 21:04:10 INFO - 'SHELL': '/bin/bash', 21:04:10 INFO - 'SHLVL': '1', 21:04:10 INFO - 'TERM': 'linux', 21:04:10 INFO - 'TMOUT': '86400', 21:04:10 INFO - 'USER': 'cltbld', 21:04:10 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1505601877.89358-444046738', 21:04:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 21:04:10 INFO - '_': '/tools/buildbot/bin/python'} 21:04:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 21:04:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 21:04:10 INFO - Running setup.py (path:/tmp/pip-YE_KTs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 21:04:10 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)) 21:04:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 21:04:10 INFO - Running setup.py (path:/tmp/pip-X5E2ca-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 21:04:10 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)) 21:04:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 21:04:10 INFO - Running setup.py (path:/tmp/pip-rLK2_d-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 21:04:10 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)) 21:04:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 21:04:10 INFO - Running setup.py (path:/tmp/pip-HZ6myu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 21:04:10 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)) 21:04:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 21:04:10 INFO - Running setup.py (path:/tmp/pip-utTcYX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 21:04:10 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)) 21:04:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 21:04:10 INFO - Running setup.py (path:/tmp/pip-EftCB0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 21:04:10 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)) 21:04:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 21:04:10 INFO - Running setup.py (path:/tmp/pip-68qk2_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 21:04:10 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)) 21:04:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 21:04:10 INFO - Running setup.py (path:/tmp/pip-EMbMdr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 21:04:11 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)) 21:04:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 21:04:11 INFO - Running setup.py (path:/tmp/pip-WYF_x9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 21:04:11 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)) 21:04:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 21:04:11 INFO - Running setup.py (path:/tmp/pip-GhcWR3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 21:04:11 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)) 21:04:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 21:04:11 INFO - Running setup.py (path:/tmp/pip-MVZmAx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 21:04:11 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)) 21:04:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 21:04:11 INFO - Running setup.py (path:/tmp/pip-apeItR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 21:04:11 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)) 21:04:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 21:04:11 INFO - Running setup.py (path:/tmp/pip-fRRGq_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 21:04:11 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)) 21:04:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 21:04:11 INFO - Running setup.py (path:/tmp/pip-FWBvNn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 21:04:11 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)) 21:04:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 21:04:11 INFO - Running setup.py (path:/tmp/pip-J8nNNX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 21:04:11 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)) 21:04:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 21:04:11 INFO - Running setup.py (path:/tmp/pip-Ywt9s1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 21:04:11 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)) 21:04:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 21:04:11 INFO - Running setup.py (path:/tmp/pip-ZmyzK7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 21:04:11 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)) 21:04:11 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)) 21:04:11 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)) 21:04:11 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)) 21:04:11 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)) 21:04:11 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)) 21:04:11 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)) 21:04:11 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.5->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 21:04:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 21:04:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 21:04:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 21:04:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 21:04:12 INFO - Downloading blessings-1.6.tar.gz 21:04:12 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 21:04:12 INFO - Installing collected packages: blessings 21:04:12 INFO - Running setup.py install for blessings 21:04:12 INFO - Successfully installed blessings 21:04:12 INFO - Cleaning up... 21:04:13 INFO - Return code: 0 21:04:13 INFO - Done creating virtualenv /builds/slave/test/build/venv. 21:04:13 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 21:04:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 21:04:13 INFO - Reading from file tmpfile_stdout 21:04:13 INFO - Current package versions: 21:04:13 INFO - argparse == 1.2.1 21:04:13 INFO - blessings == 1.6 21:04:13 INFO - blobuploader == 1.2.4 21:04:13 INFO - docopt == 0.6.1 21:04:13 INFO - functools32 == 3.2.3-2 21:04:13 INFO - jsonschema == 2.5.1 21:04:13 INFO - manifestparser == 1.1 21:04:13 INFO - mozInstall == 1.13 21:04:13 INFO - mozcrash == 1.0 21:04:13 INFO - mozdebug == 0.1 21:04:13 INFO - mozdevice == 0.51 21:04:13 INFO - mozfile == 1.2 21:04:13 INFO - mozhttpd == 0.7 21:04:13 INFO - mozinfo == 0.10 21:04:13 INFO - mozleak == 0.1 21:04:13 INFO - mozlog == 3.5 21:04:13 INFO - moznetwork == 0.27 21:04:13 INFO - mozprocess == 0.25 21:04:13 INFO - mozprofile == 0.28 21:04:13 INFO - mozrunner == 6.13 21:04:13 INFO - mozscreenshot == 0.1 21:04:13 INFO - mozsystemmonitor == 0.3 21:04:13 INFO - moztest == 0.8 21:04:13 INFO - mozversion == 1.4 21:04:13 INFO - psutil == 3.1.1 21:04:13 INFO - requests == 1.2.3 21:04:13 INFO - wsgiref == 0.1.2 21:04:13 INFO - Installing None into virtualenv /builds/slave/test/build/venv 21:04:13 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')]} 21:04:13 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 21:04:13 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')]} 21:04:13 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 21:04:13 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 0x1c021f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dcba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f6ea60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f72090>, '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 0x1f72d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f6cf90>, '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': 'd2a8c569965ab8367867b893000001a1-1505601877.89358-444046738', '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 21:04:13 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 21:04:13 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 21:04:13 INFO - Using env: {'DISPLAY': ':0', 21:04:13 INFO - 'HOME': '/home/cltbld', 21:04:13 INFO - 'LANG': 'en_US.UTF-8', 21:04:13 INFO - 'LANGUAGE': 'en_US:en', 21:04:13 INFO - 'LOGNAME': 'cltbld', 21:04:13 INFO - 'MAIL': '/var/mail/cltbld', 21:04:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 21:04:13 INFO - 'MOZ_NO_REMOTE': '1', 21:04:13 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 21:04:13 INFO - 'NO_EM_RESTART': '1', 21:04:13 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 21:04:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 21:04:13 INFO - 'PWD': '/builds/slave/test', 21:04:13 INFO - 'SHELL': '/bin/bash', 21:04:13 INFO - 'SHLVL': '1', 21:04:13 INFO - 'TERM': 'linux', 21:04:13 INFO - 'TMOUT': '86400', 21:04:13 INFO - 'USER': 'cltbld', 21:04:13 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1505601877.89358-444046738', 21:04:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 21:04:13 INFO - '_': '/tools/buildbot/bin/python'} 21:04:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 21:04:13 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)) 21:04:13 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)) 21:04:13 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)) 21:04:13 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)) 21:04:13 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)) 21:04:13 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)) 21:04:13 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)) 21:04:13 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)) 21:04:13 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)) 21:04:13 INFO - Downloading/unpacking simplejson>=2.1.1 (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 10)) 21:04: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 21:04: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 21:04: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 21:04: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 21:04:14 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/simplejson/setup.py) egg_info for package simplejson 21:04:14 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)) 21:04:14 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)) 21:04:14 INFO - Installing collected packages: simplejson 21:04:14 INFO - Running setup.py install for simplejson 21:04:14 INFO - building 'simplejson._speedups' extension 21:04:14 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 21:04:15 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 21:04:15 INFO - Successfully installed simplejson 21:04:15 INFO - Cleaning up... 21:04:15 INFO - Return code: 0 21:04:15 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 21:04: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')]} 21:04:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 21:04: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')]} 21:04:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 21:04:15 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 0x1c021f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dcba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f6ea60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f72090>, '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 0x1f72d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f6cf90>, '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': 'd2a8c569965ab8367867b893000001a1-1505601877.89358-444046738', '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 21:04:15 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 21:04:15 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 21:04:15 INFO - Using env: {'DISPLAY': ':0', 21:04:15 INFO - 'HOME': '/home/cltbld', 21:04:15 INFO - 'LANG': 'en_US.UTF-8', 21:04:15 INFO - 'LANGUAGE': 'en_US:en', 21:04:15 INFO - 'LOGNAME': 'cltbld', 21:04:15 INFO - 'MAIL': '/var/mail/cltbld', 21:04:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 21:04:15 INFO - 'MOZ_NO_REMOTE': '1', 21:04:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 21:04:15 INFO - 'NO_EM_RESTART': '1', 21:04:15 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 21:04:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 21:04:15 INFO - 'PWD': '/builds/slave/test', 21:04:15 INFO - 'SHELL': '/bin/bash', 21:04:15 INFO - 'SHLVL': '1', 21:04:15 INFO - 'TERM': 'linux', 21:04:15 INFO - 'TMOUT': '86400', 21:04:15 INFO - 'USER': 'cltbld', 21:04:15 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1505601877.89358-444046738', 21:04:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 21:04:15 INFO - '_': '/tools/buildbot/bin/python'} 21:04:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 21:04:15 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 21:04:15 INFO - Cleaning up... 21:04:15 INFO - Return code: 0 21:04:15 INFO - Running post-action listener: _resource_record_post_action 21:04:15 INFO - Running post-action listener: _start_resource_monitoring 21:04:15 INFO - Starting resource monitoring. 21:04:15 INFO - [mozharness: 2017-09-17 04:04:15.947957Z] Finished create-virtualenv step (success) 21:04:15 INFO - [mozharness: 2017-09-17 04:04:15.948479Z] Running install step. 21:04:15 INFO - Running pre-action listener: _resource_record_pre_action 21:04:15 INFO - Running main action method: install 21:04:15 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 21:04:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 21:04:16 INFO - Reading from file tmpfile_stdout 21:04:16 INFO - Detecting whether we're running mozinstall >=1.0... 21:04:16 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 21:04:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 21:04:16 INFO - Reading from file tmpfile_stdout 21:04:16 INFO - Output received: 21:04:16 INFO - Usage: mozinstall [options] installer 21:04:16 INFO - Options: 21:04:16 INFO - -h, --help show this help message and exit 21:04:16 INFO - -d DEST, --destination=DEST 21:04:16 INFO - Directory to install application into. [default: 21:04:16 INFO - "/builds/slave/test"] 21:04:16 INFO - --app=APP Application being installed. [default: firefox] 21:04:16 INFO - mkdir: /builds/slave/test/build/application 21:04:16 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'] 21:04:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 21:04:34 INFO - Reading from file tmpfile_stdout 21:04:34 INFO - Output received: 21:04:34 INFO - /builds/slave/test/build/application/firefox/firefox 21:04:34 INFO - Running post-action listener: _resource_record_post_action 21:04:34 INFO - [mozharness: 2017-09-17 04:04:34.078142Z] Finished install step (success) 21:04:34 INFO - [mozharness: 2017-09-17 04:04:34.078395Z] Running setup-mitmproxy step. 21:04:34 INFO - Running pre-action listener: _resource_record_pre_action 21:04:34 INFO - Running main action method: setup_mitmproxy 21:04:34 INFO - Skipping: mitmproxy is not required 21:04:34 INFO - Running post-action listener: _resource_record_post_action 21:04:34 INFO - [mozharness: 2017-09-17 04:04:34.079534Z] Finished setup-mitmproxy step (success) 21:04:34 INFO - [mozharness: 2017-09-17 04:04:34.079818Z] Running run-tests step. 21:04:34 INFO - Running pre-action listener: _resource_record_pre_action 21:04:34 INFO - Running pre-action listener: _set_gcov_prefix 21:04:34 INFO - Running main action method: run_tests 21:04:34 WARNING - Try message not found. 21:04:34 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 21:04:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 21:04:34 INFO - Python 2.7.3 21:04:34 INFO - Return code: 0 21:04:34 INFO - grabbing minidump binary from tooltool 21:04:34 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')]} 21:04:34 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 0x1f72090>, '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 0x1f72d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f6cf90>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 21:04:34 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 21:04:34 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 21:04:34 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 21:04:34 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 21:04:34 INFO - Return code: 0 21:04:34 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 21:04:34 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 21:04:34 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 21:04:34 INFO - ENV: RUST_BACKTRACE is now full 21:04:34 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 21:04:34 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 21:04:34 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/HL4DSwsdQYWbDYpmGciB1w/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-043', '--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 21:04:34 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/HL4DSwsdQYWbDYpmGciB1w/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-043 --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 21:04:34 INFO - Using env: {'DISPLAY': ':0', 21:04:34 INFO - 'HOME': '/home/cltbld', 21:04:34 INFO - 'LANG': 'en_US.UTF-8', 21:04:34 INFO - 'LANGUAGE': 'en_US:en', 21:04:34 INFO - 'LOGNAME': 'cltbld', 21:04:34 INFO - 'MAIL': '/var/mail/cltbld', 21:04:34 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 21:04:34 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 21:04:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 21:04:34 INFO - 'MOZ_NO_REMOTE': '1', 21:04:34 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 21:04:34 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 21:04:34 INFO - 'NO_EM_RESTART': '1', 21:04:34 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 21:04:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 21:04:34 INFO - 'PWD': '/builds/slave/test', 21:04:34 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 21:04:34 INFO - 'RUST_BACKTRACE': 'full', 21:04:34 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 21:04:34 INFO - 'SHELL': '/bin/bash', 21:04:34 INFO - 'SHLVL': '1', 21:04:34 INFO - 'TERM': 'linux', 21:04:34 INFO - 'TMOUT': '86400', 21:04:34 INFO - 'USER': 'cltbld', 21:04:34 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1505601877.89358-444046738', 21:04:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 21:04:34 INFO - '_': '/tools/buildbot/bin/python'} 21:04:34 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/HL4DSwsdQYWbDYpmGciB1w/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-043', '--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 21:04:34 INFO - mozversion application_buildid: 20170917031052 21:04:34 INFO - mozversion application_changeset: 015f852e93fe8887e666ee5a1ff246d3d4e8063b 21:04:34 INFO - mozversion application_display_name: Nightly 21:04:34 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 21:04:34 INFO - mozversion application_name: Firefox 21:04:34 INFO - mozversion application_remotingname: firefox 21:04:34 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 21:04:34 INFO - mozversion application_vendor: Mozilla 21:04:34 INFO - mozversion application_version: 57.0a1 21:04:34 INFO - mozversion platform_buildid: 20170917031052 21:04:34 INFO - mozversion platform_changeset: 015f852e93fe8887e666ee5a1ff246d3d4e8063b 21:04:34 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 21:04:34 INFO - mozversion platform_version: 57.0a1 21:04:34 INFO - using testdate: 1505621074 21:04:34 INFO - actual date: 1505621074 21:04:34 INFO - starting webserver on 'localhost:55862' 21:04:34 INFO - SUITE-START | Running 2 tests 21:04:34 INFO - TEST-START | dromaeo_css 21:04:34 INFO - Initialising browser for dromaeo_css test... 21:04:34 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:55862/getInfo.html -profile /tmp/tmpBkHeLG/profile 21:04:34 INFO - TEST-INFO | started process 13206 (/builds/slave/test/build/application/firefox/firefox http://localhost:55862/getInfo.html) 21:04:40 INFO - TEST-INFO | 13206: exit 0 21:04:40 INFO - Browser initialized. 21:04:40 INFO - Running cycle 1/1 for dromaeo_css test... 21:04:40 INFO - Using env: {'DISPLAY': ':0', 21:04:40 INFO - 'HOME': '/home/cltbld', 21:04:40 INFO - 'JSGC_DISABLE_POISONING': '1', 21:04:40 INFO - 'LANG': 'en_US.UTF-8', 21:04:40 INFO - 'LANGUAGE': 'en_US:en', 21:04:40 INFO - 'LD_LIBRARY_PATH': '/builds/slave/test/build/application/firefox', 21:04:40 INFO - 'LOGNAME': 'cltbld', 21:04:40 INFO - 'MAIL': '/var/mail/cltbld', 21:04:40 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 21:04:40 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 21:04:40 INFO - 'MOZ_CRASHREPORTER': '1', 21:04:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 21:04:40 INFO - 'MOZ_DISABLE_NONLOCAL_CONNECTIONS': '1', 21:04:40 INFO - 'MOZ_NO_REMOTE': '1', 21:04:40 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 21:04:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 21:04:40 INFO - 'NO_EM_RESTART': '1', 21:04:40 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 21:04:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 21:04:40 INFO - 'PWD': '/builds/slave/test', 21:04:40 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 21:04:40 INFO - 'RUST_BACKTRACE': 'full', 21:04:40 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 21:04:40 INFO - 'SHELL': '/bin/bash', 21:04:40 INFO - 'SHLVL': '1', 21:04:40 INFO - 'STYLO_FORCE_DISABLED': '1', 21:04:40 INFO - 'TERM': 'linux', 21:04:40 INFO - 'TMOUT': '86400', 21:04:40 INFO - 'USER': 'cltbld', 21:04:40 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1505601877.89358-444046738', 21:04:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 21:04:40 INFO - '_': '/tools/buildbot/bin/python'} 21:04:40 INFO - TEST-INFO | started process 13441 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpBkHeLG/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 21:04:41 INFO - PID 13441 | 21:04:41 INFO - PID 13441 | (/builds/slave/test/build/application/firefox/firefox:13490): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 21:04:41 INFO - PID 13441 | 21:04:51 INFO - PID 13441 | RSS: Main: 154861568 21:04:51 INFO - PID 13441 | 21:07:48 INFO - PID 13441 | Cycle 1(1): loaded http://localhost:55862/tests/dromaeo/cssquery-dojo.html (next: http://localhost:55862/tests/dromaeo/cssquery-ext.html) 21:07:50 INFO - PID 13441 | RSS: Main: 155557888 21:07:50 INFO - PID 13441 | 21:10:52 INFO - PID 13441 | Cycle 1(1): loaded http://localhost:55862/tests/dromaeo/cssquery-ext.html (next: http://localhost:55862/tests/dromaeo/cssquery-jquery.html) 21:10:52 INFO - PID 13441 | RSS: Main: 153780224 21:10:52 INFO - PID 13441 | 21:13:54 INFO - PID 13441 | Cycle 1(1): loaded http://localhost:55862/tests/dromaeo/cssquery-jquery.html (next: http://localhost:55862/tests/dromaeo/cssquery-mootools.html) 21:13:55 INFO - PID 13441 | RSS: Main: 157134848 21:13:55 INFO - PID 13441 | 21:16:56 INFO - PID 13441 | Cycle 1(1): loaded http://localhost:55862/tests/dromaeo/cssquery-mootools.html (next: http://localhost:55862/tests/dromaeo/cssquery-prototype.html) 21:16:57 INFO - PID 13441 | RSS: Main: 155308032 21:16:57 INFO - PID 13441 | 21:20:00 INFO - PID 13441 | Cycle 1(1): loaded http://localhost:55862/tests/dromaeo/cssquery-prototype.html (next: http://localhost:55862/tests/dromaeo/cssquery-yui.html) 21:20:01 INFO - PID 13441 | RSS: Main: 155262976 21:20:01 INFO - PID 13441 | 21:23:02 INFO - PID 13441 | Cycle 1(1): loaded http://localhost:55862/tests/dromaeo/cssquery-yui.html (next: http://localhost:55862/tests/dromaeo/cssquery-dojo.html) 21:23:02 INFO - PID 13441 | RSS: Main: 159547392 21:23:02 INFO - PID 13441 | 21:23:02 INFO - PID 13441 | __start_tp_report 21:23:02 INFO - PID 13441 | _x_x_mozilla_page_load 21:23:02 INFO - PID 13441 | _x_x_mozilla_page_load_details 21:23:02 INFO - PID 13441 | |i|pagename|runs| 21:23:02 INFO - PID 13441 | |0;dojo.html;3143.1827724791556;3152.747780177586;3162.5256211568276;3166.762492813038;3179.4912813949763;6054.364291749358;6163.815085547435;6200.658963756991;6288.937110628893;6312.33720459352;6187.102870083846;6212.720427580758;6222.253329600443;6231.906521402183;6232.376762323765;5674.035413979613;5679.602427830064;5681.545476361881;5699.145128230757;5769.423057694239;5721.256236689224;5747.540196784268;5785.421457854223;5792.391798861122;5803;902.6801755007757;5580.441955804387;5743.4543718346895;5818.389069147742;5845.240118784552;5175.024838190048;5602.60781745278;5696.829095127153;5734.197212390269;5780.306363236438;5641.887162256773;5662.66024038559;5726.541876649858;5731.168980497846;5735.11105778605;6133.601315914496;6141.570090093695;6179.69101544921;6264.091706702503;6275.403836635513;6635;6650.135482387307;6735.831604209885;6742.393184613359;6774.356436138559;6534.607923524603;6719.832004199885;6740.696668649923;6808.285130061371;6816.556923799987;6146.692665366714;6158.784442544535;6160.599561028519;6169.598976066586;6175.938240617581;6718.731250750013;6810.216825065181;6813.7955861324235;6817.181938167451;6822.624755638488;6471.255805582324;6599.274079851212;6600.80197594073;6608.900866487006;6612.338766123446;6701.932980670228;6718.160229971254;6767;6777.390034896883;6798.626075565792;6466.418022378009;6574.934250657528;6652.334766523309;6671.46628269747;6753.358430949052;6604.801855944329;6690.3978641921485;6691.029800678874;6695.665216739241;6700.262971073178;5294.179402192666;5312.282841816383;5337.412884582693;5340.49265319794;5346.224797404355;4518.43519560055;4582.106489234568;4582.725036497821;4647.744374059459;4650.697704649187;5809.070548712186;5864.237649105589;5881.235439392852;5886.499647529922;5888.705564721747;6722.428593569503;6728;6804.897926531106;6806.659667016629;6809.421199198025;5711.657300561979;5753.971230143906;5759.712014399347;5783.652980821164;5784.1034639630925;5496;5644.774209031675;5673.943260567424;5678.744456499468;5695.345035320908;6426.325235850169;6564.8358791030605;6581.736730530725;6594.967025164843;6624.635645039472;6608.471322294301;6629.502787290972;6666.300038495985;6718.966405167943;6724.4620430364475;6356.078368636429;6499.122618446639;6600.108985287116;6602.471802255712;6607.834804129935;6422.6467544285515;6464.612123272619;6466.612003279818;6472.805815825533;6507.902381464187;6556.311587283267;6609.339066093352;6627.834304142435;6668.966655166693;6772.55978361405;6488.318726533646;6511.120998665119;6528.640924749185;6544;6547.247066587213;6455.160829092188;6457.741690332334;6540.084388185753;6548.672566371758;6549.181352330958;6399.9680001601555;6404.871902562016;6474.643894585843;6479.449246814073;6482.611043337226;6360.173177486897;6375.681215939092;6416;6422.486201103807;6612.900806488003;6208.410201030895;6273.059041143865;6280.466160376419;6281.654509002049;6285.937140628535 21:23:02 INFO - PID 13441 | |1;ext.html;844.0630899701332;863.1627321498148;863.1886027134497;866.6836604639304;876.7063033883646;39255.80372098139;39802.80098599507;42366;42835.35746963798;42840.78579607102;38879;38937.22125557487;39111.608883911154;39174.21651566967;39180;7145.785626431215;7234.3489085982255;7271;7663.6168191590195;7886.6451009704415;7795.064592248938;7838.176991415905;7892.56590887501;7893.684252629888;7900.920990790076;7857.057153141631;7893.368530517545;7895.644695988665;7950.522968621873;7958.920410795905;7920.920790792076;7947.682092716284;7948.602569871483;7950.642221100006;7958.880616790752;7739.226077392272;7860.921390786076;7862.68549258029;7865.7246996355425;7869.2130786921425;38589.807050964846;38809;38877.61122388768;38911.22177556433;38947.41578876319;3604.1530240393486;3604.6936010439144;3608.0799396154075;3621.7102631789394;3631.673149416565;31794.36411271785;31804.36391272185;31855.52216716751;31913.84043079793;32030.359392812014;5201.635885488017;5274.894502109974;5292.814751483679;5300;5335.839924802223;184278.0786096061;185651;185689;185995;186411.06794466075;43670;49828;49875.25187122196;50002.499975000515;50112.74943625258;45121.54878451239;52258;52888.471115289125;53159.46840531545;53189.7340513295;16238.594035149215;16374.345026199057;16413.6717265654;16422.589435264214;16467.917660411862;13240.40418181165;13261.469541218436;13323.66690832737;13336.866631333562;13413.463461461432;14373.856261437251;14452.277386130652;14522.128672279698;14690.265486725835;14801.407943682347;5789.739461724148;5820.679862607512;5911.793087242012;5959.67221802805;5964.224650795456;1010.4543546484963;1017.8524114003428;1031.3966329697212;1036.6164519127972;1045.5242864496636;22952.19667311636;23052.4236894079;23106.7689323108;23459.648105278433;23647.038249181733;1120.6918097523082;1127.4081107418672;1129.1192869561755;1138.561653763307;1144.0618692672097;11962.521499139937;12272.938635306766;12316.445759940645;12397.62807115788;12450.501979920882;212009;212674;213328;213478;213997;53522.19716704253;53660.46339536633;53737.731311343196;53856;53946;1445;1458.6863824277618;1466.9779953300708;1477.7635578307634;1480.2968589919917;22205.77794222102;22541.549169016856;22847.771522284565;22908.19821306313;23073.307800766004;37598;37696;37781.4332785014;37798.24403511969;37877.621223787406;185146;185211;185393;185794;185978;31910.680893190773;32570.83714581412;34653;35647.28705425929;35704.28591428209;43489.78255108704;43682.12635747331;44119;44159.33760993652;44327.11345773002;32120.518192226667;32374.676253237165;32634.673653263162;32681.18297042593;33726.66273337235;31583.526247105852;31589.8420507896;31919.6808031926;32265.838670806497;32419.837900810344;35553.46669800007;35676.46485302671;35693.28613427769;35864.64135358613;35994.28011439809;31095.533566996965;31139.765599620525;31181.68818311788;31370.372592548476;31381.372372552876;23564.293071207892;23787.52424951526;23789.64315535303;23912.88043559771;24262 21:23:02 INFO - PID 13441 | |2;jquery.html;543.244889603451;548.6214511986732;552.5441510753627;576.3717547872819;590.852286928268;22098.558028839412;22518.54962900741;22974.88512557439;22982.965766540525;23029.769702302972;25333.2400027999;25762.22713318599;25863.87068064657;26227.73772262277;26273.86863065682;6590.901136482945;6752.4260437862595;6753.5947843129325;6758.763443279487;6763.932360676379;6038.57729958903;6324.873502529947;6559.114519539872;6631.966840165816;6686.699098540577;6634.4692424606155;6634.601923884558;6637.535372523926;6639.668016599175;6641.535092543524;6605.669716514155;6606.471482281406;6611.404973552403;6616.437602803743;6626.171728533934;6155.87688246237;6159.692015399212;6186.288576813679;6187.102870083858;6188.2883468400805;28483.57274640882;29247;29592.112236632936;29654.851725741235;29866.10401687953;2057.2696692674035;2081.1675329868176;2082.125507286943;2089.4671858675943;2090.456481314854;19350.225990960345;19417.320393786293;20173.5965280695;20214.494637634176;20229.696554551694;2474.8391354562077;2481.2060140754966;2539.7587229213195;2541.55522783514;2549.1842610364693;135567.32216338953;139456.30271848576;140221;147533;147964.2601786995;14755.114693118447;14797.408103675947;14882.851171488363;14967.251637418085;15311.46409875649;23432.64851027236;23483;23486.177983770485;23520.294391168292;23549.7645023551;10076.244281678903;10301;10422.791544169075;10568.15454763617;10601.257911946244;9612.134907858186;9660.613575457044;9707.417554946725;9738.172255358373;9839.262055345878;9133.725988220363;9147.131022552847;9288.210502107397;9507.952460237793;9566.234701224024;2733.3986522964915;2789.17719272815;2800.341919648881;2816.718328167208;2835.3903910659305;977.1889331854544;983.5460525987563;995.7510622344414;1005.1857995024054;1011.8077565262577;19869.503262418555;19994.20023199056;20102.798972010387;20386.28647997313;20537.691934620994;1059.4861492176287;1061.1775873697945;1061.596593294543;1065.8561094252332;1067.151614466501;10942.562297508011;11019.504122314514;11183.776324473627;11231.775364492665;11338.546458141582;398266;406328;406901;408093;414370;108611;112056.43971780252;112368;112968;113022;1046.4296958157822;1083.7832433513172;1089.6948854320804;1161.256795650801;1199.1665792274287;20474.181032758523;20850.270240541508;20892.47768805792;20930.37208883736;21097.6835347473;55712.72143639256;55714.442855570924;56923;57929.710351447975;58043.70978145082;66880;67187.66406167937;67232;67417;67764;14184.290785460893;14587.270636467922;14642.70714585681;14668;14774.409023638935;22437.775622244222;22953.426164346023;23128.190513331952;23149.3055208344;23435.296941091794;17539.035353055704;18326.17532211027;18381.17284722164;18418.907905460386;18584.349547765763;15711.21443927822;16209.837901620833;16561.66876662436;16608.58478537998;16608.58478537998;18442.07789610541;18577.34979275773;18691;18705.438836834917;18808.529786754894;14457;14457.060291081047;14481;14537.20045397471;14627.853721462649;14459.927700361432;14588.34352454121;15935.840641593899;17729.37947171843;17915.19381627856 21:23:02 INFO - PID 13441 | |3;mootools.html;1348.8381394232695;1400.915945043298;1402.0816365280741;1424.2807382271951;1424.9002569820116;14890.404383824647;15362.692746145085;15467.767983480257;15495.147766872846;15502.379904803794;15214.315355808987;15291.158986255752;15308.387664493406;15322.616934576614;15324.080555166698;2678.1429942418436;2704.5131876262267;2746.368335282876;2747.5466548019654;2759.806813523054;2703.986480067597;2714.280715610365;2724.632174656426;2727.931801704963;2728.5225085610036;2640.854752988585;2653.668291463567;2675.1439539347416;2777.9722202778016;2785.470760555488;2716.891324347024;2737.8220415672918;2741.7258274172723;2760.585912113179;2771.847548384838;2465.3836540864786;2612.42526644138;2712.308361367858;2716.4023914738727;2725.427660191362;15097.698046039128;15337.079775213411;15337.923310383376;15356.308966096552;15358.462453814063;7892.763217103496;8165;8183.631736571869;8193.713220037329;8201.22088401601;5413.404525502192;5500.834974950758;5620.522255608278;5754.79858204965;5762.452567006169;1867.9719804202948;1909.4748944040361;1928.855335849803;1957.4421289932443;1958.3733205374285;27076.32309192286;27337.726622733917;27393.041243556578;27406.725932740817;27417.31456713578;6788.389044985975;6836;6953.9916712076465;6961.512694111465;7028.4025857801635;17393.652126957644;17519.47441576755;17532.29870805179;17549;17556.209970551357;7768.805779855549;7932.643031063616;7938.126806051329;7944.165862584461;7945.8410831784195;7236.927630723625;7239.457040721862;7281.635918204174;7447.627618619047;7449.739259125905;5076.898462030738;5182.2485739567555;5187.221916712523;5272.393674727378;5435.809746658848;1454.7454195515743;1476.8670819626286;1483.7329280729357;1487.1077353587762;1502.0386952350505;839.4207996482407;862.2799962031773;875.3872289397448;879.5646155153112;893.6961433112643;7314.195438501761;8570.4000719949;8758.56207189638;8883.866741998876;8901.777455563662;706.2125729811223;709.989350159748;716.298027932629;722.8482018776011;726.3716884894634;5287.68273903567;5309.41596424393;5324.787008519694;5435.347758269033;5466.5900057495055;21317.893410532848;21998.89000554987;22348.106075756787;22371.776282237293;22385.104595815985;20406.71954087124;21395;21601.567968640855;21640.242591509537;21701.891490542446;10182.439965801952;10242.948785256027;10305.175585953106;10453.059224669816;10462.372257664412;8302.418830682036;8416.11630778784;8470.407071504935;8475.279601233964;8590.699325523577;18003.459896203134;18129;18576;18704.812951870852;18777.53056173552;18628.81371186271;18702;18977;19341;19691.70462443093;10361.067503924683;10407.479626018518;10570.365778053341;10609.89390106089;10621.681349559525;13968.511102111785;14064.929675351557;14093.224872631694;14100.576982690536;14109.29453527299;11248;11339.206255562362;11362.715932101764;11542.82685759731;11549.538018479167;10577.259591828499;10768.946155269487;11029.83455248188;11145.164112691742;11180.04969577595;10101.494925253855;10240.53917573696;10270.33242839213;10283.794324113625;10371.170306375623;6652.501062420241;6705.463562914858;6724.865502690017;6805.115335006418;6836.28219036994;6830.692618832065;6961.269066748121;6989.5107342485535;7049.189343225389;7084.858302834017 21:23:02 INFO - PID 13441 | |4;prototype.html;498.6961380851856;504.1832231784509;519.1252739134561;526.5050852198933;528.207688467299;6281.120643109963;6288.151099601552;6310.589811662238;6328.3988021137975;6365.135688939972;6200.937990620092;6228.408301211389;6266.342034086424;6272.090546870701;6277.4664153547;5101.642884998052;5166.630842826654;5169.353830771153;5197.246399272103;5199.974000129994;4840.830570930018;4975.850724478253;5170.638055336128;5179.792808287664;5185.714785686786;4957.4298955620025;4965.503449655042;4972.676776009566;4983.9252411213865;4984.102861484931;4934.410997772071;4946.516045186429;4957.182064959277;4969.8509044728535;4979.950200497985;4354.804033818486;4426.557344265548;4446.3108218226225;4460.553944605514;4464.196444639996;5997.4002599740115;6037.215162028952;6038.245219347582;6047.516198704093;6068.969655151696;5500.669959802424;5606;5612.130119831392;5627.577931655102;5628.212050312959;6418.250494633984;6423.325550817191;6437;6456.51576131792;6471.320511346335;4609.193391156534;4776.73416544616;4828.5412885775795;4842.297866809293;4865.391826021747;6632.701528431232;6663.800085997428;6709.3290670933;6738.52830301879;6837.076994605714;4942.975285123552;4943.134951383566;4953.950460495421;4964.230544265644;4985.302057711923;4949.406071271471;4987.226979818061;5032.7735251913755;5041.344625198701;5046.924296135561;5568.749406276646;5616;5639.661620302795;5644;5653.689047102449;6457.063725759833;6510.437495001261;6536.444402225864;6536.614135840384;6561.114249576246;1695.279506209856;1735.0283841049054;1737.426649205759;1738.660961112571;1754;1148.661144962238;1180.2446434282067;1188.4075339045721;1198.1433275208267;1211.5577814097967;5601.9385945189415;5654.971725141348;5662.998610736317;5671.376148623648;5672.4611161940375;6538.574992625464;6633.568818026813;6634.635095069721;6637.966810165918;6662.40038396537;5614.354349249807;5635.774569017193;5658.377578466366;5677.574181936371;5697.4302569742695;3477.6000759912426;3499.632538583463;3500.789952602801;3508.280942338287;3533.5229743984746;6467.385598368148;6478.343879009678;6483.967580162069;6508.219013718384;6512.348765123545;6704.899426508607;6726.19285685711;6786.558873673195;6786.59280443175;6872.762902677466;6299.622022678654;6378.11845505577;6440.774572889926;6506.869862602722;6530.771423000172;5983.611065280743;6604.273529911609;6616.603003819786;6638.601683898982;6653.135092437952;6350.206224221973;6399.840003999751;6419.935800642121;6484.114569016742;6485.8702825944165;6337.207849018872;6371.776987805404;6419.133416988833;6449.3873082057125;6483.4164925156965;4848.660593758545;4889.535494128052;4898.142825005681;4923.8276660316715;4957.200075911264;6322.3762138713755;6396.680165991589;6519.511036672174;6648.867022659423;6660;6255.093011513396;6452.483801295791;6459.967700161469;6472.449841763503;6492;6333.556651034383;6386.201724784402;6395.650957348861;6411.49329907462;6469.8706025880165;6266.373362663697;6281.340459251713;6350.1109844622715;6368.904466432915;6378;6390.297067322684;6467.676616169078;6510.674466276762;6511.902321465087;6538.038588423549;6263.404976527223;6274.215723034621;6295.041330574622;6315.242170939517;6322.905156422749 21:23:02 INFO - PID 13441 | |5;yui.html;901.8602116671918;920.3695468604005;931.958061887215;940.0505489455647;953.7663272498237;19061.71407428888;20000.899995500004;20051.29820456284;20074.899625501872;20084.196632134735;16431.507054788344;16947.406840760577;16985.49043528696;19065.714014289795;19192.904035479838;934.6635211323935;967.88869280033;973.8587904753842;973.9902600974006;974.2206235011997;953.0564740906522;995.248587316575;996.6362277768599;997.2371136080903;997.3218211616098;1053.210092430677;1061.9522121504551;1062.6227689170348;1063.261033581661;1063.7925604507125;995.1690338567305;1018.3889666200295;1033.4832583708146;1039.2880876599515;1040.0743338428804;753.1978442958232;754.1628792040831;757.0877093102798;757.307064036406;757.7650928212216;20295.79704202954;20548.38354849357;20560.38318850437;20572.485687857774;20588.27941022057;20941.26705565313;21835;21867.12531498754;21890;21894.12423503058;17230.138493075297;17321;17475.47573572795;17709.380171694058;17730.556736081573;3703.740738148331;3705.6109108543483;3733.1413774831667;3738.0841693784923;3739.1773809761808;141525;142781;144427;144902;146413;16324.75512867308;16641.66716665684;16778.41275555374;16831.24259408305;16861.409850655167;29749.851250743606;30381.69618303833;30501.62742676585;30533.38933221323;30546.236344091576;8623.655053797904;8780.341474389446;8890.73327800167;8904.332175086894;8919.152680495343;4116.794160292034;4164.104717485755;4197.559256278108;4255.616994470451;4266.274733295348;5488.9725551372785;5566.860828479321;5572.080606699849;5599.44005599445;5606.803761868315;932.2262522106636;974.1378879691524;979.8138353712772;984.3700031979539;986.9457179855033;669.4376723552142;684.2746688510196;693.0678237770192;701.431840209432;705.104517263073;11704.35626040559;12139.332336721389;12153.210041347284;12275.447604857804;12356;698.5913240754215;703.3529153179087;705.5696025424487;706.6502081469705;719.3885197582118;5467.9453205468235;5519.558435325164;5528.861778455571;5537.473939975695;5611.8597035073635;121797.98110586005;124890.37554812168;125196;126395;128463.35768321286;109394;109772;110607.44696276468;110938.44530777456;112029.43985280185;92459;94963;95009;98480.99999999857;99699.50150249347;10227.170512807628;10283.331583447052;10443.530041148319;10492.527836247235;10664.89335106639;44765.32852007288;45857;46033.079338413714;46366.84082897955;46610.533894661974;57748;57918;58160.70919645375;58229.4177058224;59407;15191;15224.391024359345;15297;15304.617384565476;15326.386944522093;16765.497035088967;16783.832161678227;16794;16962.575935601708;17073.14634268257;14383.352749126105;14746;14946.028508146936;15028.17345046033;15035.248237588296;15195.468158614396;15474.458393956158;15561.76657350118;15602.765958510405;15626.921865390601;14719.55841324762;14733.189674568002;14814.77777833355;14982.325795339018;15077.39690412415;10896.400697961688;11149.72125696864;11219.55121795119;11247.88752112501;11269.605563805228;10879.891201087888;10892.455377230948;10895.182861285593;11036.282641628268;11287 21:23:02 INFO - PID 13441 | __end_tp_report 21:23:02 INFO - PID 13441 | __start_cc_report 21:23:02 INFO - PID 13441 | _x_x_mozilla_cycle_collect,310 21:23:02 INFO - PID 13441 | __end_cc_report 21:23:02 INFO - PID 13441 | __startTimestamp1505622182859__endTimestamp 21:23:02 INFO - PID 13441 | 21:23:02 INFO - PID 13441 | ------- Summary: start ------- 21:23:02 INFO - PID 13441 | Number of tests: 6 21:23:02 INFO - PID 13441 | 21:23:02 INFO - PID 13441 | [#0] dojo.html Cycles:165 Average:6102.08 Median:6399.97 stddev:837.02 (13.1%) stddev-sans-first:806.76 21:23:02 INFO - PID 13441 | Values: 3143.2 3152.7 3162.5 3166.8 3179.5 6054.4 6163.8 6200.7 6288.9 6312.3 6187.1 6212.7 6222.3 6231.9 6232.4 5674.0 5679.6 5681.5 5699.1 5769.4 5721.3 5747.5 5785.4 5792.4 5803.0 902.7 5580.4 5743.5 5818.4 5845.2 5175.0 5602.6 5696.8 5734.2 5780.3 5641.9 5662.7 5726.5 5731.2 5735.1 6133.6 6141.6 6179.7 6264.1 6275.4 6635.0 6650.1 6735.8 6742.4 6774.4 6534.6 6719.8 6740.7 6808.3 6816.6 6146.7 6158.8 6160.6 6169.6 6175.9 6718.7 6810.2 6813.8 6817.2 6822.6 6471.3 6599.3 6600.8 6608.9 6612.3 6701.9 6718.2 6767.0 6777.4 6798.6 6466.4 6574.9 6652.3 6671.5 6753.4 6604.8 6690.4 6691.0 6695.7 6700.3 5294.2 5312.3 5337.4 5340.5 5346.2 4518.4 4582.1 4582.7 4647.7 4650.7 5809.1 5864.2 5881.2 5886.5 5888.7 6722.4 6728.0 6804.9 6806.7 6809.4 5711.7 5754.0 5759.7 5783.7 5784.1 5496.0 5644.8 5673.9 5678.7 5695.3 6426.3 6564.8 6581.7 6595.0 6624.6 6608.5 6629.5 6666.3 6719.0 6724.5 6356.1 6499.1 6600.1 6602.5 6607.8 6422.6 6464.6 6466.6 6472.8 6507.9 6556.3 6609.3 6627.8 6669.0 6772.6 6488.3 6511.1 6528.6 6544.0 6547.2 6455.2 6457.7 6540.1 6548.7 6549.2 6400.0 6404.9 6474.6 6479.4 6482.6 6360.2 6375.7 6416.0 6422.5 6612.9 6208.4 6273.1 6280.5 6281.7 6285.9 21:23:02 INFO - PID 13441 | 21:23:02 INFO - PID 13441 | [#1] ext.html Cycles:180 Average:36701.50 Median:35684.88 stddev:50457.66 (141.4%) stddev-sans-first:50527.37 21:23:02 INFO - PID 13441 | Values: 844.1 863.2 863.2 866.7 876.7 39255.8 39802.8 42366.0 42835.4 42840.8 38879.0 38937.2 39111.6 39174.2 39180.0 7145.8 7234.3 7271.0 7663.6 7886.6 7795.1 7838.2 7892.6 7893.7 7900.9 7857.1 7893.4 7895.6 7950.5 7958.9 7920.9 7947.7 7948.6 7950.6 7958.9 7739.2 7860.9 7862.7 7865.7 7869.2 38589.8 38809.0 38877.6 38911.2 38947.4 3604.2 3604.7 3608.1 3621.7 3631.7 31794.4 31804.4 31855.5 31913.8 32030.4 5201.6 5274.9 5292.8 5300.0 5335.8 184278.1 185651.0 185689.0 185995.0 186411.1 43670.0 49828.0 49875.3 50002.5 50112.7 45121.5 52258.0 52888.5 53159.5 53189.7 16238.6 16374.3 16413.7 16422.6 16467.9 13240.4 13261.5 13323.7 13336.9 13413.5 14373.9 14452.3 14522.1 14690.3 14801.4 5789.7 5820.7 5911.8 5959.7 5964.2 1010.5 1017.9 1031.4 1036.6 1045.5 22952.2 23052.4 23106.8 23459.6 23647.0 1120.7 1127.4 1129.1 1138.6 1144.1 11962.5 12272.9 12316.4 12397.6 12450.5 212009.0 212674.0 213328.0 213478.0 213997.0 53522.2 53660.5 53737.7 53856.0 53946.0 1445.0 1458.7 1467.0 1477.8 1480.3 22205.8 22541.5 22847.8 22908.2 23073.3 37598.0 37696.0 37781.4 37798.2 37877.6 185146.0 185211.0 185393.0 185794.0 185978.0 31910.7 32570.8 34653.0 35647.3 35704.3 43489.8 43682.1 44119.0 44159.3 44327.1 32120.5 32374.7 32634.7 32681.2 33726.7 31583.5 31589.8 31919.7 32265.8 32419.8 35553.5 35676.5 35693.3 35864.6 35994.3 31095.5 31139.8 31181.7 31370.4 31381.4 23564.3 23787.5 23789.6 23912.9 24262.0 21:23:02 INFO - PID 13441 | 21:23:02 INFO - PID 13441 | [#2] jquery.html Cycles:180 Average:32444.39 Median:22964.16 stddev:69912.34 (304.4%) stddev-sans-first:70067.43 21:23:02 INFO - PID 13441 | Values: 543.2 548.6 552.5 576.4 590.9 22098.6 22518.5 22974.9 22983.0 23029.8 25333.2 25762.2 25863.9 26227.7 26273.9 6590.9 6752.4 6753.6 6758.8 6763.9 6038.6 6324.9 6559.1 6632.0 6686.7 6634.5 6634.6 6637.5 6639.7 6641.5 6605.7 6606.5 6611.4 6616.4 6626.2 6155.9 6159.7 6186.3 6187.1 6188.3 28483.6 29247.0 29592.1 29654.9 29866.1 2057.3 2081.2 2082.1 2089.5 2090.5 19350.2 19417.3 20173.6 20214.5 20229.7 2474.8 2481.2 2539.8 2541.6 2549.2 135567.3 139456.3 140221.0 147533.0 147964.3 14755.1 14797.4 14882.9 14967.3 15311.5 23432.6 23483.0 23486.2 23520.3 23549.8 10076.2 10301.0 10422.8 10568.2 10601.3 9612.1 9660.6 9707.4 9738.2 9839.3 9133.7 9147.1 9288.2 9508.0 9566.2 2733.4 2789.2 2800.3 2816.7 2835.4 977.2 983.5 995.8 1005.2 1011.8 19869.5 19994.2 20102.8 20386.3 20537.7 1059.5 1061.2 1061.6 1065.9 1067.2 10942.6 11019.5 11183.8 11231.8 11338.5 398266.0 406328.0 406901.0 408093.0 414370.0 108611.0 112056.4 112368.0 112968.0 113022.0 1046.4 1083.8 1089.7 1161.3 1199.2 20474.2 20850.3 20892.5 20930.4 21097.7 55712.7 55714.4 56923.0 57929.7 58043.7 66880.0 67187.7 67232.0 67417.0 67764.0 14184.3 14587.3 14642.7 14668.0 14774.4 22437.8 22953.4 23128.2 23149.3 23435.3 17539.0 18326.2 18381.2 18418.9 18584.3 15711.2 16209.8 16561.7 16608.6 16608.6 18442.1 18577.3 18691.0 18705.4 18808.5 14457.0 14457.1 14481.0 14537.2 14627.9 14459.9 14588.3 15935.8 17729.4 17915.2 21:23:02 INFO - PID 13441 | 21:23:02 INFO - PID 13441 | [#3] mootools.html Cycles:180 Average:9341.91 Median:2691.06 stddev:6757.09 (251.1%) stddev-sans-first:6749.36 21:23:02 INFO - PID 13441 | Values: 1348.8 1400.9 1402.1 1424.3 1424.9 14890.4 15362.7 15467.8 15495.1 15502.4 15214.3 15291.2 15308.4 15322.6 15324.1 2678.1 2704.5 2746.4 2747.5 2759.8 2704.0 2714.3 2724.6 2727.9 2728.5 2640.9 2653.7 2675.1 2778.0 2785.5 2716.9 2737.8 2741.7 2760.6 2771.8 2465.4 2612.4 2712.3 2716.4 2725.4 15097.7 15337.1 15337.9 15356.3 15358.5 7892.8 8165.0 8183.6 8193.7 8201.2 5413.4 5500.8 5620.5 5754.8 5762.5 1868.0 1909.5 1928.9 1957.4 1958.4 27076.3 27337.7 27393.0 27406.7 27417.3 6788.4 6836.0 6954.0 6961.5 7028.4 17393.7 17519.5 17532.3 17549.0 17556.2 7768.8 7932.6 7938.1 7944.2 7945.8 7236.9 7239.5 7281.6 7447.6 7449.7 5076.9 5182.2 5187.2 5272.4 5435.8 1454.7 1476.9 1483.7 1487.1 1502.0 839.4 862.3 875.4 879.6 893.7 7314.2 8570.4 8758.6 8883.9 8901.8 706.2 710.0 716.3 722.8 726.4 5287.7 5309.4 5324.8 5435.3 5466.6 21317.9 21998.9 22348.1 22371.8 22385.1 20406.7 21395.0 21601.6 21640.2 21701.9 10182.4 10242.9 10305.2 10453.1 10462.4 8302.4 8416.1 8470.4 8475.3 8590.7 18003.5 18129.0 18576.0 18704.8 18777.5 18628.8 18702.0 18977.0 19341.0 19691.7 10361.1 10407.5 10570.4 10609.9 10621.7 13968.5 14064.9 14093.2 14100.6 14109.3 11248.0 11339.2 11362.7 11542.8 11549.5 10577.3 10768.9 11029.8 11145.2 11180.0 10101.5 10240.5 10270.3 10283.8 10371.2 6652.5 6705.5 6724.9 6805.1 6836.3 6830.7 6961.3 6989.5 7049.2 7084.9 21:23:02 INFO - PID 13441 | 21:23:02 INFO - PID 13441 | [#4] prototype.html Cycles:180 Average:5447.23 Median:6134.95 stddev:1518.14 (24.7%) stddev-sans-first:1476.27 21:23:02 INFO - PID 13441 | Values: 498.7 504.2 519.1 526.5 528.2 6281.1 6288.2 6310.6 6328.4 6365.1 6200.9 6228.4 6266.3 6272.1 6277.5 5101.6 5166.6 5169.4 5197.2 5200.0 4840.8 4975.9 5170.6 5179.8 5185.7 4957.4 4965.5 4972.7 4983.9 4984.1 4934.4 4946.5 4957.2 4969.9 4980.0 4354.8 4426.6 4446.3 4460.6 4464.2 5997.4 6037.2 6038.2 6047.5 6069.0 5500.7 5606.0 5612.1 5627.6 5628.2 6418.3 6423.3 6437.0 6456.5 6471.3 4609.2 4776.7 4828.5 4842.3 4865.4 6632.7 6663.8 6709.3 6738.5 6837.1 4943.0 4943.1 4954.0 4964.2 4985.3 4949.4 4987.2 5032.8 5041.3 5046.9 5568.7 5616.0 5639.7 5644.0 5653.7 6457.1 6510.4 6536.4 6536.6 6561.1 1695.3 1735.0 1737.4 1738.7 1754.0 1148.7 1180.2 1188.4 1198.1 1211.6 5601.9 5655.0 5663.0 5671.4 5672.5 6538.6 6633.6 6634.6 6638.0 6662.4 5614.4 5635.8 5658.4 5677.6 5697.4 3477.6 3499.6 3500.8 3508.3 3533.5 6467.4 6478.3 6484.0 6508.2 6512.3 6704.9 6726.2 6786.6 6786.6 6872.8 6299.6 6378.1 6440.8 6506.9 6530.8 5983.6 6604.3 6616.6 6638.6 6653.1 6350.2 6399.8 6419.9 6484.1 6485.9 6337.2 6371.8 6419.1 6449.4 6483.4 4848.7 4889.5 4898.1 4923.8 4957.2 6322.4 6396.7 6519.5 6648.9 6660.0 6255.1 6452.5 6460.0 6472.4 6492.0 6333.6 6386.2 6395.7 6411.5 6469.9 6266.4 6281.3 6350.1 6368.9 6378.0 6390.3 6467.7 6510.7 6511.9 6538.0 6263.4 6274.2 6295.0 6315.2 6322.9 21:23:02 INFO - PID 13441 | 21:23:02 INFO - PID 13441 | [#5] yui.html Cycles:180 Average:24514.52 Median:20554.38 stddev:36150.34 (175.9%) stddev-sans-first:36208.27 21:23:02 INFO - PID 13441 | Values: 901.9 920.4 932.0 940.1 953.8 19061.7 20000.9 20051.3 20074.9 20084.2 16431.5 16947.4 16985.5 19065.7 19192.9 934.7 967.9 973.9 974.0 974.2 953.1 995.2 996.6 997.2 997.3 1053.2 1062.0 1062.6 1063.3 1063.8 995.2 1018.4 1033.5 1039.3 1040.1 753.2 754.2 757.1 757.3 757.8 20295.8 20548.4 20560.4 20572.5 20588.3 20941.3 21835.0 21867.1 21890.0 21894.1 17230.1 17321.0 17475.5 17709.4 17730.6 3703.7 3705.6 3733.1 3738.1 3739.2 141525.0 142781.0 144427.0 144902.0 146413.0 16324.8 16641.7 16778.4 16831.2 16861.4 29749.9 30381.7 30501.6 30533.4 30546.2 8623.7 8780.3 8890.7 8904.3 8919.2 4116.8 4164.1 4197.6 4255.6 4266.3 5489.0 5566.9 5572.1 5599.4 5606.8 932.2 974.1 979.8 984.4 986.9 669.4 684.3 693.1 701.4 705.1 11704.4 12139.3 12153.2 12275.4 12356.0 698.6 703.4 705.6 706.7 719.4 5467.9 5519.6 5528.9 5537.5 5611.9 121798.0 124890.4 125196.0 126395.0 128463.4 109394.0 109772.0 110607.4 110938.4 112029.4 92459.0 94963.0 95009.0 98481.0 99699.5 10227.2 10283.3 10443.5 10492.5 10664.9 44765.3 45857.0 46033.1 46366.8 46610.5 57748.0 57918.0 58160.7 58229.4 59407.0 15191.0 15224.4 15297.0 15304.6 15326.4 16765.5 16783.8 16794.0 16962.6 17073.1 14383.4 14746.0 14946.0 15028.2 15035.2 15195.5 15474.5 15561.8 15602.8 15626.9 14719.6 14733.2 14814.8 14982.3 15077.4 10896.4 11149.7 11219.6 11247.9 11269.6 10879.9 10892.5 10895.2 11036.3 11287.0 21:23:02 INFO - PID 13441 | -------- Summary: end -------- 21:23:02 INFO - PID 13441 | 21:23:03 INFO - TEST-INFO | 13441: exit 0 21:23:03 INFO - TEST-OK | dromaeo_css | took 1109219ms 21:23:03 INFO - TEST-START | kraken 21:23:03 INFO - Initialising browser for kraken test... 21:23:03 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:55862/getInfo.html -profile /tmp/tmpMGc9Zv/profile 21:23:03 INFO - TEST-INFO | started process 13810 (/builds/slave/test/build/application/firefox/firefox http://localhost:55862/getInfo.html) 21:23:09 INFO - TEST-INFO | 13810: exit 0 21:23:09 INFO - Browser initialized. 21:23:09 INFO - Running cycle 1/1 for kraken test... 21:23:09 INFO - Using env: {'DISPLAY': ':0', 21:23:09 INFO - 'HOME': '/home/cltbld', 21:23:09 INFO - 'JSGC_DISABLE_POISONING': '1', 21:23:09 INFO - 'LANG': 'en_US.UTF-8', 21:23:09 INFO - 'LANGUAGE': 'en_US:en', 21:23:09 INFO - 'LD_LIBRARY_PATH': '/builds/slave/test/build/application/firefox', 21:23:09 INFO - 'LOGNAME': 'cltbld', 21:23:09 INFO - 'MAIL': '/var/mail/cltbld', 21:23:09 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 21:23:09 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 21:23:09 INFO - 'MOZ_CRASHREPORTER': '1', 21:23:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 21:23:09 INFO - 'MOZ_DISABLE_NONLOCAL_CONNECTIONS': '1', 21:23:09 INFO - 'MOZ_NO_REMOTE': '1', 21:23:09 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 21:23:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 21:23:09 INFO - 'NO_EM_RESTART': '1', 21:23:09 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 21:23:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 21:23:09 INFO - 'PWD': '/builds/slave/test', 21:23:09 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 21:23:09 INFO - 'RUST_BACKTRACE': 'full', 21:23:09 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 21:23:09 INFO - 'SHELL': '/bin/bash', 21:23:09 INFO - 'SHLVL': '1', 21:23:09 INFO - 'STYLO_FORCE_DISABLED': '1', 21:23:09 INFO - 'TERM': 'linux', 21:23:09 INFO - 'TMOUT': '86400', 21:23:09 INFO - 'USER': 'cltbld', 21:23:09 INFO - 'XDG_SESSION_COOKIE': 'd2a8c569965ab8367867b893000001a1-1505601877.89358-444046738', 21:23:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 21:23:09 INFO - '_': '/tools/buildbot/bin/python'} 21:23:09 INFO - TEST-INFO | started process 14045 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpMGc9Zv/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 21:23:10 INFO - PID 14045 | 21:23:10 INFO - PID 14045 | (/builds/slave/test/build/application/firefox/firefox:14094): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 21:23:10 INFO - PID 14045 | 21:23:20 INFO - PID 14045 | RSS: Main: 154865664 21:23:20 INFO - PID 14045 | 21:23:23 INFO - PID 14045 | Cycle 1(1): loaded http://localhost:55862/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:55862/tests/kraken/driver.html?testName=audio-beat-detection) 21:23:24 INFO - PID 14045 | RSS: Main: 160423936 21:23:24 INFO - PID 14045 | 21:23:26 INFO - PID 14045 | Cycle 1(1): loaded http://localhost:55862/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:55862/tests/kraken/driver.html?testName=audio-dft) 21:23:27 INFO - PID 14045 | RSS: Main: 160215040 21:23:27 INFO - PID 14045 | 21:23:30 INFO - PID 14045 | Cycle 1(1): loaded http://localhost:55862/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:55862/tests/kraken/driver.html?testName=audio-fft) 21:23:30 INFO - PID 14045 | RSS: Main: 157016064 21:23:30 INFO - PID 14045 | 21:23:32 INFO - PID 14045 | Cycle 1(1): loaded http://localhost:55862/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:55862/tests/kraken/driver.html?testName=audio-oscillator) 21:23:33 INFO - PID 14045 | RSS: Main: 158027776 21:23:33 INFO - PID 14045 | 21:23:35 INFO - PID 14045 | Cycle 1(1): loaded http://localhost:55862/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:55862/tests/kraken/driver.html?testName=imaging-gaussian-blur) 21:23:36 INFO - PID 14045 | RSS: Main: 157863936 21:23:36 INFO - PID 14045 | 21:23:39 INFO - PID 14045 | Cycle 1(1): loaded http://localhost:55862/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:55862/tests/kraken/driver.html?testName=imaging-darkroom) 21:23:40 INFO - PID 14045 | RSS: Main: 160342016 21:23:40 INFO - PID 14045 | 21:23:43 INFO - PID 14045 | Cycle 1(1): loaded http://localhost:55862/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:55862/tests/kraken/driver.html?testName=imaging-desaturate) 21:23:44 INFO - PID 14045 | RSS: Main: 160772096 21:23:44 INFO - PID 14045 | 21:23:47 INFO - PID 14045 | Cycle 1(1): loaded http://localhost:55862/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:55862/tests/kraken/driver.html?testName=json-parse-financial) 21:23:48 INFO - PID 14045 | RSS: Main: 160800768 21:23:48 INFO - PID 14045 | 21:23:49 INFO - PID 14045 | Cycle 1(1): loaded http://localhost:55862/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:55862/tests/kraken/driver.html?testName=json-stringify-tinderbox) 21:23:50 INFO - PID 14045 | RSS: Main: 160710656 21:23:50 INFO - PID 14045 | 21:23:51 INFO - PID 14045 | Cycle 1(1): loaded http://localhost:55862/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:55862/tests/kraken/driver.html?testName=stanford-crypto-aes) 21:23:52 INFO - PID 14045 | RSS: Main: 160604160 21:23:52 INFO - PID 14045 | 21:23:54 INFO - PID 14045 | Cycle 1(1): loaded http://localhost:55862/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:55862/tests/kraken/driver.html?testName=stanford-crypto-ccm) 21:23:55 INFO - PID 14045 | RSS: Main: 157704192 21:23:55 INFO - PID 14045 | 21:23:57 INFO - PID 14045 | Cycle 1(1): loaded http://localhost:55862/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:55862/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 21:23:58 INFO - PID 14045 | RSS: Main: 158490624 21:23:58 INFO - PID 14045 | 21:24:01 INFO - PID 14045 | Cycle 1(1): loaded http://localhost:55862/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:55862/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 21:24:02 INFO - PID 14045 | RSS: Main: 158642176 21:24:02 INFO - PID 14045 | 21:24:03 INFO - PID 14045 | Cycle 1(1): loaded http://localhost:55862/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:55862/tests/kraken/driver.html?testName=ai-astar) 21:24:04 INFO - PID 14045 | RSS: Main: 159662080 21:24:04 INFO - PID 14045 | 21:24:04 INFO - PID 14045 | __start_tp_report 21:24:04 INFO - PID 14045 | _x_x_mozilla_page_load 21:24:04 INFO - PID 14045 | _x_x_mozilla_page_load_details 21:24:04 INFO - PID 14045 | |i|pagename|runs| 21:24:04 INFO - PID 14045 | |0;ai-astar;112;108;109;106;107;109;109;106;106;106 21:24:04 INFO - PID 14045 | |1;audio-beat-detection;118;118;121;117;118;117;116;118;117;121 21:24:04 INFO - PID 14045 | |2;audio-dft;163;164;165;162;162;162;162;167;167;164 21:24:04 INFO - PID 14045 | |3;audio-fft;74;73;74;78;75;74;76;74;75;79 21:24:04 INFO - PID 14045 | |4;audio-oscillator;79;79;79;78;88;80;79;79;81;80 21:24:04 INFO - PID 14045 | |5;imaging-gaussian-blur;111;114;115;114;111;114;114;114;115;113 21:24:04 INFO - PID 14045 | |6;imaging-darkroom;157;148;148;148;148;150;150;149;147;149 21:24:04 INFO - PID 14045 | |7;imaging-desaturate;94;94;94;94;96;94;95;94;95;95 21:24:04 INFO - PID 14045 | |8;json-parse-financial;57;55;51;54;55;53;55;54;60;55 21:24:04 INFO - PID 14045 | |9;json-stringify-tinderbox;37;37;37;37;38;38;37;38;37;37 21:24:04 INFO - PID 14045 | |10;stanford-crypto-aes;79;75;74;74;75;76;77;78;76;74 21:24:04 INFO - PID 14045 | |11;stanford-crypto-ccm;120;113;114;113;113;115;111;114;115;115 21:24:04 INFO - PID 14045 | |12;stanford-crypto-pbkdf2;172;172;170;174;175;176;166;179;170;173 21:24:04 INFO - PID 14045 | |13;stanford-crypto-sha256-iterative;80;68;68;67;66;65;66;63;66;70 21:24:04 INFO - PID 14045 | __end_tp_report 21:24:04 INFO - PID 14045 | __start_cc_report 21:24:04 INFO - PID 14045 | _x_x_mozilla_cycle_collect,745 21:24:04 INFO - PID 14045 | __end_cc_report 21:24:04 INFO - PID 14045 | __startTimestamp1505622244071__endTimestamp 21:24:04 INFO - PID 14045 | 21:24:04 INFO - PID 14045 | ------- Summary: start ------- 21:24:04 INFO - PID 14045 | Number of tests: 14 21:24:04 INFO - PID 14045 | 21:24:04 INFO - PID 14045 | [#0] ai-astar Cycles:10 Average:107.80 Median:108.50 stddev:1.99 (1.8%) stddev-sans-first:1.41 21:24:04 INFO - PID 14045 | Values: 112.0 108.0 109.0 106.0 107.0 109.0 109.0 106.0 106.0 106.0 21:24:04 INFO - PID 14045 | 21:24:04 INFO - PID 14045 | [#1] audio-beat-detection Cycles:10 Average:118.10 Median:118.00 stddev:1.66 (1.4%) stddev-sans-first:1.76 21:24:04 INFO - PID 14045 | Values: 118.0 118.0 121.0 117.0 118.0 117.0 116.0 118.0 117.0 121.0 21:24:04 INFO - PID 14045 | 21:24:04 INFO - PID 14045 | [#2] audio-dft Cycles:10 Average:163.80 Median:164.00 stddev:1.99 (1.2%) stddev-sans-first:2.09 21:24:04 INFO - PID 14045 | Values: 163.0 164.0 165.0 162.0 162.0 162.0 162.0 167.0 167.0 164.0 21:24:04 INFO - PID 14045 | 21:24:04 INFO - PID 14045 | [#3] audio-fft Cycles:10 Average:75.20 Median:75.00 stddev:1.93 (2.6%) stddev-sans-first:2.00 21:24:04 INFO - PID 14045 | Values: 74.0 73.0 74.0 78.0 75.0 74.0 76.0 74.0 75.0 79.0 21:24:04 INFO - PID 14045 | 21:24:04 INFO - PID 14045 | [#4] audio-oscillator Cycles:10 Average:80.20 Median:79.50 stddev:2.86 (3.6%) stddev-sans-first:3.00 21:24:04 INFO - PID 14045 | Values: 79.0 79.0 79.0 78.0 88.0 80.0 79.0 79.0 81.0 80.0 21:24:04 INFO - PID 14045 | 21:24:04 INFO - PID 14045 | [#5] imaging-gaussian-blur Cycles:10 Average:113.50 Median:114.00 stddev:1.43 (1.3%) stddev-sans-first:1.20 21:24:04 INFO - PID 14045 | Values: 111.0 114.0 115.0 114.0 111.0 114.0 114.0 114.0 115.0 113.0 21:24:04 INFO - PID 14045 | 21:24:04 INFO - PID 14045 | [#6] imaging-darkroom Cycles:10 Average:149.40 Median:149.00 stddev:2.84 (1.9%) stddev-sans-first:1.01 21:24:04 INFO - PID 14045 | Values: 157.0 148.0 148.0 148.0 148.0 150.0 150.0 149.0 147.0 149.0 21:24:04 INFO - PID 14045 | 21:24:04 INFO - PID 14045 | [#7] imaging-desaturate Cycles:10 Average:94.50 Median:94.50 stddev:0.71 (0.7%) stddev-sans-first:0.73 21:24:04 INFO - PID 14045 | Values: 94.0 94.0 94.0 94.0 96.0 94.0 95.0 94.0 95.0 95.0 21:24:04 INFO - PID 14045 | 21:24:04 INFO - PID 14045 | [#8] json-parse-financial Cycles:10 Average:54.90 Median:55.00 stddev:2.38 (4.3%) stddev-sans-first:2.40 21:24:04 INFO - PID 14045 | Values: 57.0 55.0 51.0 54.0 55.0 53.0 55.0 54.0 60.0 55.0 21:24:04 INFO - PID 14045 | 21:24:04 INFO - PID 14045 | [#9] json-stringify-tinderbox Cycles:10 Average:37.30 Median:37.00 stddev:0.48 (1.3%) stddev-sans-first:0.50 21:24:04 INFO - PID 14045 | Values: 37.0 37.0 37.0 37.0 38.0 38.0 37.0 38.0 37.0 37.0 21:24:04 INFO - PID 14045 | 21:24:04 INFO - PID 14045 | [#10] stanford-crypto-aes Cycles:10 Average:75.80 Median:76.00 stddev:1.75 (2.3%) stddev-sans-first:1.42 21:24:04 INFO - PID 14045 | Values: 79.0 75.0 74.0 74.0 75.0 76.0 77.0 78.0 76.0 74.0 21:24:04 INFO - PID 14045 | 21:24:04 INFO - PID 14045 | [#11] stanford-crypto-ccm Cycles:10 Average:114.30 Median:114.50 stddev:2.36 (2.1%) stddev-sans-first:1.32 21:24:04 INFO - PID 14045 | Values: 120.0 113.0 114.0 113.0 113.0 115.0 111.0 114.0 115.0 115.0 21:24:04 INFO - PID 14045 | 21:24:04 INFO - PID 14045 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:172.70 Median:173.50 stddev:3.62 (2.1%) stddev-sans-first:3.83 21:24:04 INFO - PID 14045 | Values: 172.0 172.0 170.0 174.0 175.0 176.0 166.0 179.0 170.0 173.0 21:24:04 INFO - PID 14045 | 21:24:04 INFO - PID 14045 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:67.90 Median:67.50 stddev:4.65 (6.9%) stddev-sans-first:2.01 21:24:04 INFO - PID 14045 | Values: 80.0 68.0 68.0 67.0 66.0 65.0 66.0 63.0 66.0 70.0 21:24:04 INFO - PID 14045 | -------- Summary: end -------- 21:24:04 INFO - PID 14045 | 21:24:04 INFO - PID 14045 | *** UTM:SVC TimerManager:registerTimer called after profile-before-change notification. Ignoring timer registration for id: telemetry_modules_ping 21:24:04 INFO - TEST-INFO | 14045: exit 0 21:24:04 INFO - TEST-OK | kraken | took 61035ms 21:24:04 INFO - SUITE-END | took 1170s 21:24:04 INFO - Completed test suite (00:19:30) 21:24:04 INFO - javascript benchmark 21:24:04 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s", "stylo_disabled"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 8458.594947454274, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3143.1827724791556, 3152.747780177586, 3162.5256211568276, 3166.762492813038, 3179.4912813949763, 6054.364291749358, 6163.815085547435, 6200.658963756991, 6288.937110628893, 6312.33720459352, 6187.102870083846, 6212.720427580758, 6222.253329600443, 6231.906521402183, 6232.376762323765, 5674.035413979613, 5679.602427830064, 5681.545476361881, 5699.145128230757, 5769.423057694239, 5721.256236689224, 5747.540196784268, 5785.421457854223, 5792.391798861122, 5803.0, 902.6801755007757, 5580.441955804387, 5743.4543718346895, 5818.389069147742, 5845.240118784552, 5175.024838190048, 5602.60781745278, 5696.829095127153, 5734.197212390269, 5780.306363236438, 5641.887162256773, 5662.66024038559, 5726.541876649858, 5731.168980497846, 5735.11105778605, 6133.601315914496, 6141.570090093695, 6179.69101544921, 6264.091706702503, 6275.403836635513, 6635.0, 6650.135482387307, 6735.831604209885, 6742.393184613359, 6774.356436138559, 6534.607923524603, 6719.832004199885, 6740.696668649923, 6808.285130061371, 6816.556923799987, 6146.692665366714, 6158.784442544535, 6160.599561028519, 6169.598976066586, 6175.938240617581, 6718.731250750013, 6810.216825065181, 6813.7955861324235, 6817.181938167451, 6822.624755638488, 6471.255805582324, 6599.274079851212, 6600.80197594073, 6608.900866487006, 6612.338766123446, 6701.932980670228, 6718.160229971254, 6767.0, 6777.390034896883, 6798.626075565792, 6466.418022378009, 6574.934250657528, 6652.334766523309, 6671.46628269747, 6753.358430949052, 6604.801855944329, 6690.3978641921485, 6691.029800678874, 6695.665216739241, 6700.262971073178, 5294.179402192666, 5312.282841816383, 5337.412884582693, 5340.49265319794, 5346.224797404355, 4518.43519560055, 4582.106489234568, 4582.725036497821, 4647.744374059459, 4650.697704649187, 5809.070548712186, 5864.237649105589, 5881.235439392852, 5886.499647529922, 5888.705564721747, 6722.428593569503, 6728.0, 6804.897926531106, 6806.659667016629, 6809.421199198025, 5711.657300561979, 5753.971230143906, 5759.712014399347, 5783.652980821164, 5784.1034639630925, 5496.0, 5644.774209031675, 5673.943260567424, 5678.744456499468, 5695.345035320908, 6426.325235850169, 6564.8358791030605, 6581.736730530725, 6594.967025164843, 6624.635645039472, 6608.471322294301, 6629.502787290972, 6666.300038495985, 6718.966405167943, 6724.4620430364475, 6356.078368636429, 6499.122618446639, 6600.108985287116, 6602.471802255712, 6607.834804129935, 6422.6467544285515, 6464.612123272619, 6466.612003279818, 6472.805815825533, 6507.902381464187, 6556.311587283267, 6609.339066093352, 6627.834304142435, 6668.966655166693, 6772.55978361405, 6488.318726533646, 6511.120998665119, 6528.640924749185, 6544.0, 6547.247066587213, 6455.160829092188, 6457.741690332334, 6540.084388185753, 6548.672566371758, 6549.181352330958, 6399.9680001601555, 6404.871902562016, 6474.643894585843, 6479.449246814073, 6482.611043337226, 6360.173177486897, 6375.681215939092, 6416.0, 6422.486201103807, 6612.900806488003, 6208.410201030895, 6273.059041143865, 6280.466160376419, 6281.654509002049, 6285.937140628535], "value": 6042.495033316607, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [844.0630899701332, 863.1627321498148, 863.1886027134497, 866.6836604639304, 876.7063033883646, 39255.80372098139, 39802.80098599507, 42366.0, 42835.35746963798, 42840.78579607102, 38879.0, 38937.22125557487, 39111.608883911154, 39174.21651566967, 39180.0, 7145.785626431215, 7234.3489085982255, 7271.0, 7663.6168191590195, 7886.6451009704415, 7795.064592248938, 7838.176991415905, 7892.56590887501, 7893.684252629888, 7900.920990790076, 7857.057153141631, 7893.368530517545, 7895.644695988665, 7950.522968621873, 7958.920410795905, 7920.920790792076, 7947.682092716284, 7948.602569871483, 7950.642221100006, 7958.880616790752, 7739.226077392272, 7860.921390786076, 7862.68549258029, 7865.7246996355425, 7869.2130786921425, 38589.807050964846, 38809.0, 38877.61122388768, 38911.22177556433, 38947.41578876319, 3604.1530240393486, 3604.6936010439144, 3608.0799396154075, 3621.7102631789394, 3631.673149416565, 31794.36411271785, 31804.36391272185, 31855.52216716751, 31913.84043079793, 32030.359392812014, 5201.635885488017, 5274.894502109974, 5292.814751483679, 5300.0, 5335.839924802223, 184278.0786096061, 185651.0, 185689.0, 185995.0, 186411.06794466075, 43670.0, 49828.0, 49875.25187122196, 50002.499975000515, 50112.74943625258, 45121.54878451239, 52258.0, 52888.471115289125, 53159.46840531545, 53189.7340513295, 16238.594035149215, 16374.345026199057, 16413.6717265654, 16422.589435264214, 16467.917660411862, 13240.40418181165, 13261.469541218436, 13323.66690832737, 13336.866631333562, 13413.463461461432, 14373.856261437251, 14452.277386130652, 14522.128672279698, 14690.265486725835, 14801.407943682347, 5789.739461724148, 5820.679862607512, 5911.793087242012, 5959.67221802805, 5964.224650795456, 1010.4543546484963, 1017.8524114003428, 1031.3966329697212, 1036.6164519127972, 1045.5242864496636, 22952.19667311636, 23052.4236894079, 23106.7689323108, 23459.648105278433, 23647.038249181733, 1120.6918097523082, 1127.4081107418672, 1129.1192869561755, 1138.561653763307, 1144.0618692672097, 11962.521499139937, 12272.938635306766, 12316.445759940645, 12397.62807115788, 12450.501979920882, 212009.0, 212674.0, 213328.0, 213478.0, 213997.0, 53522.19716704253, 53660.46339536633, 53737.731311343196, 53856.0, 53946.0, 1445.0, 1458.6863824277618, 1466.9779953300708, 1477.7635578307634, 1480.2968589919917, 22205.77794222102, 22541.549169016856, 22847.771522284565, 22908.19821306313, 23073.307800766004, 37598.0, 37696.0, 37781.4332785014, 37798.24403511969, 37877.621223787406, 185146.0, 185211.0, 185393.0, 185794.0, 185978.0, 31910.680893190773, 32570.83714581412, 34653.0, 35647.28705425929, 35704.28591428209, 43489.78255108704, 43682.12635747331, 44119.0, 44159.33760993652, 44327.11345773002, 32120.518192226667, 32374.676253237165, 32634.673653263162, 32681.18297042593, 33726.66273337235, 31583.526247105852, 31589.8420507896, 31919.6808031926, 32265.838670806497, 32419.837900810344, 35553.46669800007, 35676.46485302671, 35693.28613427769, 35864.64135358613, 35994.28011439809, 31095.533566996965, 31139.765599620525, 31181.68818311788, 31370.372592548476, 31381.372372552876, 23564.293071207892, 23787.52424951526, 23789.64315535303, 23912.88043559771, 24262.0], "value": 17208.71147776614, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [543.244889603451, 548.6214511986732, 552.5441510753627, 576.3717547872819, 590.852286928268, 22098.558028839412, 22518.54962900741, 22974.88512557439, 22982.965766540525, 23029.769702302972, 25333.2400027999, 25762.22713318599, 25863.87068064657, 26227.73772262277, 26273.86863065682, 6590.901136482945, 6752.4260437862595, 6753.5947843129325, 6758.763443279487, 6763.932360676379, 6038.57729958903, 6324.873502529947, 6559.114519539872, 6631.966840165816, 6686.699098540577, 6634.4692424606155, 6634.601923884558, 6637.535372523926, 6639.668016599175, 6641.535092543524, 6605.669716514155, 6606.471482281406, 6611.404973552403, 6616.437602803743, 6626.171728533934, 6155.87688246237, 6159.692015399212, 6186.288576813679, 6187.102870083858, 6188.2883468400805, 28483.57274640882, 29247.0, 29592.112236632936, 29654.851725741235, 29866.10401687953, 2057.2696692674035, 2081.1675329868176, 2082.125507286943, 2089.4671858675943, 2090.456481314854, 19350.225990960345, 19417.320393786293, 20173.5965280695, 20214.494637634176, 20229.696554551694, 2474.8391354562077, 2481.2060140754966, 2539.7587229213195, 2541.55522783514, 2549.1842610364693, 135567.32216338953, 139456.30271848576, 140221.0, 147533.0, 147964.2601786995, 14755.114693118447, 14797.408103675947, 14882.851171488363, 14967.251637418085, 15311.46409875649, 23432.64851027236, 23483.0, 23486.177983770485, 23520.294391168292, 23549.7645023551, 10076.244281678903, 10301.0, 10422.791544169075, 10568.15454763617, 10601.257911946244, 9612.134907858186, 9660.613575457044, 9707.417554946725, 9738.172255358373, 9839.262055345878, 9133.725988220363, 9147.131022552847, 9288.210502107397, 9507.952460237793, 9566.234701224024, 2733.3986522964915, 2789.17719272815, 2800.341919648881, 2816.718328167208, 2835.3903910659305, 977.1889331854544, 983.5460525987563, 995.7510622344414, 1005.1857995024054, 1011.8077565262577, 19869.503262418555, 19994.20023199056, 20102.798972010387, 20386.28647997313, 20537.691934620994, 1059.4861492176287, 1061.1775873697945, 1061.596593294543, 1065.8561094252332, 1067.151614466501, 10942.562297508011, 11019.504122314514, 11183.776324473627, 11231.775364492665, 11338.546458141582, 398266.0, 406328.0, 406901.0, 408093.0, 414370.0, 108611.0, 112056.43971780252, 112368.0, 112968.0, 113022.0, 1046.4296958157822, 1083.7832433513172, 1089.6948854320804, 1161.256795650801, 1199.1665792274287, 20474.181032758523, 20850.270240541508, 20892.47768805792, 20930.37208883736, 21097.6835347473, 55712.72143639256, 55714.442855570924, 56923.0, 57929.710351447975, 58043.70978145082, 66880.0, 67187.66406167937, 67232.0, 67417.0, 67764.0, 14184.290785460893, 14587.270636467922, 14642.70714585681, 14668.0, 14774.409023638935, 22437.775622244222, 22953.426164346023, 23128.190513331952, 23149.3055208344, 23435.296941091794, 17539.035353055704, 18326.17532211027, 18381.17284722164, 18418.907905460386, 18584.349547765763, 15711.21443927822, 16209.837901620833, 16561.66876662436, 16608.58478537998, 16608.58478537998, 18442.07789610541, 18577.34979275773, 18691.0, 18705.438836834917, 18808.529786754894, 14457.0, 14457.060291081047, 14481.0, 14537.20045397471, 14627.853721462649, 14459.927700361432, 14588.34352454121, 15935.840641593899, 17729.37947171843, 17915.19381627856], "value": 11975.847730926676, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1348.8381394232695, 1400.915945043298, 1402.0816365280741, 1424.2807382271951, 1424.9002569820116, 14890.404383824647, 15362.692746145085, 15467.767983480257, 15495.147766872846, 15502.379904803794, 15214.315355808987, 15291.158986255752, 15308.387664493406, 15322.616934576614, 15324.080555166698, 2678.1429942418436, 2704.5131876262267, 2746.368335282876, 2747.5466548019654, 2759.806813523054, 2703.986480067597, 2714.280715610365, 2724.632174656426, 2727.931801704963, 2728.5225085610036, 2640.854752988585, 2653.668291463567, 2675.1439539347416, 2777.9722202778016, 2785.470760555488, 2716.891324347024, 2737.8220415672918, 2741.7258274172723, 2760.585912113179, 2771.847548384838, 2465.3836540864786, 2612.42526644138, 2712.308361367858, 2716.4023914738727, 2725.427660191362, 15097.698046039128, 15337.079775213411, 15337.923310383376, 15356.308966096552, 15358.462453814063, 7892.763217103496, 8165.0, 8183.631736571869, 8193.713220037329, 8201.22088401601, 5413.404525502192, 5500.834974950758, 5620.522255608278, 5754.79858204965, 5762.452567006169, 1867.9719804202948, 1909.4748944040361, 1928.855335849803, 1957.4421289932443, 1958.3733205374285, 27076.32309192286, 27337.726622733917, 27393.041243556578, 27406.725932740817, 27417.31456713578, 6788.389044985975, 6836.0, 6953.9916712076465, 6961.512694111465, 7028.4025857801635, 17393.652126957644, 17519.47441576755, 17532.29870805179, 17549.0, 17556.209970551357, 7768.805779855549, 7932.643031063616, 7938.126806051329, 7944.165862584461, 7945.8410831784195, 7236.927630723625, 7239.457040721862, 7281.635918204174, 7447.627618619047, 7449.739259125905, 5076.898462030738, 5182.2485739567555, 5187.221916712523, 5272.393674727378, 5435.809746658848, 1454.7454195515743, 1476.8670819626286, 1483.7329280729357, 1487.1077353587762, 1502.0386952350505, 839.4207996482407, 862.2799962031773, 875.3872289397448, 879.5646155153112, 893.6961433112643, 7314.195438501761, 8570.4000719949, 8758.56207189638, 8883.866741998876, 8901.777455563662, 706.2125729811223, 709.989350159748, 716.298027932629, 722.8482018776011, 726.3716884894634, 5287.68273903567, 5309.41596424393, 5324.787008519694, 5435.347758269033, 5466.5900057495055, 21317.893410532848, 21998.89000554987, 22348.106075756787, 22371.776282237293, 22385.104595815985, 20406.71954087124, 21395.0, 21601.567968640855, 21640.242591509537, 21701.891490542446, 10182.439965801952, 10242.948785256027, 10305.175585953106, 10453.059224669816, 10462.372257664412, 8302.418830682036, 8416.11630778784, 8470.407071504935, 8475.279601233964, 8590.699325523577, 18003.459896203134, 18129.0, 18576.0, 18704.812951870852, 18777.53056173552, 18628.81371186271, 18702.0, 18977.0, 19341.0, 19691.70462443093, 10361.067503924683, 10407.479626018518, 10570.365778053341, 10609.89390106089, 10621.681349559525, 13968.511102111785, 14064.929675351557, 14093.224872631694, 14100.576982690536, 14109.29453527299, 11248.0, 11339.206255562362, 11362.715932101764, 11542.82685759731, 11549.538018479167, 10577.259591828499, 10768.946155269487, 11029.83455248188, 11145.164112691742, 11180.04969577595, 10101.494925253855, 10240.53917573696, 10270.33242839213, 10283.794324113625, 10371.170306375623, 6652.501062420241, 6705.463562914858, 6724.865502690017, 6805.115335006418, 6836.28219036994, 6830.692618832065, 6961.269066748121, 6989.5107342485535, 7049.189343225389, 7084.858302834017], "value": 6617.634276385262, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [498.6961380851856, 504.1832231784509, 519.1252739134561, 526.5050852198933, 528.207688467299, 6281.120643109963, 6288.151099601552, 6310.589811662238, 6328.3988021137975, 6365.135688939972, 6200.937990620092, 6228.408301211389, 6266.342034086424, 6272.090546870701, 6277.4664153547, 5101.642884998052, 5166.630842826654, 5169.353830771153, 5197.246399272103, 5199.974000129994, 4840.830570930018, 4975.850724478253, 5170.638055336128, 5179.792808287664, 5185.714785686786, 4957.4298955620025, 4965.503449655042, 4972.676776009566, 4983.9252411213865, 4984.102861484931, 4934.410997772071, 4946.516045186429, 4957.182064959277, 4969.8509044728535, 4979.950200497985, 4354.804033818486, 4426.557344265548, 4446.3108218226225, 4460.553944605514, 4464.196444639996, 5997.4002599740115, 6037.215162028952, 6038.245219347582, 6047.516198704093, 6068.969655151696, 5500.669959802424, 5606.0, 5612.130119831392, 5627.577931655102, 5628.212050312959, 6418.250494633984, 6423.325550817191, 6437.0, 6456.51576131792, 6471.320511346335, 4609.193391156534, 4776.73416544616, 4828.5412885775795, 4842.297866809293, 4865.391826021747, 6632.701528431232, 6663.800085997428, 6709.3290670933, 6738.52830301879, 6837.076994605714, 4942.975285123552, 4943.134951383566, 4953.950460495421, 4964.230544265644, 4985.302057711923, 4949.406071271471, 4987.226979818061, 5032.7735251913755, 5041.344625198701, 5046.924296135561, 5568.749406276646, 5616.0, 5639.661620302795, 5644.0, 5653.689047102449, 6457.063725759833, 6510.437495001261, 6536.444402225864, 6536.614135840384, 6561.114249576246, 1695.279506209856, 1735.0283841049054, 1737.426649205759, 1738.660961112571, 1754.0, 1148.661144962238, 1180.2446434282067, 1188.4075339045721, 1198.1433275208267, 1211.5577814097967, 5601.9385945189415, 5654.971725141348, 5662.998610736317, 5671.376148623648, 5672.4611161940375, 6538.574992625464, 6633.568818026813, 6634.635095069721, 6637.966810165918, 6662.40038396537, 5614.354349249807, 5635.774569017193, 5658.377578466366, 5677.574181936371, 5697.4302569742695, 3477.6000759912426, 3499.632538583463, 3500.789952602801, 3508.280942338287, 3533.5229743984746, 6467.385598368148, 6478.343879009678, 6483.967580162069, 6508.219013718384, 6512.348765123545, 6704.899426508607, 6726.19285685711, 6786.558873673195, 6786.59280443175, 6872.762902677466, 6299.622022678654, 6378.11845505577, 6440.774572889926, 6506.869862602722, 6530.771423000172, 5983.611065280743, 6604.273529911609, 6616.603003819786, 6638.601683898982, 6653.135092437952, 6350.206224221973, 6399.840003999751, 6419.935800642121, 6484.114569016742, 6485.8702825944165, 6337.207849018872, 6371.776987805404, 6419.133416988833, 6449.3873082057125, 6483.4164925156965, 4848.660593758545, 4889.535494128052, 4898.142825005681, 4923.8276660316715, 4957.200075911264, 6322.3762138713755, 6396.680165991589, 6519.511036672174, 6648.867022659423, 6660.0, 6255.093011513396, 6452.483801295791, 6459.967700161469, 6472.449841763503, 6492.0, 6333.556651034383, 6386.201724784402, 6395.650957348861, 6411.49329907462, 6469.8706025880165, 6266.373362663697, 6281.340459251713, 6350.1109844622715, 6368.904466432915, 6378.0, 6390.297067322684, 6467.676616169078, 6510.674466276762, 6511.902321465087, 6538.038588423549, 6263.404976527223, 6274.215723034621, 6295.041330574622, 6315.242170939517, 6322.905156422749], "value": 4999.826474787358, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [901.8602116671918, 920.3695468604005, 931.958061887215, 940.0505489455647, 953.7663272498237, 19061.71407428888, 20000.899995500004, 20051.29820456284, 20074.899625501872, 20084.196632134735, 16431.507054788344, 16947.406840760577, 16985.49043528696, 19065.714014289795, 19192.904035479838, 934.6635211323935, 967.88869280033, 973.8587904753842, 973.9902600974006, 974.2206235011997, 953.0564740906522, 995.248587316575, 996.6362277768599, 997.2371136080903, 997.3218211616098, 1053.210092430677, 1061.9522121504551, 1062.6227689170348, 1063.261033581661, 1063.7925604507125, 995.1690338567305, 1018.3889666200295, 1033.4832583708146, 1039.2880876599515, 1040.0743338428804, 753.1978442958232, 754.1628792040831, 757.0877093102798, 757.307064036406, 757.7650928212216, 20295.79704202954, 20548.38354849357, 20560.38318850437, 20572.485687857774, 20588.27941022057, 20941.26705565313, 21835.0, 21867.12531498754, 21890.0, 21894.12423503058, 17230.138493075297, 17321.0, 17475.47573572795, 17709.380171694058, 17730.556736081573, 3703.740738148331, 3705.6109108543483, 3733.1413774831667, 3738.0841693784923, 3739.1773809761808, 141525.0, 142781.0, 144427.0, 144902.0, 146413.0, 16324.75512867308, 16641.66716665684, 16778.41275555374, 16831.24259408305, 16861.409850655167, 29749.851250743606, 30381.69618303833, 30501.62742676585, 30533.38933221323, 30546.236344091576, 8623.655053797904, 8780.341474389446, 8890.73327800167, 8904.332175086894, 8919.152680495343, 4116.794160292034, 4164.104717485755, 4197.559256278108, 4255.616994470451, 4266.274733295348, 5488.9725551372785, 5566.860828479321, 5572.080606699849, 5599.44005599445, 5606.803761868315, 932.2262522106636, 974.1378879691524, 979.8138353712772, 984.3700031979539, 986.9457179855033, 669.4376723552142, 684.2746688510196, 693.0678237770192, 701.431840209432, 705.104517263073, 11704.35626040559, 12139.332336721389, 12153.210041347284, 12275.447604857804, 12356.0, 698.5913240754215, 703.3529153179087, 705.5696025424487, 706.6502081469705, 719.3885197582118, 5467.9453205468235, 5519.558435325164, 5528.861778455571, 5537.473939975695, 5611.8597035073635, 121797.98110586005, 124890.37554812168, 125196.0, 126395.0, 128463.35768321286, 109394.0, 109772.0, 110607.44696276468, 110938.44530777456, 112029.43985280185, 92459.0, 94963.0, 95009.0, 98480.99999999857, 99699.50150249347, 10227.170512807628, 10283.331583447052, 10443.530041148319, 10492.527836247235, 10664.89335106639, 44765.32852007288, 45857.0, 46033.079338413714, 46366.84082897955, 46610.533894661974, 57748.0, 57918.0, 58160.70919645375, 58229.4177058224, 59407.0, 15191.0, 15224.391024359345, 15297.0, 15304.617384565476, 15326.386944522093, 16765.497035088967, 16783.832161678227, 16794.0, 16962.575935601708, 17073.14634268257, 14383.352749126105, 14746.0, 14946.028508146936, 15028.17345046033, 15035.248237588296, 15195.468158614396, 15474.458393956158, 15561.76657350118, 15602.765958510405, 15626.921865390601, 14719.55841324762, 14733.189674568002, 14814.77777833355, 14982.325795339018, 15077.39690412415, 10896.400697961688, 11149.72125696864, 11219.55121795119, 11247.88752112501, 11269.605563805228, 10879.891201087888, 10892.455377230948, 10895.182861285593, 11036.282641628268, 11287.0], "value": 8888.61512517191, "unit": "score"}]}, {"extraOptions": ["e10s", "stylo_disabled"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1425.4, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [112.0, 108.0, 109.0, 106.0, 107.0, 109.0, 109.0, 106.0, 106.0, 106.0], "value": 107.8, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 118.0, 121.0, 117.0, 118.0, 117.0, 116.0, 118.0, 117.0, 121.0], "value": 118.1, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 164.0, 165.0, 162.0, 162.0, 162.0, 162.0, 167.0, 167.0, 164.0], "value": 163.8, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [74.0, 73.0, 74.0, 78.0, 75.0, 74.0, 76.0, 74.0, 75.0, 79.0], "value": 75.2, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [79.0, 79.0, 79.0, 78.0, 88.0, 80.0, 79.0, 79.0, 81.0, 80.0], "value": 80.2, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [111.0, 114.0, 115.0, 114.0, 111.0, 114.0, 114.0, 114.0, 115.0, 113.0], "value": 113.5, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [157.0, 148.0, 148.0, 148.0, 148.0, 150.0, 150.0, 149.0, 147.0, 149.0], "value": 149.4, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [94.0, 94.0, 94.0, 94.0, 96.0, 94.0, 95.0, 94.0, 95.0, 95.0], "value": 94.5, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [57.0, 55.0, 51.0, 54.0, 55.0, 53.0, 55.0, 54.0, 60.0, 55.0], "value": 54.9, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [37.0, 37.0, 37.0, 37.0, 38.0, 38.0, 37.0, 38.0, 37.0, 37.0], "value": 37.3, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [79.0, 75.0, 74.0, 74.0, 75.0, 76.0, 77.0, 78.0, 76.0, 74.0], "value": 75.8, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [120.0, 113.0, 114.0, 113.0, 113.0, 115.0, 111.0, 114.0, 115.0, 115.0], "value": 114.3, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [172.0, 172.0, 170.0, 174.0, 175.0, 176.0, 166.0, 179.0, 170.0, 173.0], "value": 172.7, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [80.0, 68.0, 68.0, 67.0, 66.0, 65.0, 66.0, 63.0, 66.0, 70.0], "value": 67.9, "unit": "score"}]}]} 21:24:04 INFO - Return code: 0 21:24:04 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 21:24:04 INFO - # TBPL SUCCESS # 21:24:04 INFO - Running post-action listener: _package_coverage_data 21:24:04 INFO - Running post-action listener: _resource_record_post_action 21:24:04 INFO - [mozharness: 2017-09-17 04:24:04.857941Z] Finished run-tests step (success) 21:24:04 INFO - Running post-run listener: _resource_record_post_run 21:24:04 INFO - Total resource usage - Wall time: 1188s; CPU: 13.0%; Read bytes: 4096; Write bytes: 340152320; Read time: 12; Write time: 248232 21:24:04 INFO - TinderboxPrint: CPU usage
13.1% 21:24:04 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 12 21:24:04 INFO - TinderboxPrint: I/O write bytes / time
340,152,320 / 248,232 21:24:04 INFO - TinderboxPrint: CPU idle
8,229.2 (86.9%) 21:24:04 INFO - TinderboxPrint: CPU user
1,192.5 (12.6%) 21:24:04 INFO - TinderboxPrint: Swap in / out
0 / 0 21:24:04 INFO - install - Wall time: 18s; CPU: 13.0%; Read bytes: 0; Write bytes: 10215424; Read time: 0; Write time: 784 21:24:04 INFO - setup-mitmproxy - Wall time: 0s; CPU: Can't collect data; Read bytes: 0; Write bytes: 0; Read time: 0; Write time: 0 21:24:04 INFO - run-tests - Wall time: 1171s; CPU: 13.0%; Read bytes: 0; Write bytes: 329936896; Read time: 0; Write time: 247448 21:24:05 INFO - Running post-run listener: _upload_blobber_files 21:24:05 INFO - Blob upload gear active. 21:24:05 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 21:24:05 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 21:24:05 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'] 21:24:05 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 21:24:05 INFO - (blobuploader) - INFO - Open directory for files ... 21:24:05 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-stylo-disabled-e10s_raw.log ... 21:24:05 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 21:24:05 INFO - (blobuploader) - INFO - Uploading, attempt #1. 21:24:07 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-stylo-disabled-e10s_raw.log: uploaded 21:24:07 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 21:24:07 INFO - (blobuploader) - INFO - Done attempting. 21:24:07 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 21:24:07 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 21:24:07 INFO - (blobuploader) - INFO - Uploading, attempt #1. 21:24:09 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 21:24:09 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 21:24:09 INFO - (blobuploader) - INFO - Done attempting. 21:24:09 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 21:24:09 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 21:24:09 INFO - (blobuploader) - INFO - Uploading, attempt #1. 21:24:13 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 21:24:13 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 21:24:13 INFO - (blobuploader) - INFO - Done attempting. 21:24:13 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-stylo-disabled-e10s_errorsummary.log ... 21:24:13 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 21:24:13 INFO - (blobuploader) - INFO - Uploading, attempt #1. 21:24:14 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-stylo-disabled-e10s_errorsummary.log: uploaded 21:24:14 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 21:24:14 INFO - (blobuploader) - INFO - Done attempting. 21:24:14 INFO - (blobuploader) - INFO - Iteration through files over. 21:24:14 INFO - Return code: 0 21:24:14 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 21:24:14 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 21:24:14 INFO - Setting buildbot property blobber_files to {"perfherder-data.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/07a2b1707f0bd86495813b368697415e9eab0186990124b0d567fcb9e2c52c90189b062aeaedef344edba8360be740f0b2cc23d1b202ea2227522ee58dfd91af", "dromaeojs-stylo-disabled-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/104f375bcf201c25ad25b1bbb65f0cd1cb763dc088f7b95b3967a21f5babeb52e8dbf3e62e09e4fb79c046c69a6b3e5670b7935f0d5545b8ff26e167873b3912", "dromaeojs-stylo-disabled-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/95dee3564a923a867fce8352841240a7645af101c8c10eace65b79fdc83a98e23ee2e0cd8f3a4851baedf08aea126104386b65000fd944e496dca0b0df8d4a2f", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/d8520644a671f20552010986183f9c254ffd984cf933467abee08fec9f3e69cce902f97ca5c39f26d587bb39c54e2c39c9120287838d49d56f0c6444bb90ad4a"} 21:24:14 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 21:24:14 INFO - Writing to file /builds/slave/test/properties/blobber_files 21:24:14 INFO - Contents: 21:24:14 INFO - blobber_files:{"perfherder-data.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/07a2b1707f0bd86495813b368697415e9eab0186990124b0d567fcb9e2c52c90189b062aeaedef344edba8360be740f0b2cc23d1b202ea2227522ee58dfd91af", "dromaeojs-stylo-disabled-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/104f375bcf201c25ad25b1bbb65f0cd1cb763dc088f7b95b3967a21f5babeb52e8dbf3e62e09e4fb79c046c69a6b3e5670b7935f0d5545b8ff26e167873b3912", "dromaeojs-stylo-disabled-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/95dee3564a923a867fce8352841240a7645af101c8c10eace65b79fdc83a98e23ee2e0cd8f3a4851baedf08aea126104386b65000fd944e496dca0b0df8d4a2f", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/d8520644a671f20552010986183f9c254ffd984cf933467abee08fec9f3e69cce902f97ca5c39f26d587bb39c54e2c39c9120287838d49d56f0c6444bb90ad4a"} 21:24:14 INFO - Running post-run listener: copy_logs_to_upload_dir 21:24:14 INFO - Copying logs to upload dir... 21:24:14 INFO - mkdir: /builds/slave/test/build/upload/logs 21:24:14 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1241.941190 ========= master_lag: 0.03 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 41 secs) (at 2017-09-16 21:24:14.097588) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-09-16 21:24:14.100929) ========= 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=d2a8c569965ab8367867b893000001a1-1505601877.89358-444046738 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/07a2b1707f0bd86495813b368697415e9eab0186990124b0d567fcb9e2c52c90189b062aeaedef344edba8360be740f0b2cc23d1b202ea2227522ee58dfd91af", "dromaeojs-stylo-disabled-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/104f375bcf201c25ad25b1bbb65f0cd1cb763dc088f7b95b3967a21f5babeb52e8dbf3e62e09e4fb79c046c69a6b3e5670b7935f0d5545b8ff26e167873b3912", "dromaeojs-stylo-disabled-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/95dee3564a923a867fce8352841240a7645af101c8c10eace65b79fdc83a98e23ee2e0cd8f3a4851baedf08aea126104386b65000fd944e496dca0b0df8d4a2f", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/d8520644a671f20552010986183f9c254ffd984cf933467abee08fec9f3e69cce902f97ca5c39f26d587bb39c54e2c39c9120287838d49d56f0c6444bb90ad4a"} build_url:https://queue.taskcluster.net/v1/task/HL4DSwsdQYWbDYpmGciB1w/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011530 build_url: 'https://queue.taskcluster.net/v1/task/HL4DSwsdQYWbDYpmGciB1w/artifacts/public/build/target.tar.bz2' blobber_files: '{"perfherder-data.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/07a2b1707f0bd86495813b368697415e9eab0186990124b0d567fcb9e2c52c90189b062aeaedef344edba8360be740f0b2cc23d1b202ea2227522ee58dfd91af", "dromaeojs-stylo-disabled-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/104f375bcf201c25ad25b1bbb65f0cd1cb763dc088f7b95b3967a21f5babeb52e8dbf3e62e09e4fb79c046c69a6b3e5670b7935f0d5545b8ff26e167873b3912", "dromaeojs-stylo-disabled-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/95dee3564a923a867fce8352841240a7645af101c8c10eace65b79fdc83a98e23ee2e0cd8f3a4851baedf08aea126104386b65000fd944e496dca0b0df8d4a2f", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/d8520644a671f20552010986183f9c254ffd984cf933467abee08fec9f3e69cce902f97ca5c39f26d587bb39c54e2c39c9120287838d49d56f0c6444bb90ad4a"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-09-16 21:24:14.129641) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-09-16 21:24:14.129983) ========= 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=d2a8c569965ab8367867b893000001a1-1505601877.89358-444046738 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004576 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-09-16 21:24:14.214516) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-09-16 21:24:14.214859) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-09-16 21:24:14.215246) ========= ========= Total master_lag: 0.23 =========