builder: mozilla-central_ubuntu64_hw_test-dromaeojs-stylo-disabled-e10s slave: talos-linux64-ix-077 starttime: 1505945124.88 results: success (0) revision: 319a34bea9e4f3459886b5b9e835bd338320f1fd ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-09-20 15:05:24.879922) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-09-20 15:05:24.880418) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-09-20 15:05:24.881043) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-09-20 15:05:24.954359) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-09-20 15:05:24.954685) ========= 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=20e20d796406ba5117c4a6f1000001ba-1505942851.61555-1848254621 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-09-20 15:05:25-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 80.7M=0s 2017-09-20 15:05:25 (80.7 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.130666 ========= master_lag: 0.05 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-09-20 15:05:25.132498) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-09-20 15:05:25.132810) ========= 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=20e20d796406ba5117c4a6f1000001ba-1505942851.61555-1848254621 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.017620 ========= master_lag: 0.09 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-09-20 15:05:25.239546) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 2 secs) (at 2017-09-20 15:05:25.239901) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 319a34bea9e4f3459886b5b9e835bd338320f1fd --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 319a34bea9e4f3459886b5b9e835bd338320f1fd --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=20e20d796406ba5117c4a6f1000001ba-1505942851.61555-1848254621 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-09-20 15:05:25,552 truncating revision to first 12 chars 2017-09-20 15:05:25,552 Setting DEBUG logging. 2017-09-20 15:05:25,552 attempt 1/10 2017-09-20 15:05:25,552 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/319a34bea9e4?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-09-20 15:05:27,701 unpacking tar archive at: mozilla-central-319a34bea9e4/testing/mozharness/ program finished with exit code 0 elapsedTime=2.440836 ========= master_lag: 0.03 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 2 secs) (at 2017-09-20 15:05:27.713916) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-09-20 15:05:27.714241) ========= script_repo_revision: 319a34bea9e4f3459886b5b9e835bd338320f1fd ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-09-20 15:05:27.714639) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-09-20 15:05:27.714911) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-09-20 15:05:27.728292) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 36 secs) (at 2017-09-20 15:05:27.728684) ========= /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=20e20d796406ba5117c4a6f1000001ba-1505942851.61555-1848254621 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 15:05:28 INFO - MultiFileLogger online at 20170920 15:05:28 in /builds/slave/test 15:05:28 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 15:05:28 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 15:05:28 INFO - {'append_to_log': False, 15:05:28 INFO - 'base_work_dir': '/builds/slave/test', 15:05:28 INFO - 'blob_upload_branch': 'Firefox-Non-PGO', 15:05:28 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 15:05:28 INFO - 'branch': 'Firefox-Non-PGO', 15:05:28 INFO - 'buildbot_json_path': 'buildprops.json', 15:05:28 INFO - 'code_coverage': False, 15:05:28 INFO - 'config_files': ('talos/linux_config.py',), 15:05:28 INFO - 'default_actions': ('clobber', 15:05:28 INFO - 'read-buildbot-config', 15:05:28 INFO - 'download-and-extract', 15:05:28 INFO - 'populate-webroot', 15:05:28 INFO - 'create-virtualenv', 15:05:28 INFO - 'install', 15:05:28 INFO - 'setup-mitmproxy', 15:05:28 INFO - 'run-tests'), 15:05:28 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 15:05:28 INFO - 'disable_ccov_upload': False, 15:05:28 INFO - 'disable_stylo': False, 15:05:28 INFO - 'download_minidump_stackwalk': True, 15:05:28 INFO - 'download_symbols': 'ondemand', 15:05:28 INFO - 'enable_stylo': False, 15:05:28 INFO - 'enable_webrender': False, 15:05:28 INFO - 'exes': {'tooltool.py': '/tools/tooltool.py'}, 15:05:28 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 15:05:28 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 15:05:28 INFO - 'gecko_profile': False, 15:05:28 INFO - 'gecko_profile_interval': 0, 15:05:28 INFO - 'installer_path': 'installer.exe', 15:05:28 INFO - 'log_level': 'info', 15:05:28 INFO - 'log_name': 'talos', 15:05:28 INFO - 'log_to_console': True, 15:05:28 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 15:05:28 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 15:05:28 INFO - 'opt_config_files': (), 15:05:28 INFO - 'pip_index': False, 15:05:28 INFO - 'suite': 'dromaeojs-stylo-disabled-e10s', 15:05:28 INFO - 'system_bits': '32', 15:05:28 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 15:05:28 INFO - 'title': 'talos-linux64-ix-077', 15:05:28 INFO - 'tooltool_cache': '/builds/tooltool_cache', 15:05:28 INFO - 'use_talos_json': True, 15:05:28 INFO - 'verify': 'False', 15:05:28 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 15:05:28 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 15:05:28 INFO - 'work_dir': 'build'} 15:05:28 INFO - [mozharness: 2017-09-20 22:05:28.173062Z] Running clobber step. 15:05:28 INFO - Running pre-action listener: _resource_record_pre_action 15:05:28 INFO - Running main action method: clobber 15:05:28 INFO - rmtree: /builds/slave/test/build 15:05:28 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 15:05:29 INFO - Running post-action listener: _resource_record_post_action 15:05:29 INFO - [mozharness: 2017-09-20 22:05:29.688533Z] Finished clobber step (success) 15:05:29 INFO - [mozharness: 2017-09-20 22:05:29.688631Z] Running read-buildbot-config step. 15:05:29 INFO - Running pre-action listener: _resource_record_pre_action 15:05:29 INFO - Running main action method: read_buildbot_config 15:05:29 INFO - Using buildbot properties: 15:05:29 INFO - { 15:05:29 INFO - "project": "", 15:05:29 INFO - "product": "firefox", 15:05:29 INFO - "who": "kwierso@gmail.com", 15:05:29 INFO - "installer_path": "public/build/target.tar.bz2", 15:05:29 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs-stylo-disabled-e10s", 15:05:29 INFO - "repository": "https://hg.mozilla.org/mozilla-central", 15:05:29 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central talos dromaeojs-stylo-disabled-e10s", 15:05:29 INFO - "stage_platform": "linux64", 15:05:29 INFO - "basedir": "/builds/slave/test", 15:05:29 INFO - "buildnumber": 49, 15:05:29 INFO - "platform": "ubuntu64_hw", 15:05:29 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 15:05:29 INFO - "slavebuilddir": "test", 15:05:29 INFO - "taskId": "WaqiK4uhR_agndxCwcZZfQ", 15:05:29 INFO - "branch": "mozilla-central", 15:05:29 INFO - "script_repo_revision": "production", 15:05:29 INFO - "revision": "319a34bea9e4f3459886b5b9e835bd338320f1fd", 15:05:29 INFO - "slavename": "talos-linux64-ix-077", 15:05:29 INFO - "repo_path": "mozilla-central" 15:05:29 INFO - } 15:05:29 INFO - Finding installer, test and symbols from parent task. 15:05:29 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/WaqiK4uhR_agndxCwcZZfQ'}, attempt #1 15:05:30 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/WaqiK4uhR_agndxCwcZZfQ'}, attempt #1 15:05:30 INFO - Task dependencies: So2N-P5gRV2VMrCgAQvl_g 15:05:30 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/So2N-P5gRV2VMrCgAQvl_g'}, attempt #1 15:05:31 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/So2N-P5gRV2VMrCgAQvl_g/artifacts/public/build/target.tar.bz2 15:05:31 INFO - Set test_packages_url: https://queue.taskcluster.net/v1/task/So2N-P5gRV2VMrCgAQvl_g/artifacts/public/build/target.test_packages.json 15:05:31 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/So2N-P5gRV2VMrCgAQvl_g/artifacts/public/build/target.crashreporter-symbols.zip 15:05:31 INFO - Running post-action listener: _resource_record_post_action 15:05:31 INFO - [mozharness: 2017-09-20 22:05:31.057189Z] Finished read-buildbot-config step (success) 15:05:31 INFO - [mozharness: 2017-09-20 22:05:31.057410Z] Running download-and-extract step. 15:05:31 INFO - Running pre-action listener: _resource_record_pre_action 15:05:31 INFO - Running main action method: download_and_extract 15:05:31 INFO - mkdir: /builds/slave/test/build/tests 15:05:31 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')]} 15:05:31 INFO - trying https://queue.taskcluster.net/v1/task/So2N-P5gRV2VMrCgAQvl_g/artifacts/public/build/target.test_packages.json 15:05:31 INFO - Downloading https://queue.taskcluster.net/v1/task/So2N-P5gRV2VMrCgAQvl_g/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 15:05:31 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/So2N-P5gRV2VMrCgAQvl_g/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 15:05:31 INFO - Downloaded 989 bytes. 15:05:31 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 15:05:31 INFO - Using the following test package requirements: 15:05:31 INFO - {u'awsy': [u'target.common.tests.zip', u'target.awsy.tests.zip'], 15:05:31 INFO - u'common': [u'target.common.tests.zip'], 15:05:31 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 15:05:31 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 15:05:31 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 15:05:31 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 15:05:31 INFO - u'mozbase': [u'target.common.tests.zip'], 15:05:31 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 15:05:31 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 15:05:31 INFO - u'web-platform': [u'target.common.tests.zip', 15:05:31 INFO - u'target.web-platform.tests.tar.gz'], 15:05:31 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 15:05:31 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite categories: ['common', 'talos'] 15:05:31 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/So2N-P5gRV2VMrCgAQvl_g/artifacts/public/build/target.common.tests.zip 15:05:31 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/So2N-P5gRV2VMrCgAQvl_g/artifacts/public/build/target.common.tests.zip'}, attempt #1 15:05:31 INFO - Fetch https://queue.taskcluster.net/v1/task/So2N-P5gRV2VMrCgAQvl_g/artifacts/public/build/target.common.tests.zip into memory 15:05:33 INFO - Content-Length response header: 54732410 15:05:33 INFO - Bytes received: 54732410 15:05:43 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/So2N-P5gRV2VMrCgAQvl_g/artifacts/public/build/target.talos.tests.zip 15:05:43 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/So2N-P5gRV2VMrCgAQvl_g/artifacts/public/build/target.talos.tests.zip'}, attempt #1 15:05:43 INFO - Fetch https://queue.taskcluster.net/v1/task/So2N-P5gRV2VMrCgAQvl_g/artifacts/public/build/target.talos.tests.zip into memory 15:05:44 INFO - Content-Length response header: 14512509 15:05:44 INFO - Bytes received: 14512509 15:05:44 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')]} 15:05:44 INFO - trying https://queue.taskcluster.net/v1/task/So2N-P5gRV2VMrCgAQvl_g/artifacts/public/build/target.tar.bz2 15:05:44 INFO - Downloading https://queue.taskcluster.net/v1/task/So2N-P5gRV2VMrCgAQvl_g/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 15:05:44 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/So2N-P5gRV2VMrCgAQvl_g/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 15:05:46 INFO - Downloaded 61645932 bytes. 15:05:46 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/So2N-P5gRV2VMrCgAQvl_g/artifacts/public/build/target.tar.bz2 15:05:46 INFO - mkdir: /builds/slave/test/properties 15:05:46 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 15:05:46 INFO - Writing to file /builds/slave/test/properties/build_url 15:05:46 INFO - Contents: 15:05:46 INFO - build_url:https://queue.taskcluster.net/v1/task/So2N-P5gRV2VMrCgAQvl_g/artifacts/public/build/target.tar.bz2 15:05:46 INFO - Running post-action listener: _resource_record_post_action 15:05:46 INFO - Running post-action listener: find_tests_for_verification 15:05:46 INFO - Running post-action listener: set_extra_try_arguments 15:05:46 INFO - [mozharness: 2017-09-20 22:05:46.158390Z] Finished download-and-extract step (success) 15:05:46 INFO - [mozharness: 2017-09-20 22:05:46.158488Z] Running populate-webroot step. 15:05:46 INFO - Running pre-action listener: _resource_record_pre_action 15:05:46 INFO - Running main action method: populate_webroot 15:05:46 INFO - {'suites': {'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 15:05:46 INFO - 'chromez-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 15:05:46 INFO - 'tests': ['tresize', 15:05:46 INFO - 'tcanvasmark']}, 15:05:46 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 15:05:46 INFO - 'dromaeojs-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 15:05:46 INFO - 'tests': ['dromaeo_css', 15:05:46 INFO - 'kraken']}, 15:05:46 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 15:05:46 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 15:05:46 INFO - 'g1-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 15:05:46 INFO - 'talos_options': ['--disable-stylo'], 15:05:46 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 15:05:46 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 15:05:46 INFO - 'tests': ['damp', 'tps']}, 15:05:46 INFO - 'g2-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 15:05:46 INFO - 'talos_options': ['--disable-stylo'], 15:05:46 INFO - 'tests': ['damp', 'tps']}, 15:05:46 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 15:05:46 INFO - 'g3-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 15:05:46 INFO - 'tests': ['dromaeo_dom']}, 15:05:46 INFO - 'g4-e10s': {'tests': ['basic_compositor_video', 'glvideo']}, 15:05:46 INFO - 'g4-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 15:05:46 INFO - 'tests': ['basic_compositor_video', 15:05:46 INFO - 'glvideo']}, 15:05:46 INFO - 'g5-e10s': {'pagesets_name': 'tp5n.zip', 15:05:46 INFO - 'tests': ['ts_paint_webext', 'tp5o_webext']}, 15:05:46 INFO - 'g5-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 15:05:46 INFO - 'talos_options': ['--disable-stylo'], 15:05:46 INFO - 'tests': ['ts_paint_webext', 15:05:46 INFO - 'tp5o_webext']}, 15:05:46 INFO - 'other-e10s': {'tests': ['a11yr', 15:05:46 INFO - 'ts_paint', 15:05:46 INFO - 'tpaint', 15:05:46 INFO - 'sessionrestore', 15:05:46 INFO - 'sessionrestore_many_windows', 15:05:46 INFO - 'sessionrestore_no_auto_restore', 15:05:46 INFO - 'tabpaint']}, 15:05:46 INFO - 'other-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 15:05:46 INFO - 'tests': ['a11yr', 15:05:46 INFO - 'ts_paint', 15:05:46 INFO - 'tpaint', 15:05:46 INFO - 'sessionrestore', 15:05:46 INFO - 'sessionrestore_many_windows', 15:05:46 INFO - 'sessionrestore_no_auto_restore', 15:05:46 INFO - 'tabpaint']}, 15:05:46 INFO - 'perf-reftest-e10s': {'tests': ['perf_reftest']}, 15:05:46 INFO - 'perf-reftest-singletons-e10s': {'tests': ['perf_reftest_singletons']}, 15:05:46 INFO - 'perf-reftest-singletons-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 15:05:46 INFO - 'tests': ['perf_reftest_singletons']}, 15:05:46 INFO - 'perf-reftest-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 15:05:46 INFO - 'tests': ['bloom_basic']}, 15:05:46 INFO - 'svgr-e10s': {'tests': ['tsvgx', 15:05:46 INFO - 'tsvgr_opacity', 15:05:46 INFO - 'tart', 15:05:46 INFO - 'tscrollx', 15:05:46 INFO - 'tsvg_static']}, 15:05:46 INFO - 'svgr-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 15:05:46 INFO - 'tests': ['tsvgx', 15:05:46 INFO - 'tsvgr_opacity', 15:05:46 INFO - 'tart', 15:05:46 INFO - 'tscrollx', 15:05:46 INFO - 'tsvg_static']}, 15:05:46 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 15:05:46 INFO - 'tp5o-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 15:05:46 INFO - 'talos_options': ['--disable-stylo'], 15:05:46 INFO - 'tests': ['tp5o']}, 15:05:46 INFO - 'tp6-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 15:05:46 INFO - 'talos_options': ['--mitmproxy', 15:05:46 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 15:05:46 INFO - '--firstNonBlankPaint'], 15:05:46 INFO - 'tests': ['tp6_google', 15:05:46 INFO - 'tp6_youtube', 15:05:46 INFO - 'tp6_amazon', 15:05:46 INFO - 'tp6_facebook']}, 15:05:46 INFO - 'tp6-stylo-disabled-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 15:05:46 INFO - 'talos_options': ['--disable-stylo', 15:05:46 INFO - '--mitmproxy', 15:05:46 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 15:05:46 INFO - '--firstNonBlankPaint'], 15:05:46 INFO - 'tests': ['tp6_google', 15:05:46 INFO - 'tp6_youtube', 15:05:46 INFO - 'tp6_amazon', 15:05:46 INFO - 'tp6_facebook']}, 15:05:46 INFO - 'tp6-stylo-threads-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 15:05:46 INFO - 'talos_options': ['--stylo-threads=1', 15:05:46 INFO - '--mitmproxy', 15:05:46 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 15:05:46 INFO - '--firstNonBlankPaint'], 15:05:46 INFO - 'tests': ['tp6_google', 15:05:46 INFO - 'tp6_youtube', 15:05:46 INFO - 'tp6_amazon', 15:05:46 INFO - 'tp6_facebook']}, 15:05:46 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 15:05:46 INFO - 'talos_options': ['--xperf_path', 15:05:46 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 15:05:46 INFO - 'tests': ['tp5n']}, 15:05:46 INFO - 'xperf-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 15:05:46 INFO - 'talos_options': ['--disable-stylo', 15:05:46 INFO - '--xperf_path', 15:05:46 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 15:05:46 INFO - 'tests': ['tp5n']}}} 15:05:46 INFO - Running post-action listener: _resource_record_post_action 15:05:46 INFO - [mozharness: 2017-09-20 22:05:46.173367Z] Finished populate-webroot step (success) 15:05:46 INFO - [mozharness: 2017-09-20 22:05:46.173457Z] Running create-virtualenv step. 15:05:46 INFO - Running pre-action listener: _resource_record_pre_action 15:05:46 INFO - Running main action method: create_virtualenv 15:05:46 INFO - Creating virtualenv /builds/slave/test/build/venv 15:05:46 INFO - Running command: ['virtualenv', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 15:05:46 INFO - Copy/paste: virtualenv --no-site-packages --distribute /builds/slave/test/build/venv 15:05:46 INFO - Using partial env: {'VIRTUALENV_NO_DOWNLOAD': '1'} 15:05:46 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 15:05:46 INFO - New python executable in /builds/slave/test/build/venv/bin/python 15:05:46 INFO - Installing distribute.............................................................................................................................................................................................done. 15:05:47 INFO - Installing pip...............done. 15:05:47 INFO - Return code: 0 15:05:47 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 15:05:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 15:05:47 INFO - Reading from file tmpfile_stdout 15:05:47 INFO - Output received: 15:05:47 INFO - pip 1.1 from /builds/slave/test/build/venv/lib/python2.7/site-packages/pip-1.1-py2.7.egg (python 2.7) 15:05:47 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 15:05:47 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')]} 15:05:47 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:05:47 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')]} 15:05:47 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:05:47 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 0x1a941f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c5da80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e00a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e04090>, '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 0x1e04d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1dfef90>, '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': '20e20d796406ba5117c4a6f1000001ba-1505942851.61555-1848254621', '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 15:05:47 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 15:05:47 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 15:05:47 INFO - Using env: {'DISPLAY': ':0', 15:05:47 INFO - 'HOME': '/home/cltbld', 15:05:47 INFO - 'LANG': 'en_US.UTF-8', 15:05:47 INFO - 'LANGUAGE': 'en_US:en', 15:05:47 INFO - 'LOGNAME': 'cltbld', 15:05:47 INFO - 'MAIL': '/var/mail/cltbld', 15:05:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:05:47 INFO - 'MOZ_NO_REMOTE': '1', 15:05:47 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:05:47 INFO - 'NO_EM_RESTART': '1', 15:05:47 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:05:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:05:47 INFO - 'PWD': '/builds/slave/test', 15:05:47 INFO - 'SHELL': '/bin/bash', 15:05:47 INFO - 'SHLVL': '1', 15:05:47 INFO - 'TERM': 'linux', 15:05:47 INFO - 'TMOUT': '86400', 15:05:47 INFO - 'USER': 'cltbld', 15:05:47 INFO - 'XDG_SESSION_COOKIE': '20e20d796406ba5117c4a6f1000001ba-1505942851.61555-1848254621', 15:05:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:05:47 INFO - '_': '/tools/buildbot/bin/python'} 15:05:48 INFO - Ignoring indexes: http://pypi.python.org/simple/ 15:05:48 INFO - Downloading/unpacking pip>=1.5 15:05:48 INFO - Running setup.py egg_info for package pip 15:05:48 INFO - warning: no files found matching 'pip/cacert.pem' 15:05:48 INFO - warning: no files found matching '*.html' under directory 'docs' 15:05:48 INFO - warning: no previously-included files matching '*.rst' found under directory 'docs/_build' 15:05:48 INFO - no previously-included directories found matching 'docs/_build/_sources' 15:05:48 INFO - Installing collected packages: pip 15:05:48 INFO - Found existing installation: pip 1.1 15:05:48 INFO - Uninstalling pip: 15:05:48 INFO - Successfully uninstalled pip 15:05:48 INFO - Running setup.py install for pip 15:05:48 INFO - warning: no files found matching 'pip/cacert.pem' 15:05:48 INFO - warning: no files found matching '*.html' under directory 'docs' 15:05:48 INFO - warning: no previously-included files matching '*.rst' found under directory 'docs/_build' 15:05:48 INFO - no previously-included directories found matching 'docs/_build/_sources' 15:05:48 INFO - Installing pip script to /builds/slave/test/build/venv/bin 15:05:48 INFO - Installing pip2.7 script to /builds/slave/test/build/venv/bin 15:05:48 INFO - Installing pip2 script to /builds/slave/test/build/venv/bin 15:05:48 INFO - Successfully installed pip 15:05:48 INFO - Cleaning up... 15:05:48 INFO - Return code: 0 15:05:48 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 15:05:48 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')]} 15:05:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:05:48 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')]} 15:05:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:05:48 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/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 0x1a941f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c5da80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e00a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e04090>, '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 0x1e04d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1dfef90>, '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': '20e20d796406ba5117c4a6f1000001ba-1505942851.61555-1848254621', '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 15:05:48 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 15:05:48 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 15:05:48 INFO - Using env: {'DISPLAY': ':0', 15:05:48 INFO - 'HOME': '/home/cltbld', 15:05:48 INFO - 'LANG': 'en_US.UTF-8', 15:05:48 INFO - 'LANGUAGE': 'en_US:en', 15:05:48 INFO - 'LOGNAME': 'cltbld', 15:05:48 INFO - 'MAIL': '/var/mail/cltbld', 15:05:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:05:48 INFO - 'MOZ_NO_REMOTE': '1', 15:05:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:05:48 INFO - 'NO_EM_RESTART': '1', 15:05:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:05:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:05:48 INFO - 'PWD': '/builds/slave/test', 15:05:48 INFO - 'SHELL': '/bin/bash', 15:05:48 INFO - 'SHLVL': '1', 15:05:48 INFO - 'TERM': 'linux', 15:05:48 INFO - 'TMOUT': '86400', 15:05:48 INFO - 'USER': 'cltbld', 15:05:48 INFO - 'XDG_SESSION_COOKIE': '20e20d796406ba5117c4a6f1000001ba-1505942851.61555-1848254621', 15:05:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:05:48 INFO - '_': '/tools/buildbot/bin/python'} 15:05:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:05:48 INFO - Downloading/unpacking psutil>=3.1.1 15:05:48 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:05:48 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:05:48 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:05:48 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:05:49 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 15:05:49 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 15:05:49 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 15:05:49 INFO - Installing collected packages: psutil 15:05:49 INFO - Running setup.py install for psutil 15:05:49 INFO - building 'psutil._psutil_linux' extension 15:05:49 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 15:05:50 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 15:05:50 INFO - building 'psutil._psutil_posix' extension 15:05:50 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 15:05:50 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 15:05:50 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 15:05:50 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 15:05:50 INFO - Successfully installed psutil 15:05:50 INFO - Cleaning up... 15:05:50 INFO - Return code: 0 15:05:50 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 15:05: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')]} 15:05:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:05: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')]} 15:05:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:05:50 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 0x1a941f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c5da80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e00a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e04090>, '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 0x1e04d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1dfef90>, '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': '20e20d796406ba5117c4a6f1000001ba-1505942851.61555-1848254621', '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 15:05:50 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 15:05:50 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 15:05:50 INFO - Using env: {'DISPLAY': ':0', 15:05:50 INFO - 'HOME': '/home/cltbld', 15:05:50 INFO - 'LANG': 'en_US.UTF-8', 15:05:50 INFO - 'LANGUAGE': 'en_US:en', 15:05:50 INFO - 'LOGNAME': 'cltbld', 15:05:50 INFO - 'MAIL': '/var/mail/cltbld', 15:05:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:05:50 INFO - 'MOZ_NO_REMOTE': '1', 15:05:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:05:50 INFO - 'NO_EM_RESTART': '1', 15:05:50 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:05:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:05:50 INFO - 'PWD': '/builds/slave/test', 15:05:50 INFO - 'SHELL': '/bin/bash', 15:05:50 INFO - 'SHLVL': '1', 15:05:50 INFO - 'TERM': 'linux', 15:05:50 INFO - 'TMOUT': '86400', 15:05:50 INFO - 'USER': 'cltbld', 15:05:50 INFO - 'XDG_SESSION_COOKIE': '20e20d796406ba5117c4a6f1000001ba-1505942851.61555-1848254621', 15:05:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:05:50 INFO - '_': '/tools/buildbot/bin/python'} 15:05:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:05:50 INFO - Downloading/unpacking mozsystemmonitor==0.3 15:05:50 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 15:05:50 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 15:05:50 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 15:05:50 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 15:05:51 INFO - Downloading mozsystemmonitor-0.3.tar.gz 15:05:51 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 15:05:51 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 15:05:51 INFO - Installing collected packages: mozsystemmonitor 15:05:51 INFO - Running setup.py install for mozsystemmonitor 15:05:51 INFO - Successfully installed mozsystemmonitor 15:05:51 INFO - Cleaning up... 15:05:52 INFO - Return code: 0 15:05:52 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 15:05:52 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')]} 15:05:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:05:52 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')]} 15:05:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:05:52 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 0x1a941f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c5da80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e00a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e04090>, '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 0x1e04d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1dfef90>, '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': '20e20d796406ba5117c4a6f1000001ba-1505942851.61555-1848254621', '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 15:05:52 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 15:05:52 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 15:05:52 INFO - Using env: {'DISPLAY': ':0', 15:05:52 INFO - 'HOME': '/home/cltbld', 15:05:52 INFO - 'LANG': 'en_US.UTF-8', 15:05:52 INFO - 'LANGUAGE': 'en_US:en', 15:05:52 INFO - 'LOGNAME': 'cltbld', 15:05:52 INFO - 'MAIL': '/var/mail/cltbld', 15:05:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:05:52 INFO - 'MOZ_NO_REMOTE': '1', 15:05:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:05:52 INFO - 'NO_EM_RESTART': '1', 15:05:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:05:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:05:52 INFO - 'PWD': '/builds/slave/test', 15:05:52 INFO - 'SHELL': '/bin/bash', 15:05:52 INFO - 'SHLVL': '1', 15:05:52 INFO - 'TERM': 'linux', 15:05:52 INFO - 'TMOUT': '86400', 15:05:52 INFO - 'USER': 'cltbld', 15:05:52 INFO - 'XDG_SESSION_COOKIE': '20e20d796406ba5117c4a6f1000001ba-1505942851.61555-1848254621', 15:05:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:05:52 INFO - '_': '/tools/buildbot/bin/python'} 15:05:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:05:52 INFO - Downloading/unpacking jsonschema==2.5.1 15:05:52 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 15:05:52 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 15:05:52 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 15:05:52 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 15:05:53 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 15:05:53 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 15:05:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:05:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:05:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:05:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:05:53 INFO - Downloading functools32-3.2.3-2.tar.gz 15:05:53 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 15:05:53 INFO - warning: no files found matching '*.txt' 15:05:53 INFO - no previously-included directories found matching 'build' 15:05:53 INFO - no previously-included directories found matching 'dist' 15:05:53 INFO - no previously-included directories found matching '.git*' 15:05:53 INFO - Installing collected packages: jsonschema, functools32 15:05:53 INFO - Running setup.py install for functools32 15:05:53 INFO - warning: no files found matching '*.txt' 15:05:53 INFO - no previously-included directories found matching 'build' 15:05:53 INFO - no previously-included directories found matching 'dist' 15:05:53 INFO - no previously-included directories found matching '.git*' 15:05:53 INFO - Successfully installed jsonschema functools32 15:05:53 INFO - Cleaning up... 15:05:53 INFO - Return code: 0 15:05:53 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 15:05:53 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')]} 15:05:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:05:53 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')]} 15:05:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:05:53 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/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 0x1a941f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c5da80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e00a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e04090>, '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 0x1e04d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1dfef90>, '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': '20e20d796406ba5117c4a6f1000001ba-1505942851.61555-1848254621', '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 15:05:53 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 15:05:53 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 15:05:53 INFO - Using env: {'DISPLAY': ':0', 15:05:53 INFO - 'HOME': '/home/cltbld', 15:05:53 INFO - 'LANG': 'en_US.UTF-8', 15:05:53 INFO - 'LANGUAGE': 'en_US:en', 15:05:53 INFO - 'LOGNAME': 'cltbld', 15:05:53 INFO - 'MAIL': '/var/mail/cltbld', 15:05:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:05:53 INFO - 'MOZ_NO_REMOTE': '1', 15:05:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:05:53 INFO - 'NO_EM_RESTART': '1', 15:05:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:05:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:05:53 INFO - 'PWD': '/builds/slave/test', 15:05:53 INFO - 'SHELL': '/bin/bash', 15:05:53 INFO - 'SHLVL': '1', 15:05:53 INFO - 'TERM': 'linux', 15:05:53 INFO - 'TMOUT': '86400', 15:05:53 INFO - 'USER': 'cltbld', 15:05:53 INFO - 'XDG_SESSION_COOKIE': '20e20d796406ba5117c4a6f1000001ba-1505942851.61555-1848254621', 15:05:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:05:53 INFO - '_': '/tools/buildbot/bin/python'} 15:05:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:05:54 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 15:05:54 INFO - Cleaning up... 15:05:54 INFO - Return code: 0 15:05:54 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 15:05:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:05:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:05:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:05:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:05:54 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 0x1a941f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c5da80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e00a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e04090>, '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 0x1e04d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1dfef90>, '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': '20e20d796406ba5117c4a6f1000001ba-1505942851.61555-1848254621', '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 15:05:54 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 15:05:54 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 15:05:54 INFO - Using env: {'DISPLAY': ':0', 15:05:54 INFO - 'HOME': '/home/cltbld', 15:05:54 INFO - 'LANG': 'en_US.UTF-8', 15:05:54 INFO - 'LANGUAGE': 'en_US:en', 15:05:54 INFO - 'LOGNAME': 'cltbld', 15:05:54 INFO - 'MAIL': '/var/mail/cltbld', 15:05:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:05:54 INFO - 'MOZ_NO_REMOTE': '1', 15:05:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:05:54 INFO - 'NO_EM_RESTART': '1', 15:05:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:05:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:05:54 INFO - 'PWD': '/builds/slave/test', 15:05:54 INFO - 'SHELL': '/bin/bash', 15:05:54 INFO - 'SHLVL': '1', 15:05:54 INFO - 'TERM': 'linux', 15:05:54 INFO - 'TMOUT': '86400', 15:05:54 INFO - 'USER': 'cltbld', 15:05:54 INFO - 'XDG_SESSION_COOKIE': '20e20d796406ba5117c4a6f1000001ba-1505942851.61555-1848254621', 15:05:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:05:54 INFO - '_': '/tools/buildbot/bin/python'} 15:05:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:05:54 INFO - Downloading/unpacking blobuploader==1.2.4 15:05:54 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 15:05:54 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 15:05:54 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 15:05:54 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 15:05:55 INFO - Downloading blobuploader-1.2.4.tar.gz 15:05:55 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 15:05:55 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 15:05:55 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 15:05:55 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 15:05:55 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 15:05:55 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 15:05:55 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 15:05:55 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 15:05:55 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 15:05:55 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 15:05:55 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 15:05:55 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 15:05:56 INFO - Downloading docopt-0.6.1.tar.gz 15:05:56 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 15:05:56 INFO - Installing collected packages: blobuploader, requests, docopt 15:05:56 INFO - Running setup.py install for blobuploader 15:05:56 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 15:05:56 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 15:05:56 INFO - Running setup.py install for requests 15:05:56 INFO - Running setup.py install for docopt 15:05:56 INFO - Successfully installed blobuploader requests docopt 15:05:56 INFO - Cleaning up... 15:05:56 INFO - Return code: 0 15:05:56 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:05: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')]} 15:05:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:05: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')]} 15:05:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:05:56 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 0x1a941f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c5da80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e00a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e04090>, '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 0x1e04d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1dfef90>, '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': '20e20d796406ba5117c4a6f1000001ba-1505942851.61555-1848254621', '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 15:05:56 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 15:05:56 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 15:05:56 INFO - Using env: {'DISPLAY': ':0', 15:05:56 INFO - 'HOME': '/home/cltbld', 15:05:56 INFO - 'LANG': 'en_US.UTF-8', 15:05:56 INFO - 'LANGUAGE': 'en_US:en', 15:05:56 INFO - 'LOGNAME': 'cltbld', 15:05:56 INFO - 'MAIL': '/var/mail/cltbld', 15:05:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:05:56 INFO - 'MOZ_NO_REMOTE': '1', 15:05:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:05:56 INFO - 'NO_EM_RESTART': '1', 15:05:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:05:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:05:56 INFO - 'PWD': '/builds/slave/test', 15:05:56 INFO - 'SHELL': '/bin/bash', 15:05:56 INFO - 'SHLVL': '1', 15:05:56 INFO - 'TERM': 'linux', 15:05:56 INFO - 'TMOUT': '86400', 15:05:56 INFO - 'USER': 'cltbld', 15:05:56 INFO - 'XDG_SESSION_COOKIE': '20e20d796406ba5117c4a6f1000001ba-1505942851.61555-1848254621', 15:05:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:05:56 INFO - '_': '/tools/buildbot/bin/python'} 15:05:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:05:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 15:05:56 INFO - Running setup.py (path:/tmp/pip-QSfMn6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 15:05:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 15:05:57 INFO - Running setup.py (path:/tmp/pip-ysSgWK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 15:05:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 15:05:57 INFO - Running setup.py (path:/tmp/pip-6BVlCk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 15:05:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 15:05:57 INFO - Running setup.py (path:/tmp/pip-86PF3R-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 15:05:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 15:05:57 INFO - Running setup.py (path:/tmp/pip-WnkeHx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 15:05:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 15:05:57 INFO - Running setup.py (path:/tmp/pip-yMjgsc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 15:05:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 15:05:57 INFO - Running setup.py (path:/tmp/pip-hPP2jU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 15:05:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 15:05:57 INFO - Running setup.py (path:/tmp/pip-ssuh_M-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 15:05:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 15:05:57 INFO - Running setup.py (path:/tmp/pip-DmouOV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 15:05:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 15:05:57 INFO - Running setup.py (path:/tmp/pip-P0iEhW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 15:05:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 15:05:57 INFO - Running setup.py (path:/tmp/pip-aKmFh8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 15:05:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 15:05:57 INFO - Running setup.py (path:/tmp/pip-IK8qaG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 15:05:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 15:05:57 INFO - Running setup.py (path:/tmp/pip-uimrV8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 15:05:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 15:05:57 INFO - Running setup.py (path:/tmp/pip-zXOoSm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 15:05:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 15:05:57 INFO - Running setup.py (path:/tmp/pip-iErgHo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 15:05:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 15:05:57 INFO - Running setup.py (path:/tmp/pip-D6wCFW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 15:05:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 15:05:58 INFO - Running setup.py (path:/tmp/pip-TKb7px-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 15:05:58 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 15:05:58 INFO - Running setup.py install for manifestparser 15:05:58 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 15:05:58 INFO - Running setup.py install for mozcrash 15:05:58 INFO - Running setup.py install for mozdebug 15:05:58 INFO - Running setup.py install for mozdevice 15:05:58 INFO - Installing dm script to /builds/slave/test/build/venv/bin 15:05:58 INFO - Running setup.py install for mozfile 15:05:58 INFO - Running setup.py install for mozhttpd 15:05:58 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 15:05:58 INFO - Running setup.py install for mozinfo 15:05:58 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 15:05:58 INFO - Running setup.py install for mozInstall 15:05:58 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 15:05:58 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 15:05:58 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 15:05:58 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 15:05:58 INFO - Running setup.py install for mozleak 15:05:59 INFO - Running setup.py install for mozlog 15:05:59 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 15:05:59 INFO - Running setup.py install for moznetwork 15:05:59 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 15:05:59 INFO - Running setup.py install for mozprocess 15:05:59 INFO - Running setup.py install for mozprofile 15:05:59 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 15:05:59 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 15:05:59 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 15:05:59 INFO - Running setup.py install for mozrunner 15:05:59 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 15:05:59 INFO - Running setup.py install for mozscreenshot 15:05:59 INFO - Running setup.py install for moztest 15:05:59 INFO - Running setup.py install for mozversion 15:05:59 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 15:05:59 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 15:05:59 INFO - Cleaning up... 15:05:59 INFO - Return code: 0 15:05:59 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:05: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')]} 15:05:59 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:05: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')]} 15:05:59 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:05:59 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 0x1a941f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c5da80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e00a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e04090>, '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 0x1e04d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1dfef90>, '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': '20e20d796406ba5117c4a6f1000001ba-1505942851.61555-1848254621', '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 15:05:59 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 15:05:59 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 15:05:59 INFO - Using env: {'DISPLAY': ':0', 15:05:59 INFO - 'HOME': '/home/cltbld', 15:05:59 INFO - 'LANG': 'en_US.UTF-8', 15:05:59 INFO - 'LANGUAGE': 'en_US:en', 15:05:59 INFO - 'LOGNAME': 'cltbld', 15:05:59 INFO - 'MAIL': '/var/mail/cltbld', 15:05:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:05:59 INFO - 'MOZ_NO_REMOTE': '1', 15:05:59 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:05:59 INFO - 'NO_EM_RESTART': '1', 15:05:59 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:05:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:05:59 INFO - 'PWD': '/builds/slave/test', 15:05:59 INFO - 'SHELL': '/bin/bash', 15:05:59 INFO - 'SHLVL': '1', 15:05:59 INFO - 'TERM': 'linux', 15:05:59 INFO - 'TMOUT': '86400', 15:05:59 INFO - 'USER': 'cltbld', 15:05:59 INFO - 'XDG_SESSION_COOKIE': '20e20d796406ba5117c4a6f1000001ba-1505942851.61555-1848254621', 15:05:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:05:59 INFO - '_': '/tools/buildbot/bin/python'} 15:06:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:06:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 15:06:00 INFO - Running setup.py (path:/tmp/pip-lNFbR7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 15:06:00 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)) 15:06:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 15:06:00 INFO - Running setup.py (path:/tmp/pip-Srmpcd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 15:06:00 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)) 15:06:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 15:06:00 INFO - Running setup.py (path:/tmp/pip-1AMqI7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 15:06:00 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)) 15:06:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 15:06:00 INFO - Running setup.py (path:/tmp/pip-cr4oTm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 15:06:00 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)) 15:06:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 15:06:00 INFO - Running setup.py (path:/tmp/pip-ANrjhq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 15:06:00 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)) 15:06:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 15:06:00 INFO - Running setup.py (path:/tmp/pip-vC7Ytu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 15:06:00 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)) 15:06:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 15:06:00 INFO - Running setup.py (path:/tmp/pip-oyKJAx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 15:06:00 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)) 15:06:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 15:06:00 INFO - Running setup.py (path:/tmp/pip-OXEAD3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 15:06:00 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)) 15:06:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 15:06:00 INFO - Running setup.py (path:/tmp/pip-8HP93B-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 15:06:00 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)) 15:06:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 15:06:00 INFO - Running setup.py (path:/tmp/pip-uBmHEf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 15:06:00 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)) 15:06:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 15:06:00 INFO - Running setup.py (path:/tmp/pip-3gIPI1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 15:06:00 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)) 15:06:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 15:06:00 INFO - Running setup.py (path:/tmp/pip-RvRU9X-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 15:06:00 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)) 15:06:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 15:06:00 INFO - Running setup.py (path:/tmp/pip-Cvmij0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 15:06:01 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)) 15:06:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 15:06:01 INFO - Running setup.py (path:/tmp/pip-hxtel8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 15:06:01 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)) 15:06:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 15:06:01 INFO - Running setup.py (path:/tmp/pip-lAa3sY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 15:06:01 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)) 15:06:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 15:06:01 INFO - Running setup.py (path:/tmp/pip-7NWYHz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 15:06:01 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)) 15:06:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 15:06:01 INFO - Running setup.py (path:/tmp/pip-ZvxaLh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 15:06:01 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)) 15:06:01 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)) 15:06:01 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)) 15:06:01 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)) 15:06:01 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)) 15:06:01 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)) 15:06:01 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)) 15:06:01 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.5->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 15:06:01 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:06:01 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:06:01 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:06:01 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:06:02 INFO - Downloading blessings-1.6.tar.gz 15:06:02 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 15:06:02 INFO - Installing collected packages: blessings 15:06:02 INFO - Running setup.py install for blessings 15:06:02 INFO - Successfully installed blessings 15:06:02 INFO - Cleaning up... 15:06:02 INFO - Return code: 0 15:06:02 INFO - Done creating virtualenv /builds/slave/test/build/venv. 15:06:02 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 15:06:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 15:06:02 INFO - Reading from file tmpfile_stdout 15:06:02 INFO - Current package versions: 15:06:02 INFO - argparse == 1.2.1 15:06:02 INFO - blessings == 1.6 15:06:02 INFO - blobuploader == 1.2.4 15:06:02 INFO - docopt == 0.6.1 15:06:02 INFO - functools32 == 3.2.3-2 15:06:02 INFO - jsonschema == 2.5.1 15:06:02 INFO - manifestparser == 1.1 15:06:02 INFO - mozInstall == 1.13 15:06:02 INFO - mozcrash == 1.0 15:06:02 INFO - mozdebug == 0.1 15:06:02 INFO - mozdevice == 0.51 15:06:02 INFO - mozfile == 1.2 15:06:02 INFO - mozhttpd == 0.7 15:06:02 INFO - mozinfo == 0.10 15:06:02 INFO - mozleak == 0.1 15:06:02 INFO - mozlog == 3.5 15:06:02 INFO - moznetwork == 0.27 15:06:02 INFO - mozprocess == 0.25 15:06:02 INFO - mozprofile == 0.28 15:06:02 INFO - mozrunner == 6.13 15:06:02 INFO - mozscreenshot == 0.1 15:06:02 INFO - mozsystemmonitor == 0.3 15:06:02 INFO - moztest == 0.8 15:06:02 INFO - mozversion == 1.4 15:06:02 INFO - psutil == 3.1.1 15:06:02 INFO - requests == 1.2.3 15:06:02 INFO - wsgiref == 0.1.2 15:06:02 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:06: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')]} 15:06:02 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:06: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')]} 15:06:02 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:06:02 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 0x1a941f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c5da80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e00a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e04090>, '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 0x1e04d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1dfef90>, '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': '20e20d796406ba5117c4a6f1000001ba-1505942851.61555-1848254621', '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 15:06:02 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 15:06:02 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 15:06:02 INFO - Using env: {'DISPLAY': ':0', 15:06:02 INFO - 'HOME': '/home/cltbld', 15:06:02 INFO - 'LANG': 'en_US.UTF-8', 15:06:02 INFO - 'LANGUAGE': 'en_US:en', 15:06:02 INFO - 'LOGNAME': 'cltbld', 15:06:02 INFO - 'MAIL': '/var/mail/cltbld', 15:06:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:06:02 INFO - 'MOZ_NO_REMOTE': '1', 15:06:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:06:02 INFO - 'NO_EM_RESTART': '1', 15:06:02 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:06:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:06:02 INFO - 'PWD': '/builds/slave/test', 15:06:02 INFO - 'SHELL': '/bin/bash', 15:06:02 INFO - 'SHLVL': '1', 15:06:02 INFO - 'TERM': 'linux', 15:06:02 INFO - 'TMOUT': '86400', 15:06:02 INFO - 'USER': 'cltbld', 15:06:02 INFO - 'XDG_SESSION_COOKIE': '20e20d796406ba5117c4a6f1000001ba-1505942851.61555-1848254621', 15:06:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:06:02 INFO - '_': '/tools/buildbot/bin/python'} 15:06:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:06:03 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)) 15:06:03 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)) 15:06:03 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)) 15:06:03 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)) 15:06:03 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)) 15:06:03 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)) 15:06:03 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)) 15:06:03 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)) 15:06:03 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)) 15:06:03 INFO - Downloading/unpacking simplejson>=2.1.1 (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 10)) 15:06: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 15:06: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 15:06: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 15:06: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 15:06:04 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/simplejson/setup.py) egg_info for package simplejson 15:06:04 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)) 15:06:04 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)) 15:06:04 INFO - Installing collected packages: simplejson 15:06:04 INFO - Running setup.py install for simplejson 15:06:04 INFO - building 'simplejson._speedups' extension 15:06:04 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 15:06:05 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 15:06:05 INFO - Successfully installed simplejson 15:06:05 INFO - Cleaning up... 15:06:05 INFO - Return code: 0 15:06:05 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 15:06:05 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')]} 15:06:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:06:05 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')]} 15:06:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:06:05 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/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 0x1a941f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c5da80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e00a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e04090>, '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 0x1e04d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1dfef90>, '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': '20e20d796406ba5117c4a6f1000001ba-1505942851.61555-1848254621', '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 15:06:05 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 15:06:05 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 15:06:05 INFO - Using env: {'DISPLAY': ':0', 15:06:05 INFO - 'HOME': '/home/cltbld', 15:06:05 INFO - 'LANG': 'en_US.UTF-8', 15:06:05 INFO - 'LANGUAGE': 'en_US:en', 15:06:05 INFO - 'LOGNAME': 'cltbld', 15:06:05 INFO - 'MAIL': '/var/mail/cltbld', 15:06:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:06:05 INFO - 'MOZ_NO_REMOTE': '1', 15:06:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:06:05 INFO - 'NO_EM_RESTART': '1', 15:06:05 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:06:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:06:05 INFO - 'PWD': '/builds/slave/test', 15:06:05 INFO - 'SHELL': '/bin/bash', 15:06:05 INFO - 'SHLVL': '1', 15:06:05 INFO - 'TERM': 'linux', 15:06:05 INFO - 'TMOUT': '86400', 15:06:05 INFO - 'USER': 'cltbld', 15:06:05 INFO - 'XDG_SESSION_COOKIE': '20e20d796406ba5117c4a6f1000001ba-1505942851.61555-1848254621', 15:06:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:06:05 INFO - '_': '/tools/buildbot/bin/python'} 15:06:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:06:05 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 15:06:05 INFO - Cleaning up... 15:06:05 INFO - Return code: 0 15:06:05 INFO - Running post-action listener: _resource_record_post_action 15:06:05 INFO - Running post-action listener: _start_resource_monitoring 15:06:05 INFO - Starting resource monitoring. 15:06:05 INFO - [mozharness: 2017-09-20 22:06:05.611975Z] Finished create-virtualenv step (success) 15:06:05 INFO - [mozharness: 2017-09-20 22:06:05.612440Z] Running install step. 15:06:05 INFO - Running pre-action listener: _resource_record_pre_action 15:06:05 INFO - Running main action method: install 15:06:05 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 15:06:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 15:06:05 INFO - Reading from file tmpfile_stdout 15:06:05 INFO - Detecting whether we're running mozinstall >=1.0... 15:06:05 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 15:06:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 15:06:05 INFO - Reading from file tmpfile_stdout 15:06:05 INFO - Output received: 15:06:05 INFO - Usage: mozinstall [options] installer 15:06:05 INFO - Options: 15:06:05 INFO - -h, --help show this help message and exit 15:06:05 INFO - -d DEST, --destination=DEST 15:06:05 INFO - Directory to install application into. [default: 15:06:05 INFO - "/builds/slave/test"] 15:06:05 INFO - --app=APP Application being installed. [default: firefox] 15:06:05 INFO - mkdir: /builds/slave/test/build/application 15:06:05 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'] 15:06:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 15:06:23 INFO - Reading from file tmpfile_stdout 15:06:23 INFO - Output received: 15:06:23 INFO - /builds/slave/test/build/application/firefox/firefox 15:06:23 INFO - Running post-action listener: _resource_record_post_action 15:06:23 INFO - [mozharness: 2017-09-20 22:06:23.729704Z] Finished install step (success) 15:06:23 INFO - [mozharness: 2017-09-20 22:06:23.729957Z] Running setup-mitmproxy step. 15:06:23 INFO - Running pre-action listener: _resource_record_pre_action 15:06:23 INFO - Running main action method: setup_mitmproxy 15:06:23 INFO - Skipping: mitmproxy is not required 15:06:23 INFO - Running post-action listener: _resource_record_post_action 15:06:23 INFO - [mozharness: 2017-09-20 22:06:23.731173Z] Finished setup-mitmproxy step (success) 15:06:23 INFO - [mozharness: 2017-09-20 22:06:23.731394Z] Running run-tests step. 15:06:23 INFO - Running pre-action listener: _resource_record_pre_action 15:06:23 INFO - Running pre-action listener: _set_gcov_prefix 15:06:23 INFO - Running main action method: run_tests 15:06:23 WARNING - Try message not found. 15:06:23 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 15:06:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 15:06:23 INFO - Python 2.7.3 15:06:23 INFO - Return code: 0 15:06:23 INFO - grabbing minidump binary from tooltool 15:06:23 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')]} 15:06:23 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 0x1e04090>, '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 0x1e04d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1dfef90>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 15:06:23 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 15:06:23 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 15:06:23 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 15:06:23 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 15:06:23 INFO - Return code: 0 15:06:23 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 15:06:23 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 15:06:23 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 15:06:23 INFO - ENV: RUST_BACKTRACE is now full 15:06:23 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 15:06:23 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 15:06:23 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/So2N-P5gRV2VMrCgAQvl_g/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-077', '--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 15:06:23 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/So2N-P5gRV2VMrCgAQvl_g/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-077 --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 15:06:23 INFO - Using env: {'DISPLAY': ':0', 15:06:23 INFO - 'HOME': '/home/cltbld', 15:06:23 INFO - 'LANG': 'en_US.UTF-8', 15:06:23 INFO - 'LANGUAGE': 'en_US:en', 15:06:23 INFO - 'LOGNAME': 'cltbld', 15:06:23 INFO - 'MAIL': '/var/mail/cltbld', 15:06:23 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 15:06:23 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 15:06:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:06:23 INFO - 'MOZ_NO_REMOTE': '1', 15:06:23 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 15:06:23 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:06:23 INFO - 'NO_EM_RESTART': '1', 15:06:23 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:06:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:06:23 INFO - 'PWD': '/builds/slave/test', 15:06:23 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 15:06:23 INFO - 'RUST_BACKTRACE': 'full', 15:06:23 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 15:06:23 INFO - 'SHELL': '/bin/bash', 15:06:23 INFO - 'SHLVL': '1', 15:06:23 INFO - 'TERM': 'linux', 15:06:23 INFO - 'TMOUT': '86400', 15:06:23 INFO - 'USER': 'cltbld', 15:06:23 INFO - 'XDG_SESSION_COOKIE': '20e20d796406ba5117c4a6f1000001ba-1505942851.61555-1848254621', 15:06:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:06:23 INFO - '_': '/tools/buildbot/bin/python'} 15:06:23 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/So2N-P5gRV2VMrCgAQvl_g/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-077', '--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 15:06:24 INFO - mozversion application_buildid: 20170920210755 15:06:24 INFO - mozversion application_changeset: 319a34bea9e4f3459886b5b9e835bd338320f1fd 15:06:24 INFO - mozversion application_display_name: Nightly 15:06:24 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 15:06:24 INFO - mozversion application_name: Firefox 15:06:24 INFO - mozversion application_remotingname: firefox 15:06:24 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 15:06:24 INFO - mozversion application_vendor: Mozilla 15:06:24 INFO - mozversion application_version: 57.0a1 15:06:24 INFO - mozversion platform_buildid: 20170920210755 15:06:24 INFO - mozversion platform_changeset: 319a34bea9e4f3459886b5b9e835bd338320f1fd 15:06:24 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 15:06:24 INFO - mozversion platform_version: 57.0a1 15:06:24 INFO - using testdate: 1505945184 15:06:24 INFO - actual date: 1505945184 15:06:24 INFO - starting webserver on 'localhost:52301' 15:06:24 INFO - SUITE-START | Running 2 tests 15:06:24 INFO - TEST-START | dromaeo_css 15:06:24 INFO - Initialising browser for dromaeo_css test... 15:06:24 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:52301/getInfo.html -profile /tmp/tmptoyL4i/profile 15:06:24 INFO - TEST-INFO | started process 17365 (/builds/slave/test/build/application/firefox/firefox http://localhost:52301/getInfo.html) 15:06:29 INFO - TEST-INFO | 17365: exit 0 15:06:29 INFO - Browser initialized. 15:06:29 INFO - Running cycle 1/1 for dromaeo_css test... 15:06:29 INFO - Using env: {'DISPLAY': ':0', 15:06:29 INFO - 'HOME': '/home/cltbld', 15:06:29 INFO - 'JSGC_DISABLE_POISONING': '1', 15:06:29 INFO - 'LANG': 'en_US.UTF-8', 15:06:29 INFO - 'LANGUAGE': 'en_US:en', 15:06:29 INFO - 'LD_LIBRARY_PATH': '/builds/slave/test/build/application/firefox', 15:06:29 INFO - 'LOGNAME': 'cltbld', 15:06:29 INFO - 'MAIL': '/var/mail/cltbld', 15:06:29 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 15:06:29 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 15:06:29 INFO - 'MOZ_CRASHREPORTER': '1', 15:06:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:06:29 INFO - 'MOZ_DISABLE_NONLOCAL_CONNECTIONS': '1', 15:06:29 INFO - 'MOZ_NO_REMOTE': '1', 15:06:29 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 15:06:29 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:06:29 INFO - 'NO_EM_RESTART': '1', 15:06:29 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:06:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:06:29 INFO - 'PWD': '/builds/slave/test', 15:06:29 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 15:06:29 INFO - 'RUST_BACKTRACE': 'full', 15:06:29 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 15:06:29 INFO - 'SHELL': '/bin/bash', 15:06:29 INFO - 'SHLVL': '1', 15:06:29 INFO - 'STYLO_FORCE_DISABLED': '1', 15:06:29 INFO - 'TERM': 'linux', 15:06:29 INFO - 'TMOUT': '86400', 15:06:29 INFO - 'USER': 'cltbld', 15:06:29 INFO - 'XDG_SESSION_COOKIE': '20e20d796406ba5117c4a6f1000001ba-1505942851.61555-1848254621', 15:06:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:06:29 INFO - '_': '/tools/buildbot/bin/python'} 15:06:29 INFO - TEST-INFO | started process 17600 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmptoyL4i/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 15:06:30 INFO - PID 17600 | 15:06:30 INFO - PID 17600 | (/builds/slave/test/build/application/firefox/firefox:17648): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 15:06:30 INFO - PID 17600 | 15:06:41 INFO - PID 17600 | RSS: Main: 150159360 15:06:41 INFO - PID 17600 | 15:09:38 INFO - PID 17600 | Cycle 1(1): loaded http://localhost:52301/tests/dromaeo/cssquery-dojo.html (next: http://localhost:52301/tests/dromaeo/cssquery-ext.html) 15:09:39 INFO - PID 17600 | RSS: Main: 154615808 15:09:39 INFO - PID 17600 | 15:12:41 INFO - PID 17600 | Cycle 1(1): loaded http://localhost:52301/tests/dromaeo/cssquery-ext.html (next: http://localhost:52301/tests/dromaeo/cssquery-jquery.html) 15:12:41 INFO - PID 17600 | RSS: Main: 152899584 15:12:41 INFO - PID 17600 | 15:15:43 INFO - PID 17600 | Cycle 1(1): loaded http://localhost:52301/tests/dromaeo/cssquery-jquery.html (next: http://localhost:52301/tests/dromaeo/cssquery-mootools.html) 15:15:44 INFO - PID 17600 | RSS: Main: 156495872 15:15:44 INFO - PID 17600 | 15:18:45 INFO - PID 17600 | Cycle 1(1): loaded http://localhost:52301/tests/dromaeo/cssquery-mootools.html (next: http://localhost:52301/tests/dromaeo/cssquery-prototype.html) 15:18:46 INFO - PID 17600 | RSS: Main: 155103232 15:18:46 INFO - PID 17600 | 15:21:49 INFO - PID 17600 | Cycle 1(1): loaded http://localhost:52301/tests/dromaeo/cssquery-prototype.html (next: http://localhost:52301/tests/dromaeo/cssquery-yui.html) 15:21:50 INFO - PID 17600 | RSS: Main: 156041216 15:21:50 INFO - PID 17600 | 15:24:51 INFO - PID 17600 | Cycle 1(1): loaded http://localhost:52301/tests/dromaeo/cssquery-yui.html (next: http://localhost:52301/tests/dromaeo/cssquery-dojo.html) 15:24:52 INFO - PID 17600 | RSS: Main: 158867456 15:24:52 INFO - PID 17600 | 15:24:52 INFO - PID 17600 | __start_tp_report 15:24:52 INFO - PID 17600 | _x_x_mozilla_page_load 15:24:52 INFO - PID 17600 | _x_x_mozilla_page_load_details 15:24:52 INFO - PID 17600 | |i|pagename|runs| 15:24:52 INFO - PID 17600 | |0;dojo.html;3116.579261799657;3134.749220062395;3136.2943337749;3155.1796532901453;3177.3645270945804;6177.444030037295;6316.873662526747;6380.266269379023;6419.358064193579;6443.935560644398;6248.781292654758;6250.656213908244;6309.305976342599;6425.228972523292;6426.935730642692;1302.2455445367086;5871.324797648283;5888.676122813244;5908.970455147718;5965.1052342148805;5722.685252311121;5792.073268277077;5844.620099693507;5871.588988770788;5901.937651222778;5767.452092051249;5788.247527821356;5808.332041815182;5823.912641310384;5855.824325270228;5781.479666829963;5789;5853.5317174625925;5863.149843272744;5882.647041177543;5763.538916886639;5773.566982476289;5840.036393994986;5841.182234487175;5848.912266316009;6212.72042758077;6303.810885673392;6315.463185629227;6367.172267605228;6404.7117879695525;6573.57271777333;6681.9642955342;6684.86630267392;6740.865182696319;6830.829229269259;6665.600063996176;6687.465002799813;6741.494387920926;6752.1222241108835;6752.966235168842;6267.874642507124;6385.999999999954;6386.42522173002;6387.041943708481;6389.488840892717;6965.477589180831;6969.895451568231;7048.224695283515;7051.330123638246;7073.71705131789;6442.387973142544;6630.370114839083;6647.966760166169;6732.865342693119;6734.730610775514;6652.201735791736;6681.331866813377;6802.455803535705;6819.318068193141;6825.795226143224;6671.46628269747;6756.054152418567;6763.898541521881;6787.321267873173;6789.015592739025;6759.290274521104;6796.626185559841;6814.1482314710665;6858.5199036067;6859.9314006860295;5055.34280543527;5205.505476979681;5225.477452254744;5302.416734159239;5306.09796334624;4593.28804035375;4669.976650116728;4694.50707675696;4707.882302942454;4713.528647135259;5780.075187969905;5829.417058294137;5861.238039054895;5863.501602363847;5865.736041878125;6747.966260168766;6767.560108592926;6768.526203165731;6825;6853.143357080365;5641.351244606841;5772.6536407815665;5781.5952883298605;5792.21805056312;5856.970715146482;5876.559258055663;5889.38161493037;5890.352061273256;5895.322037965603;5901.17383566301;6360.9045864312075;6483.254425741005;6490.415862572391;6507.609543427315;6584.7366105356205;6641.933580664131;6869.484788640972;6869.622170780655;6870.690818913261;6876.381125698611;6403.263624683221;6405.135306733531;6488.383603557654;6493.707783149675;6498.480121590356;6535.117759102651;6632.966835165793;6644.4020038196795;6698.56459330142;6752.966235168989;6859.691313890987;6860.0738900247825;6877.89683154763;6883.414909732729;6884.586924784529;6449.838754031187;6647.800565983028;6653.63405012729;6658.800235992928;6664.633445160563;6520.739170433129;6526.118973938647;6598.538102332791;6608.43828274602;6609.504287178384;6311.274203466476;6405.903911441239;6430.839229019312;6464.8707025858275;6590.934090659032;6607.471402287902;6667.366600172976;6690.966545167437;6691.59850408977;6693.665316734046;6125.111858780363;6264.154339164154;6351.96824015877;6448.193975753031;6451.3548645135115 15:24:52 INFO - PID 17600 | |1;ext.html;868.7741187291305;881.2773525708922;898.178166977216;916.7524768312555;917.7292698653896;40872;41136.17727645445;41686.791566042164;42086;42295.57704422958;42305.788471057676;42704.14591708172;42730;42748.78625606868;42828.785856070754;7834.80412989677;8061.798455038642;8062.314703250201;8063.838723225532;8066.475679080871;7915.564643944581;7942.126366099725;8006.63970121343;8008;8026.959865200666;8017.559034253114;8038.959805200966;8042.477238979448;8050.718224862131;8068.435209535335;7972.0832104308165;7977.042754869424;8003.159668234839;8013.919860801376;8030.437869349148;7885.250901164381;7901.130875603679;7939.841203175962;7955.96022019892;7956.403269754734;36841.44737828908;37244.44133338002;37275.06812329686;37293;37310.44034339487;3575.910602234939;3612.494250804863;3612.6567976042234;3612.783233006002;3613.981930090359;30879.536806947915;30897;30901.38197236043;30905.536416953764;31008.689913101032;4939.876503087416;5176.741162941876;5214.270002199695;5230.738463076831;5276.287701160371;173562;175222;175297;183088;183572;49022.26466603004;49946.75026624916;49997.50002499928;50031.49968500269;50039.24941125886;52506.737466313185;52545;52639.473605263454;52647;52653.7367313161;15695.136767477898;15791.684166316609;15816.525504234662;15817.446389376546;15841.52475425739;12938.223706577635;12987.155834870704;12999;13011.089223754436;13015.47938082485;13688.452461901412;13715.382807773674;13825.930870345785;13883.37524811386;13973.510927117502;5051.156327940275;5143.202803565453;5172.508611681884;5229.738513074331;5315.574754019669;984.7931934293736;1010.2826992835022;1019.4444028004755;1030.4126647810676;1035.4098164046572;22436.55126897453;22955.770442295696;23009;23036.88481557615;23151.652725209136;1099.2580008494235;1117.446863802423;1124.3872089711126;1130.10156925243;1137.806572882612;12060.396980150957;12156.939215303866;12176.321209333932;12231.69420764488;12245.571405000961;202926;204724;205091;205722;205926;50672;50899.491005089476;50950.74524627427;50984;51054.234186487236;1469.8971072024856;1480.060161797245;1480.696457226266;1492.7611582147022;1499.9625009374854;21721.456963575405;21854;21965.450863727896;22109.668354974365;22563.887180563994;37447.81276093602;37684.811575941945;37741.62258377491;37777.433338500494;37798.62201377951;191562;192233;192498;192723;193466;33322.5001624971;34186.31627367389;34547.65452345445;34566.65433345635;34701.30597388089;42478.36282455827;42511.787441062595;42580.14839703127;42812.357814633426;42904;31592;31780;32098;32246.677533225306;32595.18512037218;31002.68997309998;31163.662725296148;31669;31823.681763182998;31846.363072737953;35751.28497429985;35827.641723582434;35924.64075359317;36066.4590031155;36193.81903090468;31176;31329.373412532077;31375.215619608778;31387.84306078455;31570.684293156773;22829.429264268525;22941.311760647208;23165.42086447852;23201.651975220724;23399.76600233976 15:24:52 INFO - PID 17600 | |2;jquery.html;570.9143628455734;575.3584753000405;576.0293904770459;579.6724850459493;593.4955288005195;21920.23279185229;22689.319320420414;22716;22743;22767.089316427344;23616.763832361714;24014.87992560039;24210;24214.15250466234;24577.50844983099;6511.283758786518;6686.0305255737885;6696.296888826651;6701.061851340816;6702.865942681144;6343.492520598341;6592.472602191837;6672.633005184713;6677.399034086931;6685.899711504331;6577.934220657804;6585.506087043467;6587.670616469181;6596.802095937105;6602.768903088393;6552.967235163841;6583.901241481333;6588.670566471681;6611.041398997167;6615;6642.734290628369;6914.204866440374;6947;6949.270326615683;6952.130983627047;30310.242243943856;30694.232644184074;30961.38077238465;30977.535336969962;30985.535216971763;2066.8863212523456;2105.7578378486364;2106.8735875847497;2107.99870061721;2108.20942146695;19986.80013199864;20467;20790.16839326425;20862.165513379598;21081.472963176042;2532.7214006459276;2544.885480153379;2608.5565453872887;2633.0652618320414;2666.386731051869;122488.38755806253;125330;125500;129812;135928.64071359258;19880.403587892386;20258.392248232576;20984.760257711067;21505.24731634385;21834.781652183276;41608.37587436191;41614.375784363256;41704.374434383506;41705.374419383734;41706.37440438396;11350.545978160946;11430.428478576037;11431.256968297033;11582.478788454371;11718.472668729928;9487.193588545051;9548.761280968032;9556.187724043395;9593.952030239805;9704.854427183598;11238.662840114646;11243.494042768096;11495.367754773568;11567.132465065153;11682.415879206006;3920.196359746245;4031.5565287818317;4064.3293856513937;4096.877093687194;4187.853425130106;973.9610415583297;984.1437948984429;987.6247026130025;993.9453330066771;1005.1556692378438;18437.354692585694;18666.253349865852;18948.052597370075;18955.241790328233;19047.809521904604;1040.422565476168;1043.2071625564474;1047.8218702820539;1055.1084333737979;1061.3578784835063;10396.896031039743;10449.9477502612;10543.525541350658;10590.735231619272;10734.838977415346;476351;490155;493214;501491;503061;102684.48657756664;107356.46321768341;109067;110211.44894275477;111096;1159.0553698735503;1169.2283093158474;1198.8801119887942;1202.1344631865043;1205.1684337806885;16748.162591870114;16955.66088678195;16961.49115526536;17082.829171708123;17332.393366232627;53290.4670953301;54105.72947135239;54306.45693543014;54736.726316368164;55151;68227.65886170736;68606.65696671484;68650.65674671794;69086.65456672685;69318.30681693119;18683.813161868205;19130.52173695669;19214.231430742613;19295.8070419294;19383.806161938763;21301.46746331354;21614;21719;21942.561148776615;21971.23100691468;17153.914230429265;17220.88064275818;17324.220410081827;17444.73832892533;17725.822741772416;15004.474843380429;15466.458673946358;15639.296231669374;15674.9216253918;16235.350585976428;17617.82382176162;17670.558236044202;17702.911485443004;17810.10949452548;18158.546036348667;18434.354797582022;18502.074896255403;18534.165962531988;18539;18728.25086996505;17078.146092695562;17202;17330.826691733426;17400.303987840343;17430 15:24:52 INFO - PID 17600 | |3;mootools.html;1215.3801561203784;1270.8030255310427;1386.369202013084;1418.631155899467;1419.609607357977;15463.84536154638;16105.919470402661;16140.031598104108;16146.434874779385;16154.192290385463;15599.298031588578;15716.528504144893;15732.213389330516;15736.29186686599;15759.92120039401;2689.9596506052326;2736.480068786929;2771.514984877638;2778.9861050694717;2779.1523585306472;2718.904838330659;2736.0423851651963;2757.765589924859;2759.3239656284136;2760.0339881041577;2715.049732593596;2735.5076086304457;2811.6063751074867;2820.8871645134273;2822.0969289827262;2744.7392497712685;2776.9583456248174;2783.512885245074;2799.370141718128;2802.63565736454;2590.3912580543556;2722.414680843628;2790.9581356279673;2797.650293713286;2804.8457334846576;15148.394064237416;15220.162891040989;15239.23803809805;15285.159316237603;15297.770533441895;7992.680292788282;8324;8328.417010809246;8329.708460203925;8332.875006874901;5534.501894829445;5540.806071787468;5672.8865422691315;5716.542676585863;5719.857003574903;1972.5956178983274;1988.4730546405215;1999.5800881814837;2002.119067610247;2030.8476864235095;25964.870175649;26671.73328266712;26759.86620066907;26950.191494255203;27050.323741906413;7285.125784905846;7396.445266604918;7438.442116841258;7505.849883002309;7590.620468976529;20245.59508809845;20269.797302027087;20273.695894561297;20298.391048268575;20345.491362715755;8119.553424561587;8273.917260827435;8277.379196560281;8280.792980175544;8303.626336814857;7201.279872012861;7372.889406658905;7400.851982960311;7403.444741644291;7480.139783924809;5572.637778544382;5756.856078597984;5791.710414479259;5793.159991801165;5805.767769289266;1745.2757105801204;1820.280989009334;1824.835764781176;1841.611434959654;1876.934307299238;908.9454632722058;930.6556574067503;947.4788866123605;950.919171870385;953.9046095390405;7710.421718371144;7782.143964163937;7874.291313781787;7917.485363451472;7937.563434011069;731.1555153797373;732.4909188114316;738.9704411823467;740.9222031686703;745.4371949178336;5254.842354729364;5396.865078372994;5471.288732464834;5503.11950087984;5549.250851135126;20575.58848823015;21685.241016564345;21705.34883953484;21724.23965161212;21770.891145544487;20900.686489702668;20985.68521472179;21340.14639414406;21564;21588.56822863534;11212.495437705324;11361.147913906325;11370.147238957112;11384;11427.771444571063;8566.229039386486;8572.099929507312;8593.570321484025;8615.095414981588;8670.91329086701;17972.730409043612;18218.635627287116;18222;18251.81748182501;18268.36060737868;18769.530761731065;19013.33453329127;19177.712334314718;19191.52021199481;19829;11507.597234096766;11536.192466527262;11607.883921160681;11653.59212427561;11799.823002654795;13621.931890340486;13751.243681597609;13756.86243137596;13835.239061851695;13838.930805345908;11271.267367621078;11410.714732131763;11439.142064345373;11583.942080289544;11805.704857378634;11073.557057717924;11099.667009989713;11100.888991109985;11258.268212566158;11453.312801231952;9844.753881153028;9933.056359645821;9961.452120133172;9966.700998969753;9984.35101718386;7214;7291.927080729125;7311.341979221896;7328.890066648898;7378.483506154733;7583.810404739926;7756;7777.4166937478785;7805.33654639362;7860 15:24:52 INFO - PID 17600 | |4;prototype.html;501.61482152365494;506.63015998321214;527.1986580397795;530.2761730238224;530.914280296793;6263.434141464634;6304.8108556743255;6350.968245158773;6354.396332348425;6451.645159516236;6183.258009038922;6282.497400207983;6330.240371155456;6363.872722545558;6364.204474440695;5274.947250527484;5283.445238249967;5306.328506520453;5310.575153987691;5334.159714898373;5151.175811870102;5304.70824104676;5309.469053094698;5335.706536140511;5345.705986170759;4843.8062477501035;4966.627502937276;5002.324686167375;5021.522955319257;5057.6965382077005;4965.783383071171;4977.850664480072;5010.348654674905;5034.597232221414;5048.242763585455;4464.531224221475;4473.172463094338;4493.662975276868;4519.864404067883;4521.773911304422;6164.87670246597;6170.96914515429;6201.131841542187;6225.260885210493;6246.939978617334;5737.885242295172;5751.4536119068625;5762.971185144047;5763.423657634245;5774.595778295521;6544.934550654528;6565.310642382577;6581.926693091661;6682.632455214961;6705.792957267689;4635.0729854029;4871.29366241893;4873.366462359871;4916.360873086512;4926.975365123188;6669;6822.522423430361;6857.657117144123;6967.233604303573;6994;4974.353334066548;5043.36957880265;5069.403138011515;5078.162103252922;5082.517160869711;5095.617828662865;5123;5133.845984620468;5134.127198376285;5139.100657384943;5715.914261286084;5716.685582293014;5726.427357264323;5733.3406658234;5747.396523364986;6651.501137414713;6693.163354580677;6699.598024118569;6726.22648395431;6738.427233685094;1725.6376161006328;1736.3401907275154;1753.929842806299;1777.2446710148395;1785.8660600455019;1151.9136064795173;1192.1297452859287;1198.1193822540426;1206.9818952715716;1218.5065048655308;5691.8616276744815;5720.399358067426;5746.4253574643035;5772.06635777011;5790.189373487715;6684.699188536528;6804.965975170093;6820.761273355508;6850.554713943578;6857.27998560144;5626.35296940857;5718.170865224519;5746.856328591735;5757.222774925415;5758.654480731169;3519.331327047904;3532.364174448624;3595.2989167112687;3610.476480910306;3628.6595146131126;6458.6770661466735;6476.676166191766;6480.222373315138;6485.4811615070685;6546.509011824132;6830.282820303796;6844.220502669243;6937.340952609494;7049.859002819915;7081.150261968493;6396.880545904448;6512.967435162794;6541.705623246965;6543.116679248431;6567.602824968947;6325.588836725598;6737.62943038118;6753.628550429577;6850.8287292816085;6891;6483.546151769331;6553.901691474536;6586.37429444202;6604.735810567524;6706.262311145868;6313.96843015782;6385;6417.26201486835;6429.903551446826;6468.902966455601;4869.245266983623;4929.556339929423;4987.950120498748;4995;4998.950010499849;6470.547061705635;6694.263631000684;6757.86484270302;6824.884285871396;6902.171739391305;6372.968135159294;6448.709808058555;6488.513361497812;6537.673116344069;6557.508186886098;6554.508411869224;6599.505037122139;6599.8020059398295;6646.136002319668;6705.362990515893;6354.23749150105;6428.292887782247;6528.21661400635;6553.836154096186;6570.934290657224;6489.837754055998;6610.2398224204835;6694.895342268471;6697.665116744046;6708.765193218214;6292;6316.336784637547;6356.713947872265;6369.20384951881;6415.492359295655 15:24:52 INFO - PID 17600 | |5;yui.html;887.8046829697472;915.8214148241092;919.4115765909817;919.6413398774483;939.8308304505191;17743.46769596911;18166.18252178652;18197.45407637773;18228;18260.360887368926;16655.16724163793;16696;16782.74825877613;17179.484615461526;18491.815081849178;975.3221511049824;1002.5087707023579;1005.8591797148405;1005.9798804023915;1006.5872992073251;953.5327689432198;990.4898977026837;990.9108180263775;991.6677912899188;992.2756387836884;1061.3843970497132;1067.156946012653;1067.17294097075;1067.4022547373456;1067.4769363012108;1055.72551136705;1061.4056128567988;1061.4268295120664;1061.8938106189396;1062.293574772783;722.458156382713;741.4957828676498;754.9245075492462;755.4824944912752;778.3578547698172;18854;18958.526036849053;18968.5257868553;18974.525636859187;18992.52518687044;21545.569088618297;21583;22064.33806985793;22156.556868862695;22176.334709958726;17120.74318885218;17427;17587.12064396788;17587.648247034987;17724.556886077822;3738.813059347049;3760.191558814868;3766.39737641976;3767.416050512175;3767.6797472214894;132601;133065;134443.999999999;135815.32092339575;137465;16565.42021029282;16810.91594542044;17087.743683844754;17167.656646867243;17257.223424945907;30489.5342334425;31033.534496982113;31098.067057987842;31180;31352.529712054336;8389.412741108064;8435.325173986066;8534.573271336532;8536.957315213509;8538.359623028173;4260.041490664637;4327.826886924488;4328.394024836525;4334.523202447728;4338.58783415575;5102.591792656653;5236.869078273074;5247.685138891678;5252.028374750607;5257.447967963309;928.9163975242126;960.8366577681811;965.7682156282442;969.0938972061145;973.4597298499259;689.5483458334799;703.2264509040015;714.4855703893188;716.8530451257584;723.2875617516742;11628.18602697803;12108.697282568006;12255.877441225652;12817.807732884014;13095.148815326973;633.4773811605352;648.8248172993266;650.1970066967292;653.7515744017243;654.358728446116;5467;5563.666180029211;5601.439856014366;5671.489565939085;5676.602637815396;122092.01171894395;124153;124159.37920310521;127403;127511.36244318719;105759;106075.46962265293;106555;109143.45428272808;111705;90262.54868725615;92442.53778731063;92503;94669.52665236767;95415;10302.536385862804;10481.004304591052;10504;10617.787644247226;10766.46167691628;43898.561014389445;44575.10849783051;45967.77016114898;46382.68086595724;46523;57401;58411.70794146002;58673;59074.11388829085;59295.110573342296;15216.771748424004;15242.847571524142;15285.388584456497;15344.462943796914;15524.68950621004;17441.30234790594;17446;17486.213120409357;17718;17743.822561774217;15446.768298475756;15786.131762753159;15904.522864314089;15998.360065597246;16000.759988599948;15776.526704198892;15853.762193566876;15927.522174334788;16071.67856642884;16092.839071609134;15402.46091386796;15471.922640386727;15725.842741572895;15880.364785408916;15892.68214635724;12411.62765117048;12532.686682833002;12565.560205392767;12641.620751377473;12886.420111094836;11148.609798657333;11345.432728363714;11494.252873563191;11543.94228028888;11660 15:24:52 INFO - PID 17600 | __end_tp_report 15:24:52 INFO - PID 17600 | __start_cc_report 15:24:52 INFO - PID 17600 | _x_x_mozilla_cycle_collect,277 15:24:52 INFO - PID 17600 | __end_cc_report 15:24:52 INFO - PID 17600 | __startTimestamp1505946292154__endTimestamp 15:24:52 INFO - PID 17600 | 15:24:52 INFO - PID 17600 | ------- Summary: start ------- 15:24:52 INFO - PID 17600 | Number of tests: 6 15:24:52 INFO - PID 17600 | 15:24:52 INFO - PID 17600 | [#0] dojo.html Cycles:165 Average:6190.77 Median:6430.84 stddev:841.57 (13.1%) stddev-sans-first:808.86 15:24:52 INFO - PID 17600 | Values: 3116.6 3134.7 3136.3 3155.2 3177.4 6177.4 6316.9 6380.3 6419.4 6443.9 6248.8 6250.7 6309.3 6425.2 6426.9 1302.2 5871.3 5888.7 5909.0 5965.1 5722.7 5792.1 5844.6 5871.6 5901.9 5767.5 5788.2 5808.3 5823.9 5855.8 5781.5 5789.0 5853.5 5863.1 5882.6 5763.5 5773.6 5840.0 5841.2 5848.9 6212.7 6303.8 6315.5 6367.2 6404.7 6573.6 6682.0 6684.9 6740.9 6830.8 6665.6 6687.5 6741.5 6752.1 6753.0 6267.9 6386.0 6386.4 6387.0 6389.5 6965.5 6969.9 7048.2 7051.3 7073.7 6442.4 6630.4 6648.0 6732.9 6734.7 6652.2 6681.3 6802.5 6819.3 6825.8 6671.5 6756.1 6763.9 6787.3 6789.0 6759.3 6796.6 6814.1 6858.5 6859.9 5055.3 5205.5 5225.5 5302.4 5306.1 4593.3 4670.0 4694.5 4707.9 4713.5 5780.1 5829.4 5861.2 5863.5 5865.7 6748.0 6767.6 6768.5 6825.0 6853.1 5641.4 5772.7 5781.6 5792.2 5857.0 5876.6 5889.4 5890.4 5895.3 5901.2 6360.9 6483.3 6490.4 6507.6 6584.7 6641.9 6869.5 6869.6 6870.7 6876.4 6403.3 6405.1 6488.4 6493.7 6498.5 6535.1 6633.0 6644.4 6698.6 6753.0 6859.7 6860.1 6877.9 6883.4 6884.6 6449.8 6647.8 6653.6 6658.8 6664.6 6520.7 6526.1 6598.5 6608.4 6609.5 6311.3 6405.9 6430.8 6464.9 6590.9 6607.5 6667.4 6691.0 6691.6 6693.7 6125.1 6264.2 6352.0 6448.2 6451.4 15:24:52 INFO - PID 17600 | 15:24:52 INFO - PID 17600 | [#1] ext.html Cycles:180 Average:36333.68 Median:35789.46 stddev:49691.33 (138.8%) stddev-sans-first:49759.37 15:24:52 INFO - PID 17600 | Values: 868.8 881.3 898.2 916.8 917.7 40872.0 41136.2 41686.8 42086.0 42295.6 42305.8 42704.1 42730.0 42748.8 42828.8 7834.8 8061.8 8062.3 8063.8 8066.5 7915.6 7942.1 8006.6 8008.0 8027.0 8017.6 8039.0 8042.5 8050.7 8068.4 7972.1 7977.0 8003.2 8013.9 8030.4 7885.3 7901.1 7939.8 7956.0 7956.4 36841.4 37244.4 37275.1 37293.0 37310.4 3575.9 3612.5 3612.7 3612.8 3614.0 30879.5 30897.0 30901.4 30905.5 31008.7 4939.9 5176.7 5214.3 5230.7 5276.3 173562.0 175222.0 175297.0 183088.0 183572.0 49022.3 49946.8 49997.5 50031.5 50039.2 52506.7 52545.0 52639.5 52647.0 52653.7 15695.1 15791.7 15816.5 15817.4 15841.5 12938.2 12987.2 12999.0 13011.1 13015.5 13688.5 13715.4 13825.9 13883.4 13973.5 5051.2 5143.2 5172.5 5229.7 5315.6 984.8 1010.3 1019.4 1030.4 1035.4 22436.6 22955.8 23009.0 23036.9 23151.7 1099.3 1117.4 1124.4 1130.1 1137.8 12060.4 12156.9 12176.3 12231.7 12245.6 202926.0 204724.0 205091.0 205722.0 205926.0 50672.0 50899.5 50950.7 50984.0 51054.2 1469.9 1480.1 1480.7 1492.8 1500.0 21721.5 21854.0 21965.5 22109.7 22563.9 37447.8 37684.8 37741.6 37777.4 37798.6 191562.0 192233.0 192498.0 192723.0 193466.0 33322.5 34186.3 34547.7 34566.7 34701.3 42478.4 42511.8 42580.1 42812.4 42904.0 31592.0 31780.0 32098.0 32246.7 32595.2 31002.7 31163.7 31669.0 31823.7 31846.4 35751.3 35827.6 35924.6 36066.5 36193.8 31176.0 31329.4 31375.2 31387.8 31570.7 22829.4 22941.3 23165.4 23201.7 23399.8 15:24:52 INFO - PID 17600 | 15:24:52 INFO - PID 17600 | [#2] jquery.html Cycles:180 Average:35132.03 Median:21559.62 stddev:82326.30 (381.9%) stddev-sans-first:82516.35 15:24:52 INFO - PID 17600 | Values: 570.9 575.4 576.0 579.7 593.5 21920.2 22689.3 22716.0 22743.0 22767.1 23616.8 24014.9 24210.0 24214.2 24577.5 6511.3 6686.0 6696.3 6701.1 6702.9 6343.5 6592.5 6672.6 6677.4 6685.9 6577.9 6585.5 6587.7 6596.8 6602.8 6553.0 6583.9 6588.7 6611.0 6615.0 6642.7 6914.2 6947.0 6949.3 6952.1 30310.2 30694.2 30961.4 30977.5 30985.5 2066.9 2105.8 2106.9 2108.0 2108.2 19986.8 20467.0 20790.2 20862.2 21081.5 2532.7 2544.9 2608.6 2633.1 2666.4 122488.4 125330.0 125500.0 129812.0 135928.6 19880.4 20258.4 20984.8 21505.2 21834.8 41608.4 41614.4 41704.4 41705.4 41706.4 11350.5 11430.4 11431.3 11582.5 11718.5 9487.2 9548.8 9556.2 9594.0 9704.9 11238.7 11243.5 11495.4 11567.1 11682.4 3920.2 4031.6 4064.3 4096.9 4187.9 974.0 984.1 987.6 993.9 1005.2 18437.4 18666.3 18948.1 18955.2 19047.8 1040.4 1043.2 1047.8 1055.1 1061.4 10396.9 10449.9 10543.5 10590.7 10734.8 476351.0 490155.0 493214.0 501491.0 503061.0 102684.5 107356.5 109067.0 110211.4 111096.0 1159.1 1169.2 1198.9 1202.1 1205.2 16748.2 16955.7 16961.5 17082.8 17332.4 53290.5 54105.7 54306.5 54736.7 55151.0 68227.7 68606.7 68650.7 69086.7 69318.3 18683.8 19130.5 19214.2 19295.8 19383.8 21301.5 21614.0 21719.0 21942.6 21971.2 17153.9 17220.9 17324.2 17444.7 17725.8 15004.5 15466.5 15639.3 15674.9 16235.4 17617.8 17670.6 17702.9 17810.1 18158.5 18434.4 18502.1 18534.2 18539.0 18728.3 17078.1 17202.0 17330.8 17400.3 17430.0 15:24:52 INFO - PID 17600 | 15:24:52 INFO - PID 17600 | [#3] mootools.html Cycles:180 Average:9548.05 Median:2735.77 stddev:6766.03 (247.3%) stddev-sans-first:6756.04 15:24:52 INFO - PID 17600 | Values: 1215.4 1270.8 1386.4 1418.6 1419.6 15463.8 16105.9 16140.0 16146.4 16154.2 15599.3 15716.5 15732.2 15736.3 15759.9 2690.0 2736.5 2771.5 2779.0 2779.2 2718.9 2736.0 2757.8 2759.3 2760.0 2715.0 2735.5 2811.6 2820.9 2822.1 2744.7 2777.0 2783.5 2799.4 2802.6 2590.4 2722.4 2791.0 2797.7 2804.8 15148.4 15220.2 15239.2 15285.2 15297.8 7992.7 8324.0 8328.4 8329.7 8332.9 5534.5 5540.8 5672.9 5716.5 5719.9 1972.6 1988.5 1999.6 2002.1 2030.8 25964.9 26671.7 26759.9 26950.2 27050.3 7285.1 7396.4 7438.4 7505.8 7590.6 20245.6 20269.8 20273.7 20298.4 20345.5 8119.6 8273.9 8277.4 8280.8 8303.6 7201.3 7372.9 7400.9 7403.4 7480.1 5572.6 5756.9 5791.7 5793.2 5805.8 1745.3 1820.3 1824.8 1841.6 1876.9 908.9 930.7 947.5 950.9 953.9 7710.4 7782.1 7874.3 7917.5 7937.6 731.2 732.5 739.0 740.9 745.4 5254.8 5396.9 5471.3 5503.1 5549.3 20575.6 21685.2 21705.3 21724.2 21770.9 20900.7 20985.7 21340.1 21564.0 21588.6 11212.5 11361.1 11370.1 11384.0 11427.8 8566.2 8572.1 8593.6 8615.1 8670.9 17972.7 18218.6 18222.0 18251.8 18268.4 18769.5 19013.3 19177.7 19191.5 19829.0 11507.6 11536.2 11607.9 11653.6 11799.8 13621.9 13751.2 13756.9 13835.2 13838.9 11271.3 11410.7 11439.1 11583.9 11805.7 11073.6 11099.7 11100.9 11258.3 11453.3 9844.8 9933.1 9961.5 9966.7 9984.4 7214.0 7291.9 7311.3 7328.9 7378.5 7583.8 7756.0 7777.4 7805.3 7860.0 15:24:52 INFO - PID 17600 | 15:24:52 INFO - PID 17600 | [#4] prototype.html Cycles:180 Average:5551.16 Median:6255.19 stddev:1553.97 (24.8%) stddev-sans-first:1511.41 15:24:52 INFO - PID 17600 | Values: 501.6 506.6 527.2 530.3 530.9 6263.4 6304.8 6351.0 6354.4 6451.6 6183.3 6282.5 6330.2 6363.9 6364.2 5274.9 5283.4 5306.3 5310.6 5334.2 5151.2 5304.7 5309.5 5335.7 5345.7 4843.8 4966.6 5002.3 5021.5 5057.7 4965.8 4977.9 5010.3 5034.6 5048.2 4464.5 4473.2 4493.7 4519.9 4521.8 6164.9 6171.0 6201.1 6225.3 6246.9 5737.9 5751.5 5763.0 5763.4 5774.6 6544.9 6565.3 6581.9 6682.6 6705.8 4635.1 4871.3 4873.4 4916.4 4927.0 6669.0 6822.5 6857.7 6967.2 6994.0 4974.4 5043.4 5069.4 5078.2 5082.5 5095.6 5123.0 5133.8 5134.1 5139.1 5715.9 5716.7 5726.4 5733.3 5747.4 6651.5 6693.2 6699.6 6726.2 6738.4 1725.6 1736.3 1753.9 1777.2 1785.9 1151.9 1192.1 1198.1 1207.0 1218.5 5691.9 5720.4 5746.4 5772.1 5790.2 6684.7 6805.0 6820.8 6850.6 6857.3 5626.4 5718.2 5746.9 5757.2 5758.7 3519.3 3532.4 3595.3 3610.5 3628.7 6458.7 6476.7 6480.2 6485.5 6546.5 6830.3 6844.2 6937.3 7049.9 7081.2 6396.9 6513.0 6541.7 6543.1 6567.6 6325.6 6737.6 6753.6 6850.8 6891.0 6483.5 6553.9 6586.4 6604.7 6706.3 6314.0 6385.0 6417.3 6429.9 6468.9 4869.2 4929.6 4988.0 4995.0 4999.0 6470.5 6694.3 6757.9 6824.9 6902.2 6373.0 6448.7 6488.5 6537.7 6557.5 6554.5 6599.5 6599.8 6646.1 6705.4 6354.2 6428.3 6528.2 6553.8 6570.9 6489.8 6610.2 6694.9 6697.7 6708.8 6292.0 6316.3 6356.7 6369.2 6415.5 15:24:52 INFO - PID 17600 | 15:24:52 INFO - PID 17600 | [#5] yui.html Cycles:180 Average:24141.48 Median:18212.73 stddev:34915.42 (191.7%) stddev-sans-first:34969.71 15:24:52 INFO - PID 17600 | Values: 887.8 915.8 919.4 919.6 939.8 17743.5 18166.2 18197.5 18228.0 18260.4 16655.2 16696.0 16782.7 17179.5 18491.8 975.3 1002.5 1005.9 1006.0 1006.6 953.5 990.5 990.9 991.7 992.3 1061.4 1067.2 1067.2 1067.4 1067.5 1055.7 1061.4 1061.4 1061.9 1062.3 722.5 741.5 754.9 755.5 778.4 18854.0 18958.5 18968.5 18974.5 18992.5 21545.6 21583.0 22064.3 22156.6 22176.3 17120.7 17427.0 17587.1 17587.6 17724.6 3738.8 3760.2 3766.4 3767.4 3767.7 132601.0 133065.0 134444.0 135815.3 137465.0 16565.4 16810.9 17087.7 17167.7 17257.2 30489.5 31033.5 31098.1 31180.0 31352.5 8389.4 8435.3 8534.6 8537.0 8538.4 4260.0 4327.8 4328.4 4334.5 4338.6 5102.6 5236.9 5247.7 5252.0 5257.4 928.9 960.8 965.8 969.1 973.5 689.5 703.2 714.5 716.9 723.3 11628.2 12108.7 12255.9 12817.8 13095.1 633.5 648.8 650.2 653.8 654.4 5467.0 5563.7 5601.4 5671.5 5676.6 122092.0 124153.0 124159.4 127403.0 127511.4 105759.0 106075.5 106555.0 109143.5 111705.0 90262.5 92442.5 92503.0 94669.5 95415.0 10302.5 10481.0 10504.0 10617.8 10766.5 43898.6 44575.1 45967.8 46382.7 46523.0 57401.0 58411.7 58673.0 59074.1 59295.1 15216.8 15242.8 15285.4 15344.5 15524.7 17441.3 17446.0 17486.2 17718.0 17743.8 15446.8 15786.1 15904.5 15998.4 16000.8 15776.5 15853.8 15927.5 16071.7 16092.8 15402.5 15471.9 15725.8 15880.4 15892.7 12411.6 12532.7 12565.6 12641.6 12886.4 11148.6 11345.4 11494.3 11543.9 11660.0 15:24:52 INFO - PID 17600 | -------- Summary: end -------- 15:24:52 INFO - PID 17600 | 15:24:52 INFO - TEST-INFO | 17600: exit 0 15:24:52 INFO - TEST-OK | dromaeo_css | took 1108710ms 15:24:52 INFO - TEST-START | kraken 15:24:52 INFO - Initialising browser for kraken test... 15:24:52 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:52301/getInfo.html -profile /tmp/tmpY_E9LN/profile 15:24:52 INFO - TEST-INFO | started process 17972 (/builds/slave/test/build/application/firefox/firefox http://localhost:52301/getInfo.html) 15:24:58 INFO - TEST-INFO | 17972: exit 0 15:24:58 INFO - Browser initialized. 15:24:58 INFO - Running cycle 1/1 for kraken test... 15:24:58 INFO - Using env: {'DISPLAY': ':0', 15:24:58 INFO - 'HOME': '/home/cltbld', 15:24:58 INFO - 'JSGC_DISABLE_POISONING': '1', 15:24:58 INFO - 'LANG': 'en_US.UTF-8', 15:24:58 INFO - 'LANGUAGE': 'en_US:en', 15:24:58 INFO - 'LD_LIBRARY_PATH': '/builds/slave/test/build/application/firefox', 15:24:58 INFO - 'LOGNAME': 'cltbld', 15:24:58 INFO - 'MAIL': '/var/mail/cltbld', 15:24:58 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 15:24:58 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 15:24:58 INFO - 'MOZ_CRASHREPORTER': '1', 15:24:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:24:58 INFO - 'MOZ_DISABLE_NONLOCAL_CONNECTIONS': '1', 15:24:58 INFO - 'MOZ_NO_REMOTE': '1', 15:24:58 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 15:24:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:24:58 INFO - 'NO_EM_RESTART': '1', 15:24:58 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:24:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:24:58 INFO - 'PWD': '/builds/slave/test', 15:24:58 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 15:24:58 INFO - 'RUST_BACKTRACE': 'full', 15:24:58 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 15:24:58 INFO - 'SHELL': '/bin/bash', 15:24:58 INFO - 'SHLVL': '1', 15:24:58 INFO - 'STYLO_FORCE_DISABLED': '1', 15:24:58 INFO - 'TERM': 'linux', 15:24:58 INFO - 'TMOUT': '86400', 15:24:58 INFO - 'USER': 'cltbld', 15:24:58 INFO - 'XDG_SESSION_COOKIE': '20e20d796406ba5117c4a6f1000001ba-1505942851.61555-1848254621', 15:24:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:24:58 INFO - '_': '/tools/buildbot/bin/python'} 15:24:58 INFO - TEST-INFO | started process 18205 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpY_E9LN/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 15:24:59 INFO - PID 18205 | 15:24:59 INFO - PID 18205 | (/builds/slave/test/build/application/firefox/firefox:18254): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 15:24:59 INFO - PID 18205 | 15:25:09 INFO - PID 18205 | RSS: Main: 154255360 15:25:09 INFO - PID 18205 | 15:25:12 INFO - PID 18205 | Cycle 1(1): loaded http://localhost:52301/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:52301/tests/kraken/driver.html?testName=audio-beat-detection) 15:25:13 INFO - PID 18205 | RSS: Main: 160043008 15:25:13 INFO - PID 18205 | 15:25:15 INFO - PID 18205 | Cycle 1(1): loaded http://localhost:52301/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:52301/tests/kraken/driver.html?testName=audio-dft) 15:25:16 INFO - PID 18205 | RSS: Main: 160178176 15:25:16 INFO - PID 18205 | 15:25:19 INFO - PID 18205 | Cycle 1(1): loaded http://localhost:52301/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:52301/tests/kraken/driver.html?testName=audio-fft) 15:25:19 INFO - PID 18205 | RSS: Main: 157016064 15:25:19 INFO - PID 18205 | 15:25:21 INFO - PID 18205 | Cycle 1(1): loaded http://localhost:52301/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:52301/tests/kraken/driver.html?testName=audio-oscillator) 15:25:22 INFO - PID 18205 | RSS: Main: 157601792 15:25:22 INFO - PID 18205 | 15:25:24 INFO - PID 18205 | Cycle 1(1): loaded http://localhost:52301/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:52301/tests/kraken/driver.html?testName=imaging-gaussian-blur) 15:25:25 INFO - PID 18205 | RSS: Main: 157335552 15:25:25 INFO - PID 18205 | 15:25:28 INFO - PID 18205 | Cycle 1(1): loaded http://localhost:52301/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:52301/tests/kraken/driver.html?testName=imaging-darkroom) 15:25:29 INFO - PID 18205 | RSS: Main: 160407552 15:25:29 INFO - PID 18205 | 15:25:32 INFO - PID 18205 | Cycle 1(1): loaded http://localhost:52301/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:52301/tests/kraken/driver.html?testName=imaging-desaturate) 15:25:33 INFO - PID 18205 | RSS: Main: 160419840 15:25:33 INFO - PID 18205 | 15:25:36 INFO - PID 18205 | Cycle 1(1): loaded http://localhost:52301/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:52301/tests/kraken/driver.html?testName=json-parse-financial) 15:25:36 INFO - PID 18205 | RSS: Main: 160329728 15:25:36 INFO - PID 18205 | 15:25:38 INFO - PID 18205 | Cycle 1(1): loaded http://localhost:52301/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:52301/tests/kraken/driver.html?testName=json-stringify-tinderbox) 15:25:39 INFO - PID 18205 | RSS: Main: 160157696 15:25:39 INFO - PID 18205 | 15:25:40 INFO - PID 18205 | Cycle 1(1): loaded http://localhost:52301/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:52301/tests/kraken/driver.html?testName=stanford-crypto-aes) 15:25:41 INFO - PID 18205 | RSS: Main: 160133120 15:25:41 INFO - PID 18205 | 15:25:43 INFO - PID 18205 | Cycle 1(1): loaded http://localhost:52301/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:52301/tests/kraken/driver.html?testName=stanford-crypto-ccm) 15:25:44 INFO - PID 18205 | RSS: Main: 156794880 15:25:44 INFO - PID 18205 | 15:25:46 INFO - PID 18205 | Cycle 1(1): loaded http://localhost:52301/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:52301/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 15:25:47 INFO - PID 18205 | RSS: Main: 156831744 15:25:47 INFO - PID 18205 | 15:25:50 INFO - PID 18205 | Cycle 1(1): loaded http://localhost:52301/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:52301/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 15:25:50 INFO - PID 18205 | RSS: Main: 157315072 15:25:50 INFO - PID 18205 | 15:25:52 INFO - PID 18205 | Cycle 1(1): loaded http://localhost:52301/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:52301/tests/kraken/driver.html?testName=ai-astar) 15:25:52 INFO - PID 18205 | RSS: Main: 158285824 15:25:52 INFO - PID 18205 | 15:25:52 INFO - PID 18205 | __start_tp_report 15:25:52 INFO - PID 18205 | _x_x_mozilla_page_load 15:25:52 INFO - PID 18205 | _x_x_mozilla_page_load_details 15:25:52 INFO - PID 18205 | |i|pagename|runs| 15:25:52 INFO - PID 18205 | |0;ai-astar;111;109;108;107;108;110;110;110;107;108 15:25:52 INFO - PID 18205 | |1;audio-beat-detection;116;114;115;117;115;115;138;121;115;116 15:25:52 INFO - PID 18205 | |2;audio-dft;163;161;161;162;162;161;164;164;165;166 15:25:52 INFO - PID 18205 | |3;audio-fft;75;75;74;73;74;73;73;77;76;76 15:25:52 INFO - PID 18205 | |4;audio-oscillator;79;80;79;79;78;78;78;78;77;79 15:25:52 INFO - PID 18205 | |5;imaging-gaussian-blur;113;114;114;110;109;113;115;114;114;114 15:25:52 INFO - PID 18205 | |6;imaging-darkroom;158;149;148;147;149;156;148;147;147;147 15:25:52 INFO - PID 18205 | |7;imaging-desaturate;96;99;98;94;93;94;94;94;94;94 15:25:52 INFO - PID 18205 | |8;json-parse-financial;54;53;52;56;58;54;53;52;51;52 15:25:52 INFO - PID 18205 | |9;json-stringify-tinderbox;38;38;38;38;38;38;39;38;38;38 15:25:52 INFO - PID 18205 | |10;stanford-crypto-aes;74;74;72;78;74;73;74;74;75;73 15:25:52 INFO - PID 18205 | |11;stanford-crypto-ccm;114;109;116;114;110;124;114;114;112;118 15:25:52 INFO - PID 18205 | |12;stanford-crypto-pbkdf2;177;174;171;167;168;168;174;169;172;166 15:25:52 INFO - PID 18205 | |13;stanford-crypto-sha256-iterative;65;65;64;64;63;64;64;65;69;67 15:25:52 INFO - PID 18205 | __end_tp_report 15:25:52 INFO - PID 18205 | __start_cc_report 15:25:52 INFO - PID 18205 | _x_x_mozilla_cycle_collect,725 15:25:52 INFO - PID 18205 | __end_cc_report 15:25:52 INFO - PID 18205 | __startTimestamp1505946352845__endTimestamp 15:25:52 INFO - PID 18205 | 15:25:52 INFO - PID 18205 | ------- Summary: start ------- 15:25:52 INFO - PID 18205 | Number of tests: 14 15:25:52 INFO - PID 18205 | 15:25:52 INFO - PID 18205 | [#0] ai-astar Cycles:10 Average:108.80 Median:109.50 stddev:1.40 (1.3%) stddev-sans-first:1.24 15:25:52 INFO - PID 18205 | Values: 111.0 109.0 108.0 107.0 108.0 110.0 110.0 110.0 107.0 108.0 15:25:52 INFO - PID 18205 | 15:25:52 INFO - PID 18205 | [#1] audio-beat-detection Cycles:10 Average:118.20 Median:116.00 stddev:7.22 (6.2%) stddev-sans-first:7.62 15:25:52 INFO - PID 18205 | Values: 116.0 114.0 115.0 117.0 115.0 115.0 138.0 121.0 115.0 116.0 15:25:52 INFO - PID 18205 | 15:25:52 INFO - PID 18205 | [#2] audio-dft Cycles:10 Average:162.90 Median:163.50 stddev:1.79 (1.1%) stddev-sans-first:1.90 15:25:52 INFO - PID 18205 | Values: 163.0 161.0 161.0 162.0 162.0 161.0 164.0 164.0 165.0 166.0 15:25:52 INFO - PID 18205 | 15:25:52 INFO - PID 18205 | [#3] audio-fft Cycles:10 Average:74.60 Median:75.00 stddev:1.43 (1.9%) stddev-sans-first:1.51 15:25:52 INFO - PID 18205 | Values: 75.0 75.0 74.0 73.0 74.0 73.0 73.0 77.0 76.0 76.0 15:25:52 INFO - PID 18205 | 15:25:52 INFO - PID 18205 | [#4] audio-oscillator Cycles:10 Average:78.50 Median:79.00 stddev:0.85 (1.1%) stddev-sans-first:0.88 15:25:52 INFO - PID 18205 | Values: 79.0 80.0 79.0 79.0 78.0 78.0 78.0 78.0 77.0 79.0 15:25:52 INFO - PID 18205 | 15:25:52 INFO - PID 18205 | [#5] imaging-gaussian-blur Cycles:10 Average:113.00 Median:114.00 stddev:1.94 (1.7%) stddev-sans-first:2.06 15:25:52 INFO - PID 18205 | Values: 113.0 114.0 114.0 110.0 109.0 113.0 115.0 114.0 114.0 114.0 15:25:52 INFO - PID 18205 | 15:25:52 INFO - PID 18205 | [#6] imaging-darkroom Cycles:10 Average:149.60 Median:148.50 stddev:4.01 (2.7%) stddev-sans-first:2.87 15:25:52 INFO - PID 18205 | Values: 158.0 149.0 148.0 147.0 149.0 156.0 148.0 147.0 147.0 147.0 15:25:52 INFO - PID 18205 | 15:25:52 INFO - PID 18205 | [#7] imaging-desaturate Cycles:10 Average:95.00 Median:94.00 stddev:2.00 (2.1%) stddev-sans-first:2.09 15:25:52 INFO - PID 18205 | Values: 96.0 99.0 98.0 94.0 93.0 94.0 94.0 94.0 94.0 94.0 15:25:52 INFO - PID 18205 | 15:25:52 INFO - PID 18205 | [#8] json-parse-financial Cycles:10 Average:53.50 Median:53.50 stddev:2.12 (4.0%) stddev-sans-first:2.24 15:25:52 INFO - PID 18205 | Values: 54.0 53.0 52.0 56.0 58.0 54.0 53.0 52.0 51.0 52.0 15:25:52 INFO - PID 18205 | 15:25:52 INFO - PID 18205 | [#9] json-stringify-tinderbox Cycles:10 Average:38.10 Median:38.00 stddev:0.32 (0.8%) stddev-sans-first:0.33 15:25:52 INFO - PID 18205 | Values: 38.0 38.0 38.0 38.0 38.0 38.0 39.0 38.0 38.0 38.0 15:25:52 INFO - PID 18205 | 15:25:52 INFO - PID 18205 | [#10] stanford-crypto-aes Cycles:10 Average:74.10 Median:74.00 stddev:1.60 (2.2%) stddev-sans-first:1.69 15:25:52 INFO - PID 18205 | Values: 74.0 74.0 72.0 78.0 74.0 73.0 74.0 74.0 75.0 73.0 15:25:52 INFO - PID 18205 | 15:25:52 INFO - PID 18205 | [#11] stanford-crypto-ccm Cycles:10 Average:114.50 Median:114.00 stddev:4.25 (3.7%) stddev-sans-first:4.50 15:25:52 INFO - PID 18205 | Values: 114.0 109.0 116.0 114.0 110.0 124.0 114.0 114.0 112.0 118.0 15:25:52 INFO - PID 18205 | 15:25:52 INFO - PID 18205 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:170.60 Median:171.50 stddev:3.60 (2.1%) stddev-sans-first:2.98 15:25:52 INFO - PID 18205 | Values: 177.0 174.0 171.0 167.0 168.0 168.0 174.0 169.0 172.0 166.0 15:25:52 INFO - PID 18205 | 15:25:52 INFO - PID 18205 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:65.00 Median:65.00 stddev:1.76 (2.7%) stddev-sans-first:1.87 15:25:52 INFO - PID 18205 | Values: 65.0 65.0 64.0 64.0 63.0 64.0 64.0 65.0 69.0 67.0 15:25:52 INFO - PID 18205 | -------- Summary: end -------- 15:25:52 INFO - PID 18205 | 15:25:53 INFO - PID 18205 | *** UTM:SVC TimerManager:registerTimer called after profile-before-change notification. Ignoring timer registration for id: telemetry_modules_ping 15:25:53 INFO - TEST-INFO | 18205: exit 0 15:25:53 INFO - TEST-OK | kraken | took 60648ms 15:25:53 INFO - SUITE-END | took 1169s 15:25:53 INFO - Completed test suite (00:19:29) 15:25:53 INFO - javascript benchmark 15:25:53 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s", "stylo_disabled"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 8612.437744075703, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3116.579261799657, 3134.749220062395, 3136.2943337749, 3155.1796532901453, 3177.3645270945804, 6177.444030037295, 6316.873662526747, 6380.266269379023, 6419.358064193579, 6443.935560644398, 6248.781292654758, 6250.656213908244, 6309.305976342599, 6425.228972523292, 6426.935730642692, 1302.2455445367086, 5871.324797648283, 5888.676122813244, 5908.970455147718, 5965.1052342148805, 5722.685252311121, 5792.073268277077, 5844.620099693507, 5871.588988770788, 5901.937651222778, 5767.452092051249, 5788.247527821356, 5808.332041815182, 5823.912641310384, 5855.824325270228, 5781.479666829963, 5789.0, 5853.5317174625925, 5863.149843272744, 5882.647041177543, 5763.538916886639, 5773.566982476289, 5840.036393994986, 5841.182234487175, 5848.912266316009, 6212.72042758077, 6303.810885673392, 6315.463185629227, 6367.172267605228, 6404.7117879695525, 6573.57271777333, 6681.9642955342, 6684.86630267392, 6740.865182696319, 6830.829229269259, 6665.600063996176, 6687.465002799813, 6741.494387920926, 6752.1222241108835, 6752.966235168842, 6267.874642507124, 6385.999999999954, 6386.42522173002, 6387.041943708481, 6389.488840892717, 6965.477589180831, 6969.895451568231, 7048.224695283515, 7051.330123638246, 7073.71705131789, 6442.387973142544, 6630.370114839083, 6647.966760166169, 6732.865342693119, 6734.730610775514, 6652.201735791736, 6681.331866813377, 6802.455803535705, 6819.318068193141, 6825.795226143224, 6671.46628269747, 6756.054152418567, 6763.898541521881, 6787.321267873173, 6789.015592739025, 6759.290274521104, 6796.626185559841, 6814.1482314710665, 6858.5199036067, 6859.9314006860295, 5055.34280543527, 5205.505476979681, 5225.477452254744, 5302.416734159239, 5306.09796334624, 4593.28804035375, 4669.976650116728, 4694.50707675696, 4707.882302942454, 4713.528647135259, 5780.075187969905, 5829.417058294137, 5861.238039054895, 5863.501602363847, 5865.736041878125, 6747.966260168766, 6767.560108592926, 6768.526203165731, 6825.0, 6853.143357080365, 5641.351244606841, 5772.6536407815665, 5781.5952883298605, 5792.21805056312, 5856.970715146482, 5876.559258055663, 5889.38161493037, 5890.352061273256, 5895.322037965603, 5901.17383566301, 6360.9045864312075, 6483.254425741005, 6490.415862572391, 6507.609543427315, 6584.7366105356205, 6641.933580664131, 6869.484788640972, 6869.622170780655, 6870.690818913261, 6876.381125698611, 6403.263624683221, 6405.135306733531, 6488.383603557654, 6493.707783149675, 6498.480121590356, 6535.117759102651, 6632.966835165793, 6644.4020038196795, 6698.56459330142, 6752.966235168989, 6859.691313890987, 6860.0738900247825, 6877.89683154763, 6883.414909732729, 6884.586924784529, 6449.838754031187, 6647.800565983028, 6653.63405012729, 6658.800235992928, 6664.633445160563, 6520.739170433129, 6526.118973938647, 6598.538102332791, 6608.43828274602, 6609.504287178384, 6311.274203466476, 6405.903911441239, 6430.839229019312, 6464.8707025858275, 6590.934090659032, 6607.471402287902, 6667.366600172976, 6690.966545167437, 6691.59850408977, 6693.665316734046, 6125.111858780363, 6264.154339164154, 6351.96824015877, 6448.193975753031, 6451.3548645135115], "value": 6129.446911469477, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [868.7741187291305, 881.2773525708922, 898.178166977216, 916.7524768312555, 917.7292698653896, 40872.0, 41136.17727645445, 41686.791566042164, 42086.0, 42295.57704422958, 42305.788471057676, 42704.14591708172, 42730.0, 42748.78625606868, 42828.785856070754, 7834.80412989677, 8061.798455038642, 8062.314703250201, 8063.838723225532, 8066.475679080871, 7915.564643944581, 7942.126366099725, 8006.63970121343, 8008.0, 8026.959865200666, 8017.559034253114, 8038.959805200966, 8042.477238979448, 8050.718224862131, 8068.435209535335, 7972.0832104308165, 7977.042754869424, 8003.159668234839, 8013.919860801376, 8030.437869349148, 7885.250901164381, 7901.130875603679, 7939.841203175962, 7955.96022019892, 7956.403269754734, 36841.44737828908, 37244.44133338002, 37275.06812329686, 37293.0, 37310.44034339487, 3575.910602234939, 3612.494250804863, 3612.6567976042234, 3612.783233006002, 3613.981930090359, 30879.536806947915, 30897.0, 30901.38197236043, 30905.536416953764, 31008.689913101032, 4939.876503087416, 5176.741162941876, 5214.270002199695, 5230.738463076831, 5276.287701160371, 173562.0, 175222.0, 175297.0, 183088.0, 183572.0, 49022.26466603004, 49946.75026624916, 49997.50002499928, 50031.49968500269, 50039.24941125886, 52506.737466313185, 52545.0, 52639.473605263454, 52647.0, 52653.7367313161, 15695.136767477898, 15791.684166316609, 15816.525504234662, 15817.446389376546, 15841.52475425739, 12938.223706577635, 12987.155834870704, 12999.0, 13011.089223754436, 13015.47938082485, 13688.452461901412, 13715.382807773674, 13825.930870345785, 13883.37524811386, 13973.510927117502, 5051.156327940275, 5143.202803565453, 5172.508611681884, 5229.738513074331, 5315.574754019669, 984.7931934293736, 1010.2826992835022, 1019.4444028004755, 1030.4126647810676, 1035.4098164046572, 22436.55126897453, 22955.770442295696, 23009.0, 23036.88481557615, 23151.652725209136, 1099.2580008494235, 1117.446863802423, 1124.3872089711126, 1130.10156925243, 1137.806572882612, 12060.396980150957, 12156.939215303866, 12176.321209333932, 12231.69420764488, 12245.571405000961, 202926.0, 204724.0, 205091.0, 205722.0, 205926.0, 50672.0, 50899.491005089476, 50950.74524627427, 50984.0, 51054.234186487236, 1469.8971072024856, 1480.060161797245, 1480.696457226266, 1492.7611582147022, 1499.9625009374854, 21721.456963575405, 21854.0, 21965.450863727896, 22109.668354974365, 22563.887180563994, 37447.81276093602, 37684.811575941945, 37741.62258377491, 37777.433338500494, 37798.62201377951, 191562.0, 192233.0, 192498.0, 192723.0, 193466.0, 33322.5001624971, 34186.31627367389, 34547.65452345445, 34566.65433345635, 34701.30597388089, 42478.36282455827, 42511.787441062595, 42580.14839703127, 42812.357814633426, 42904.0, 31592.0, 31780.0, 32098.0, 32246.677533225306, 32595.18512037218, 31002.68997309998, 31163.662725296148, 31669.0, 31823.681763182998, 31846.363072737953, 35751.28497429985, 35827.641723582434, 35924.64075359317, 36066.4590031155, 36193.81903090468, 31176.0, 31329.373412532077, 31375.215619608778, 31387.84306078455, 31570.684293156773, 22829.429264268525, 22941.311760647208, 23165.42086447852, 23201.651975220724, 23399.76600233976], "value": 17075.712096220457, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [570.9143628455734, 575.3584753000405, 576.0293904770459, 579.6724850459493, 593.4955288005195, 21920.23279185229, 22689.319320420414, 22716.0, 22743.0, 22767.089316427344, 23616.763832361714, 24014.87992560039, 24210.0, 24214.15250466234, 24577.50844983099, 6511.283758786518, 6686.0305255737885, 6696.296888826651, 6701.061851340816, 6702.865942681144, 6343.492520598341, 6592.472602191837, 6672.633005184713, 6677.399034086931, 6685.899711504331, 6577.934220657804, 6585.506087043467, 6587.670616469181, 6596.802095937105, 6602.768903088393, 6552.967235163841, 6583.901241481333, 6588.670566471681, 6611.041398997167, 6615.0, 6642.734290628369, 6914.204866440374, 6947.0, 6949.270326615683, 6952.130983627047, 30310.242243943856, 30694.232644184074, 30961.38077238465, 30977.535336969962, 30985.535216971763, 2066.8863212523456, 2105.7578378486364, 2106.8735875847497, 2107.99870061721, 2108.20942146695, 19986.80013199864, 20467.0, 20790.16839326425, 20862.165513379598, 21081.472963176042, 2532.7214006459276, 2544.885480153379, 2608.5565453872887, 2633.0652618320414, 2666.386731051869, 122488.38755806253, 125330.0, 125500.0, 129812.0, 135928.64071359258, 19880.403587892386, 20258.392248232576, 20984.760257711067, 21505.24731634385, 21834.781652183276, 41608.37587436191, 41614.375784363256, 41704.374434383506, 41705.374419383734, 41706.37440438396, 11350.545978160946, 11430.428478576037, 11431.256968297033, 11582.478788454371, 11718.472668729928, 9487.193588545051, 9548.761280968032, 9556.187724043395, 9593.952030239805, 9704.854427183598, 11238.662840114646, 11243.494042768096, 11495.367754773568, 11567.132465065153, 11682.415879206006, 3920.196359746245, 4031.5565287818317, 4064.3293856513937, 4096.877093687194, 4187.853425130106, 973.9610415583297, 984.1437948984429, 987.6247026130025, 993.9453330066771, 1005.1556692378438, 18437.354692585694, 18666.253349865852, 18948.052597370075, 18955.241790328233, 19047.809521904604, 1040.422565476168, 1043.2071625564474, 1047.8218702820539, 1055.1084333737979, 1061.3578784835063, 10396.896031039743, 10449.9477502612, 10543.525541350658, 10590.735231619272, 10734.838977415346, 476351.0, 490155.0, 493214.0, 501491.0, 503061.0, 102684.48657756664, 107356.46321768341, 109067.0, 110211.44894275477, 111096.0, 1159.0553698735503, 1169.2283093158474, 1198.8801119887942, 1202.1344631865043, 1205.1684337806885, 16748.162591870114, 16955.66088678195, 16961.49115526536, 17082.829171708123, 17332.393366232627, 53290.4670953301, 54105.72947135239, 54306.45693543014, 54736.726316368164, 55151.0, 68227.65886170736, 68606.65696671484, 68650.65674671794, 69086.65456672685, 69318.30681693119, 18683.813161868205, 19130.52173695669, 19214.231430742613, 19295.8070419294, 19383.806161938763, 21301.46746331354, 21614.0, 21719.0, 21942.561148776615, 21971.23100691468, 17153.914230429265, 17220.88064275818, 17324.220410081827, 17444.73832892533, 17725.822741772416, 15004.474843380429, 15466.458673946358, 15639.296231669374, 15674.9216253918, 16235.350585976428, 17617.82382176162, 17670.558236044202, 17702.911485443004, 17810.10949452548, 18158.546036348667, 18434.354797582022, 18502.074896255403, 18534.165962531988, 18539.0, 18728.25086996505, 17078.146092695562, 17202.0, 17330.826691733426, 17400.303987840343, 17430.0], "value": 12621.306577515545, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1215.3801561203784, 1270.8030255310427, 1386.369202013084, 1418.631155899467, 1419.609607357977, 15463.84536154638, 16105.919470402661, 16140.031598104108, 16146.434874779385, 16154.192290385463, 15599.298031588578, 15716.528504144893, 15732.213389330516, 15736.29186686599, 15759.92120039401, 2689.9596506052326, 2736.480068786929, 2771.514984877638, 2778.9861050694717, 2779.1523585306472, 2718.904838330659, 2736.0423851651963, 2757.765589924859, 2759.3239656284136, 2760.0339881041577, 2715.049732593596, 2735.5076086304457, 2811.6063751074867, 2820.8871645134273, 2822.0969289827262, 2744.7392497712685, 2776.9583456248174, 2783.512885245074, 2799.370141718128, 2802.63565736454, 2590.3912580543556, 2722.414680843628, 2790.9581356279673, 2797.650293713286, 2804.8457334846576, 15148.394064237416, 15220.162891040989, 15239.23803809805, 15285.159316237603, 15297.770533441895, 7992.680292788282, 8324.0, 8328.417010809246, 8329.708460203925, 8332.875006874901, 5534.501894829445, 5540.806071787468, 5672.8865422691315, 5716.542676585863, 5719.857003574903, 1972.5956178983274, 1988.4730546405215, 1999.5800881814837, 2002.119067610247, 2030.8476864235095, 25964.870175649, 26671.73328266712, 26759.86620066907, 26950.191494255203, 27050.323741906413, 7285.125784905846, 7396.445266604918, 7438.442116841258, 7505.849883002309, 7590.620468976529, 20245.59508809845, 20269.797302027087, 20273.695894561297, 20298.391048268575, 20345.491362715755, 8119.553424561587, 8273.917260827435, 8277.379196560281, 8280.792980175544, 8303.626336814857, 7201.279872012861, 7372.889406658905, 7400.851982960311, 7403.444741644291, 7480.139783924809, 5572.637778544382, 5756.856078597984, 5791.710414479259, 5793.159991801165, 5805.767769289266, 1745.2757105801204, 1820.280989009334, 1824.835764781176, 1841.611434959654, 1876.934307299238, 908.9454632722058, 930.6556574067503, 947.4788866123605, 950.919171870385, 953.9046095390405, 7710.421718371144, 7782.143964163937, 7874.291313781787, 7917.485363451472, 7937.563434011069, 731.1555153797373, 732.4909188114316, 738.9704411823467, 740.9222031686703, 745.4371949178336, 5254.842354729364, 5396.865078372994, 5471.288732464834, 5503.11950087984, 5549.250851135126, 20575.58848823015, 21685.241016564345, 21705.34883953484, 21724.23965161212, 21770.891145544487, 20900.686489702668, 20985.68521472179, 21340.14639414406, 21564.0, 21588.56822863534, 11212.495437705324, 11361.147913906325, 11370.147238957112, 11384.0, 11427.771444571063, 8566.229039386486, 8572.099929507312, 8593.570321484025, 8615.095414981588, 8670.91329086701, 17972.730409043612, 18218.635627287116, 18222.0, 18251.81748182501, 18268.36060737868, 18769.530761731065, 19013.33453329127, 19177.712334314718, 19191.52021199481, 19829.0, 11507.597234096766, 11536.192466527262, 11607.883921160681, 11653.59212427561, 11799.823002654795, 13621.931890340486, 13751.243681597609, 13756.86243137596, 13835.239061851695, 13838.930805345908, 11271.267367621078, 11410.714732131763, 11439.142064345373, 11583.942080289544, 11805.704857378634, 11073.557057717924, 11099.667009989713, 11100.888991109985, 11258.268212566158, 11453.312801231952, 9844.753881153028, 9933.056359645821, 9961.452120133172, 9966.700998969753, 9984.35101718386, 7214.0, 7291.927080729125, 7311.341979221896, 7328.890066648898, 7378.483506154733, 7583.810404739926, 7756.0, 7777.4166937478785, 7805.33654639362, 7860.0], "value": 6822.6460897564575, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [501.61482152365494, 506.63015998321214, 527.1986580397795, 530.2761730238224, 530.914280296793, 6263.434141464634, 6304.8108556743255, 6350.968245158773, 6354.396332348425, 6451.645159516236, 6183.258009038922, 6282.497400207983, 6330.240371155456, 6363.872722545558, 6364.204474440695, 5274.947250527484, 5283.445238249967, 5306.328506520453, 5310.575153987691, 5334.159714898373, 5151.175811870102, 5304.70824104676, 5309.469053094698, 5335.706536140511, 5345.705986170759, 4843.8062477501035, 4966.627502937276, 5002.324686167375, 5021.522955319257, 5057.6965382077005, 4965.783383071171, 4977.850664480072, 5010.348654674905, 5034.597232221414, 5048.242763585455, 4464.531224221475, 4473.172463094338, 4493.662975276868, 4519.864404067883, 4521.773911304422, 6164.87670246597, 6170.96914515429, 6201.131841542187, 6225.260885210493, 6246.939978617334, 5737.885242295172, 5751.4536119068625, 5762.971185144047, 5763.423657634245, 5774.595778295521, 6544.934550654528, 6565.310642382577, 6581.926693091661, 6682.632455214961, 6705.792957267689, 4635.0729854029, 4871.29366241893, 4873.366462359871, 4916.360873086512, 4926.975365123188, 6669.0, 6822.522423430361, 6857.657117144123, 6967.233604303573, 6994.0, 4974.353334066548, 5043.36957880265, 5069.403138011515, 5078.162103252922, 5082.517160869711, 5095.617828662865, 5123.0, 5133.845984620468, 5134.127198376285, 5139.100657384943, 5715.914261286084, 5716.685582293014, 5726.427357264323, 5733.3406658234, 5747.396523364986, 6651.501137414713, 6693.163354580677, 6699.598024118569, 6726.22648395431, 6738.427233685094, 1725.6376161006328, 1736.3401907275154, 1753.929842806299, 1777.2446710148395, 1785.8660600455019, 1151.9136064795173, 1192.1297452859287, 1198.1193822540426, 1206.9818952715716, 1218.5065048655308, 5691.8616276744815, 5720.399358067426, 5746.4253574643035, 5772.06635777011, 5790.189373487715, 6684.699188536528, 6804.965975170093, 6820.761273355508, 6850.554713943578, 6857.27998560144, 5626.35296940857, 5718.170865224519, 5746.856328591735, 5757.222774925415, 5758.654480731169, 3519.331327047904, 3532.364174448624, 3595.2989167112687, 3610.476480910306, 3628.6595146131126, 6458.6770661466735, 6476.676166191766, 6480.222373315138, 6485.4811615070685, 6546.509011824132, 6830.282820303796, 6844.220502669243, 6937.340952609494, 7049.859002819915, 7081.150261968493, 6396.880545904448, 6512.967435162794, 6541.705623246965, 6543.116679248431, 6567.602824968947, 6325.588836725598, 6737.62943038118, 6753.628550429577, 6850.8287292816085, 6891.0, 6483.546151769331, 6553.901691474536, 6586.37429444202, 6604.735810567524, 6706.262311145868, 6313.96843015782, 6385.0, 6417.26201486835, 6429.903551446826, 6468.902966455601, 4869.245266983623, 4929.556339929423, 4987.950120498748, 4995.0, 4998.950010499849, 6470.547061705635, 6694.263631000684, 6757.86484270302, 6824.884285871396, 6902.171739391305, 6372.968135159294, 6448.709808058555, 6488.513361497812, 6537.673116344069, 6557.508186886098, 6554.508411869224, 6599.505037122139, 6599.8020059398295, 6646.136002319668, 6705.362990515893, 6354.23749150105, 6428.292887782247, 6528.21661400635, 6553.836154096186, 6570.934290657224, 6489.837754055998, 6610.2398224204835, 6694.895342268471, 6697.665116744046, 6708.765193218214, 6292.0, 6316.336784637547, 6356.713947872265, 6369.20384951881, 6415.492359295655], "value": 5090.931769872654, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [887.8046829697472, 915.8214148241092, 919.4115765909817, 919.6413398774483, 939.8308304505191, 17743.46769596911, 18166.18252178652, 18197.45407637773, 18228.0, 18260.360887368926, 16655.16724163793, 16696.0, 16782.74825877613, 17179.484615461526, 18491.815081849178, 975.3221511049824, 1002.5087707023579, 1005.8591797148405, 1005.9798804023915, 1006.5872992073251, 953.5327689432198, 990.4898977026837, 990.9108180263775, 991.6677912899188, 992.2756387836884, 1061.3843970497132, 1067.156946012653, 1067.17294097075, 1067.4022547373456, 1067.4769363012108, 1055.72551136705, 1061.4056128567988, 1061.4268295120664, 1061.8938106189396, 1062.293574772783, 722.458156382713, 741.4957828676498, 754.9245075492462, 755.4824944912752, 778.3578547698172, 18854.0, 18958.526036849053, 18968.5257868553, 18974.525636859187, 18992.52518687044, 21545.569088618297, 21583.0, 22064.33806985793, 22156.556868862695, 22176.334709958726, 17120.74318885218, 17427.0, 17587.12064396788, 17587.648247034987, 17724.556886077822, 3738.813059347049, 3760.191558814868, 3766.39737641976, 3767.416050512175, 3767.6797472214894, 132601.0, 133065.0, 134443.999999999, 135815.32092339575, 137465.0, 16565.42021029282, 16810.91594542044, 17087.743683844754, 17167.656646867243, 17257.223424945907, 30489.5342334425, 31033.534496982113, 31098.067057987842, 31180.0, 31352.529712054336, 8389.412741108064, 8435.325173986066, 8534.573271336532, 8536.957315213509, 8538.359623028173, 4260.041490664637, 4327.826886924488, 4328.394024836525, 4334.523202447728, 4338.58783415575, 5102.591792656653, 5236.869078273074, 5247.685138891678, 5252.028374750607, 5257.447967963309, 928.9163975242126, 960.8366577681811, 965.7682156282442, 969.0938972061145, 973.4597298499259, 689.5483458334799, 703.2264509040015, 714.4855703893188, 716.8530451257584, 723.2875617516742, 11628.18602697803, 12108.697282568006, 12255.877441225652, 12817.807732884014, 13095.148815326973, 633.4773811605352, 648.8248172993266, 650.1970066967292, 653.7515744017243, 654.358728446116, 5467.0, 5563.666180029211, 5601.439856014366, 5671.489565939085, 5676.602637815396, 122092.01171894395, 124153.0, 124159.37920310521, 127403.0, 127511.36244318719, 105759.0, 106075.46962265293, 106555.0, 109143.45428272808, 111705.0, 90262.54868725615, 92442.53778731063, 92503.0, 94669.52665236767, 95415.0, 10302.536385862804, 10481.004304591052, 10504.0, 10617.787644247226, 10766.46167691628, 43898.561014389445, 44575.10849783051, 45967.77016114898, 46382.68086595724, 46523.0, 57401.0, 58411.70794146002, 58673.0, 59074.11388829085, 59295.110573342296, 15216.771748424004, 15242.847571524142, 15285.388584456497, 15344.462943796914, 15524.68950621004, 17441.30234790594, 17446.0, 17486.213120409357, 17718.0, 17743.822561774217, 15446.768298475756, 15786.131762753159, 15904.522864314089, 15998.360065597246, 16000.759988599948, 15776.526704198892, 15853.762193566876, 15927.522174334788, 16071.67856642884, 16092.839071609134, 15402.46091386796, 15471.922640386727, 15725.842741572895, 15880.364785408916, 15892.68214635724, 12411.62765117048, 12532.686682833002, 12565.560205392767, 12641.620751377473, 12886.420111094836, 11148.609798657333, 11345.432728363714, 11494.252873563191, 11543.94228028888, 11660.0], "value": 8893.569402909683, "unit": "score"}]}, {"extraOptions": ["e10s", "stylo_disabled"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1416.3999999999999, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [111.0, 109.0, 108.0, 107.0, 108.0, 110.0, 110.0, 110.0, 107.0, 108.0], "value": 108.8, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [116.0, 114.0, 115.0, 117.0, 115.0, 115.0, 138.0, 121.0, 115.0, 116.0], "value": 118.2, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 161.0, 161.0, 162.0, 162.0, 161.0, 164.0, 164.0, 165.0, 166.0], "value": 162.9, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 75.0, 74.0, 73.0, 74.0, 73.0, 73.0, 77.0, 76.0, 76.0], "value": 74.6, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [79.0, 80.0, 79.0, 79.0, 78.0, 78.0, 78.0, 78.0, 77.0, 79.0], "value": 78.5, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [113.0, 114.0, 114.0, 110.0, 109.0, 113.0, 115.0, 114.0, 114.0, 114.0], "value": 113.0, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [158.0, 149.0, 148.0, 147.0, 149.0, 156.0, 148.0, 147.0, 147.0, 147.0], "value": 149.6, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 99.0, 98.0, 94.0, 93.0, 94.0, 94.0, 94.0, 94.0, 94.0], "value": 95.0, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [54.0, 53.0, 52.0, 56.0, 58.0, 54.0, 53.0, 52.0, 51.0, 52.0], "value": 53.5, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [38.0, 38.0, 38.0, 38.0, 38.0, 38.0, 39.0, 38.0, 38.0, 38.0], "value": 38.1, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [74.0, 74.0, 72.0, 78.0, 74.0, 73.0, 74.0, 74.0, 75.0, 73.0], "value": 74.1, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [114.0, 109.0, 116.0, 114.0, 110.0, 124.0, 114.0, 114.0, 112.0, 118.0], "value": 114.5, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [177.0, 174.0, 171.0, 167.0, 168.0, 168.0, 174.0, 169.0, 172.0, 166.0], "value": 170.6, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [65.0, 65.0, 64.0, 64.0, 63.0, 64.0, 64.0, 65.0, 69.0, 67.0], "value": 65.0, "unit": "score"}]}]} 15:25:53 INFO - Return code: 0 15:25:53 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 15:25:53 INFO - # TBPL SUCCESS # 15:25:53 INFO - Running post-action listener: _package_coverage_data 15:25:53 INFO - Running post-action listener: _resource_record_post_action 15:25:53 INFO - [mozharness: 2017-09-20 22:25:53.658344Z] Finished run-tests step (success) 15:25:53 INFO - Running post-run listener: _resource_record_post_run 15:25:53 INFO - Total resource usage - Wall time: 1188s; CPU: 13.0%; Read bytes: 4096; Write bytes: 411762688; Read time: 8; Write time: 250876 15:25:53 INFO - TinderboxPrint: CPU usage
13.1% 15:25:53 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 8 15:25:53 INFO - TinderboxPrint: I/O write bytes / time
411,762,688 / 250,876 15:25:53 INFO - TinderboxPrint: CPU idle
8,230.7 (86.9%) 15:25:53 INFO - TinderboxPrint: CPU user
1,190.8 (12.6%) 15:25:53 INFO - TinderboxPrint: Swap in / out
0 / 0 15:25:53 INFO - install - Wall time: 18s; CPU: 13.0%; Read bytes: 0; Write bytes: 74661888; Read time: 0; Write time: 36792 15:25:53 INFO - setup-mitmproxy - Wall time: 0s; CPU: Can't collect data; Read bytes: 0; Write bytes: 0; Read time: 0; Write time: 0 15:25:53 INFO - run-tests - Wall time: 1170s; CPU: 13.0%; Read bytes: 0; Write bytes: 336580608; Read time: 0; Write time: 214084 15:25:54 INFO - Running post-run listener: _upload_blobber_files 15:25:54 INFO - Blob upload gear active. 15:25:54 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 15:25:54 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 15:25:54 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'] 15:25:54 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 15:25:54 INFO - (blobuploader) - INFO - Open directory for files ... 15:25:54 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 15:25:54 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 15:25:54 INFO - (blobuploader) - INFO - Uploading, attempt #1. 15:25:55 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 15:25:55 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 15:25:55 INFO - (blobuploader) - INFO - Done attempting. 15:25:55 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-stylo-disabled-e10s_raw.log ... 15:25:55 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 15:25:55 INFO - (blobuploader) - INFO - Uploading, attempt #1. 15:25:56 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-stylo-disabled-e10s_raw.log: uploaded 15:25:56 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 15:25:56 INFO - (blobuploader) - INFO - Done attempting. 15:25:56 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 15:25:56 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 15:25:56 INFO - (blobuploader) - INFO - Uploading, attempt #1. 15:26:03 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 15:26:03 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 15:26:03 INFO - (blobuploader) - INFO - Done attempting. 15:26:03 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-stylo-disabled-e10s_errorsummary.log ... 15:26:03 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 15:26:03 INFO - (blobuploader) - INFO - Uploading, attempt #1. 15:26:04 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-stylo-disabled-e10s_errorsummary.log: uploaded 15:26:04 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 15:26:04 INFO - (blobuploader) - INFO - Done attempting. 15:26:04 INFO - (blobuploader) - INFO - Iteration through files over. 15:26:04 INFO - Return code: 0 15:26:04 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 15:26:04 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 15:26:04 INFO - Setting buildbot property blobber_files to {"perfherder-data.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/72474a84f25621a5dfaf95e4412e0e69a5a41dd3a9028bf27cbe3e8a15d43b96cee725d12323e4de730ef118a0c13d889c051cdec31f25827be129347ea196ab", "dromaeojs-stylo-disabled-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/9a5fb006b8d5658fc17d10ac4504602e26a4b86c0c45fa100fe8c05b8d75b2cc16d0a720589908940828d27d02e75efddb7fe527748f201a6fe94d156c33bf9d", "dromaeojs-stylo-disabled-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/a55056bc8b9b8cbae4d2058067c2fa9debb7d99deb79e89b9c1ad82621c4b574a1c88bfea2b7fdbb9dd7dc9a9bdea4f87eb074433a9f4e26d352db9bbc7e17c3", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/e4c0cf99116ac3b2b4b039e27128217917e2aca2ef813f265c65fdacdc9ecef974455ee8732033371242d4e6bd7ae1c2f03107eb1b62f8ad4714a63c6935831b"} 15:26:04 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 15:26:04 INFO - Writing to file /builds/slave/test/properties/blobber_files 15:26:04 INFO - Contents: 15:26:04 INFO - blobber_files:{"perfherder-data.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/72474a84f25621a5dfaf95e4412e0e69a5a41dd3a9028bf27cbe3e8a15d43b96cee725d12323e4de730ef118a0c13d889c051cdec31f25827be129347ea196ab", "dromaeojs-stylo-disabled-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/9a5fb006b8d5658fc17d10ac4504602e26a4b86c0c45fa100fe8c05b8d75b2cc16d0a720589908940828d27d02e75efddb7fe527748f201a6fe94d156c33bf9d", "dromaeojs-stylo-disabled-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/a55056bc8b9b8cbae4d2058067c2fa9debb7d99deb79e89b9c1ad82621c4b574a1c88bfea2b7fdbb9dd7dc9a9bdea4f87eb074433a9f4e26d352db9bbc7e17c3", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/e4c0cf99116ac3b2b4b039e27128217917e2aca2ef813f265c65fdacdc9ecef974455ee8732033371242d4e6bd7ae1c2f03107eb1b62f8ad4714a63c6935831b"} 15:26:04 INFO - Running post-run listener: copy_logs_to_upload_dir 15:26:04 INFO - Copying logs to upload dir... 15:26:04 INFO - mkdir: /builds/slave/test/build/upload/logs 15:26:04 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1236.570002 ========= master_lag: 0.13 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 36 secs) (at 2017-09-20 15:26:04.429285) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-09-20 15:26:04.434090) ========= 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=20e20d796406ba5117c4a6f1000001ba-1505942851.61555-1848254621 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/72474a84f25621a5dfaf95e4412e0e69a5a41dd3a9028bf27cbe3e8a15d43b96cee725d12323e4de730ef118a0c13d889c051cdec31f25827be129347ea196ab", "dromaeojs-stylo-disabled-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/9a5fb006b8d5658fc17d10ac4504602e26a4b86c0c45fa100fe8c05b8d75b2cc16d0a720589908940828d27d02e75efddb7fe527748f201a6fe94d156c33bf9d", "dromaeojs-stylo-disabled-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/a55056bc8b9b8cbae4d2058067c2fa9debb7d99deb79e89b9c1ad82621c4b574a1c88bfea2b7fdbb9dd7dc9a9bdea4f87eb074433a9f4e26d352db9bbc7e17c3", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/e4c0cf99116ac3b2b4b039e27128217917e2aca2ef813f265c65fdacdc9ecef974455ee8732033371242d4e6bd7ae1c2f03107eb1b62f8ad4714a63c6935831b"} build_url:https://queue.taskcluster.net/v1/task/So2N-P5gRV2VMrCgAQvl_g/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011260 build_url: 'https://queue.taskcluster.net/v1/task/So2N-P5gRV2VMrCgAQvl_g/artifacts/public/build/target.tar.bz2' blobber_files: '{"perfherder-data.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/72474a84f25621a5dfaf95e4412e0e69a5a41dd3a9028bf27cbe3e8a15d43b96cee725d12323e4de730ef118a0c13d889c051cdec31f25827be129347ea196ab", "dromaeojs-stylo-disabled-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/9a5fb006b8d5658fc17d10ac4504602e26a4b86c0c45fa100fe8c05b8d75b2cc16d0a720589908940828d27d02e75efddb7fe527748f201a6fe94d156c33bf9d", "dromaeojs-stylo-disabled-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/a55056bc8b9b8cbae4d2058067c2fa9debb7d99deb79e89b9c1ad82621c4b574a1c88bfea2b7fdbb9dd7dc9a9bdea4f87eb074433a9f4e26d352db9bbc7e17c3", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/e4c0cf99116ac3b2b4b039e27128217917e2aca2ef813f265c65fdacdc9ecef974455ee8732033371242d4e6bd7ae1c2f03107eb1b62f8ad4714a63c6935831b"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-09-20 15:26:04.465461) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-09-20 15:26:04.465929) ========= 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=20e20d796406ba5117c4a6f1000001ba-1505942851.61555-1848254621 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004480 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-09-20 15:26:04.546591) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-09-20 15:26:04.546906) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-09-20 15:26:04.547214) ========= ========= Total master_lag: 0.40 =========